-- Logs begin at Fri 2025-06-20 21:49:12 JST, end at Fri 2025-06-20 22:27:41 JST. --
Jun 20 22:26:03 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:26:03 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:26:03 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:26:03 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:03 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:26:03 rivoplus volumio[7538]: verbose: New Socket.io Connection to 192.168.1.16:3000 from 192.168.1.2 UA: Dart/3.5 (dart:io) Engine version: 3 Transport: websocket Total Clients: 9
Jun 20 22:26:03 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:03 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard
Jun 20 22:26:03 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard
Jun 20 22:26:04 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:26:04 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:26:04 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:26:04 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:04 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:26:04 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:26:04 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:26:04 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:26:04 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:04 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:26:06 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:06 rivoplus volumio[7538]: verbose: New Socket.io Connection to 192.168.1.16:3000 from 192.168.1.2 UA: Dart/3.5 (dart:io) Engine version: 3 Transport: websocket Total Clients: 10
Jun 20 22:26:06 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:06 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard
Jun 20 22:26:06 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard
Jun 20 22:26:06 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:06 rivoplus sudo[13633]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Jun 20 22:26:06 rivoplus sudo[13633]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:06 rivoplus sudo[13633]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:06 rivoplus sudo[13637]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Jun 20 22:26:06 rivoplus sudo[13637]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:06 rivoplus sudo[13637]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:06 rivoplus volumio[7538]: verbose: New Socket.io Connection to 192.168.1.15 from 192.168.1.2 UA: Mozilla/5.0 (Linux; Android 13; SO-51B Build/61.2.C.0.161; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/137.0.7151.89 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 11
Jun 20 22:26:06 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Jun 20 22:26:07 rivoplus sudo[13641]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Jun 20 22:26:07 rivoplus sudo[13641]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:07 rivoplus sudo[13641]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:07 rivoplus sudo[13645]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Jun 20 22:26:07 rivoplus sudo[13645]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache
Jun 20 22:26:07 rivoplus sudo[13645]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:07 rivoplus volumio[7538]: verbose: New Socket.io Connection to 192.168.1.15 from 192.168.1.2 UA: Mozilla/5.0 (Linux; Android 13; SO-51B Build/61.2.C.0.161; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/137.0.7151.89 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 12
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetVisibleSources
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
Jun 20 22:26:07 rivoplus volumio[7538]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom
Jun 20 22:26:07 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:26:07 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:07 rivoplus volumio[7538]: info: Listing playlists
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
Jun 20 22:26:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache
Jun 20 22:26:08 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard
Jun 20 22:26:09 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Jun 20 22:26:09 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:26:09 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:26:09 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:26:09 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:26:09 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:09 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:26:09 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Jun 20 22:26:09 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:26:09 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:26:09 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:26:09 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:26:09 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:09 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:26:13 rivoplus volumio[7538]: info: CoreCommandRouter::getUIConfigOnPlugin
Jun 20 22:26:13 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus
Jun 20 22:26:13 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getInfoNetwork
Jun 20 22:26:13 rivoplus sudo[13652]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ethtool eth0
Jun 20 22:26:13 rivoplus sudo[13652]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:13 rivoplus sudo[13652]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:13 rivoplus sudo[13657]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0
Jun 20 22:26:13 rivoplus sudo[13657]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:13 rivoplus sudo[13657]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:13 rivoplus sudo[13666]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0
Jun 20 22:26:13 rivoplus sudo[13666]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:13 rivoplus sudo[13666]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:13 rivoplus sudo[13672]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwconfig wlan0
Jun 20 22:26:13 rivoplus sudo[13672]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:13 rivoplus sudo[13672]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:13 rivoplus sudo[13690]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Jun 20 22:26:13 rivoplus sudo[13690]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:13 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworksScanCache
Jun 20 22:26:14 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getWirelessNetworks
Jun 20 22:26:14 rivoplus sudo[13690]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:14 rivoplus sudo[13694]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Jun 20 22:26:14 rivoplus sudo[13694]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:14 rivoplus sudo[13694]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:14 rivoplus sudo[13703]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan
Jun 20 22:26:14 rivoplus sudo[13703]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:14 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:14 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:14 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:14 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:14 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:14 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:14 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:14 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:14 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:14 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:14 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:14 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:15 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:15 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:15 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:15 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:16 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:16 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:16 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:17 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:17 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
Jun 20 22:26:17 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:17 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:17 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:17 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:17 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 8
Jun 20 22:26:18 rivoplus kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc050c3f000 drv_status 0x0 e_type 69 e_states 0
Jun 20 22:26:18 rivoplus sudo[13703]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:25 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
Jun 20 22:26:25 rivoplus volumio[7538]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined
Jun 20 22:26:25 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates
Jun 20 22:26:25 rivoplus volumio[7538]: info: Received Get System Version
Jun 20 22:26:25 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Jun 20 22:26:25 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:26:25 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:26:25 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:26:25 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:26:25 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:25 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:26:33 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:26:33 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:26:33 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:26:33 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:33 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:26:33 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:34 rivoplus sudo[13812]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Jun 20 22:26:34 rivoplus sudo[13812]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:34 rivoplus sudo[13812]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:34 rivoplus sudo[13816]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Jun 20 22:26:34 rivoplus sudo[13816]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:34 rivoplus sudo[13816]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:34 rivoplus volumio[7538]: verbose: New Socket.io Connection to 192.168.1.15 from 192.168.1.2 UA: Mozilla/5.0 (Linux; Android 13; SO-51B Build/61.2.C.0.161; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/137.0.7151.89 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 13
Jun 20 22:26:34 rivoplus sudo[13820]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Jun 20 22:26:34 rivoplus sudo[13820]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:34 rivoplus sudo[13820]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:34 rivoplus sudo[13824]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Jun 20 22:26:34 rivoplus sudo[13824]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:34 rivoplus sudo[13824]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:34 rivoplus volumio[7538]: verbose: New Socket.io Connection to 192.168.1.15 from 192.168.1.2 UA: Mozilla/5.0 (Linux; Android 13; SO-51B Build/61.2.C.0.161; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/137.0.7151.89 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 14
Jun 20 22:26:34 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Jun 20 22:26:34 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetVisibleSources
Jun 20 22:26:34 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Jun 20 22:26:34 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:34 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
Jun 20 22:26:34 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
Jun 20 22:26:34 rivoplus volumio[7538]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom
Jun 20 22:26:34 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:26:34 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:26:34 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:26:34 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:26:34 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:34 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:26:34 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:34 rivoplus volumio[7538]: info: Listing playlists
Jun 20 22:26:34 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings
Jun 20 22:26:34 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
Jun 20 22:26:35 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache
Jun 20 22:26:36 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard
Jun 20 22:26:36 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Jun 20 22:26:36 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:26:36 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:26:36 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:26:36 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:26:36 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:36 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:26:36 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetQueue
Jun 20 22:26:36 rivoplus volumio[7538]: info: CoreStateMachine::getQueue
Jun 20 22:26:36 rivoplus volumio[7538]: info: CorePlayQueue::getQueue
Jun 20 22:26:37 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Jun 20 22:26:37 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:26:37 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:26:37 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:26:37 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:26:37 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:37 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:26:38 rivoplus volumio[7538]: info: CoreCommandRouter::volumioPlay
Jun 20 22:26:38 rivoplus volumio[7538]: info: CoreStateMachine::play index 0
Jun 20 22:26:38 rivoplus volumio[7538]: info: CoreStateMachine::setConsumeUpdateService undefined
Jun 20 22:26:38 rivoplus volumio[7538]: info: CoreStateMachine::stop
Jun 20 22:26:38 rivoplus volumio[7538]: info: CoreStateMachine::setConsumeUpdateService undefined
Jun 20 22:26:38 rivoplus volumio[7538]: info: CoreStateMachine::play index undefined
Jun 20 22:26:38 rivoplus volumio[7538]: info: CoreStateMachine::setConsumeUpdateService undefined
Jun 20 22:26:38 rivoplus volumio[7538]: info: CorePlayQueue::getTrack 0
Jun 20 22:26:38 rivoplus volumio[7538]: info: CoreStateMachine::startPlaybackTimer
Jun 20 22:26:38 rivoplus volumio[7538]: info: CorePlayQueue::getTrack 0
Jun 20 22:26:38 rivoplus volumio[7538]: info: [1750425998898] ControllerUPNPBrowser::clearAddPlayTrack
Jun 20 22:26:38 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand stop
Jun 20 22:26:38 rivoplus volumio[7538]: info:
Jun 20 22:26:38 rivoplus volumio[7538]: ---------------------------- MPD announces state update: player
Jun 20 22:26:38 rivoplus volumio[7538]: info: sendMpdCommand stop took 19 milliseconds
Jun 20 22:26:38 rivoplus volumio[7538]: info: ControllerMpd::getState
Jun 20 22:26:38 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand status
Jun 20 22:26:38 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand clear
Jun 20 22:26:38 rivoplus volumio[7538]: info:
Jun 20 22:26:38 rivoplus volumio[7538]: ---------------------------- MPD announces system playlist update
Jun 20 22:26:38 rivoplus volumio[7538]: info: Ignoring MPD Status Update
Jun 20 22:26:38 rivoplus volumio[7538]: info: sendMpdCommand status took 3 milliseconds
Jun 20 22:26:38 rivoplus volumio[7538]: info: sendMpdCommand clear took 3 milliseconds
Jun 20 22:26:38 rivoplus volumio[7538]: verbose: ControllerMpd::parseState
Jun 20 22:26:38 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Jun 20 22:26:38 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand load "http://192.168.1.11:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I360715.wav"
Jun 20 22:26:38 rivoplus volumio[7538]: error: updateQueue error: null
Jun 20 22:26:38 rivoplus volumio[7538]: info: ------------------------------ 4ms
Jun 20 22:26:38 rivoplus volumio[7538]: info: sendMpdCommand playlistinfo took 3 milliseconds
Jun 20 22:26:38 rivoplus volumio[7538]: verbose: ControllerMpd::parseTrackInfo
Jun 20 22:26:38 rivoplus volumio[7538]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined
Jun 20 22:26:38 rivoplus volumio[7538]: info: ------------------------------ 9ms
Jun 20 22:26:38 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand add "http://192.168.1.11:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I360715.wav"
Jun 20 22:26:38 rivoplus volumio[7538]: info:
Jun 20 22:26:38 rivoplus volumio[7538]: ---------------------------- MPD announces system playlist update
Jun 20 22:26:38 rivoplus volumio[7538]: info: Ignoring MPD Status Update
Jun 20 22:26:38 rivoplus volumio[7538]: info: sendMpdCommand add "http://192.168.1.11:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I360715.wav" took 2 milliseconds
Jun 20 22:26:38 rivoplus volumio[7538]: info: CoreStateMachine::setConsumeUpdateService mpd
Jun 20 22:26:38 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand play
Jun 20 22:26:38 rivoplus volumio[7538]: info: ------------------------------ 2ms
Jun 20 22:26:38 rivoplus volumio[7538]: info: sendMpdCommand play took 3 milliseconds
Jun 20 22:26:39 rivoplus volumio[7538]: info:
Jun 20 22:26:39 rivoplus volumio[7538]: ---------------------------- MPD announces state update: player
Jun 20 22:26:39 rivoplus volumio[7538]: info: ControllerMpd::getState
Jun 20 22:26:39 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand status
Jun 20 22:26:39 rivoplus volumio[7538]: info:
Jun 20 22:26:39 rivoplus volumio[7538]: ---------------------------- MPD announces state update: player
Jun 20 22:26:39 rivoplus volumio[7538]: info: ControllerMpd::getState
Jun 20 22:26:39 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand status
Jun 20 22:26:39 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand clearerror
Jun 20 22:26:39 rivoplus volumio[7538]: info: sendMpdCommand status took 14 milliseconds
Jun 20 22:26:39 rivoplus volumio[7538]: verbose: ControllerMpd::parseState
Jun 20 22:26:39 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Jun 20 22:26:39 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand clearerror
Jun 20 22:26:39 rivoplus volumio[7538]: info: sendMpdCommand status took 20 milliseconds
Jun 20 22:26:39 rivoplus volumio[7538]: info: sendMpdCommand clearerror took 8 milliseconds
Jun 20 22:26:39 rivoplus volumio[7538]: info: sendMpdCommand playlistinfo took 7 milliseconds
Jun 20 22:26:39 rivoplus volumio[7538]: verbose: ControllerMpd::parseState
Jun 20 22:26:39 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Jun 20 22:26:39 rivoplus volumio[7538]: verbose: ControllerMpd::parseTrackInfo
Jun 20 22:26:39 rivoplus volumio[7538]: info: ControllerMpd::pushState
Jun 20 22:26:39 rivoplus volumio[7538]: info: CoreCommandRouter::servicePushState
Jun 20 22:26:39 rivoplus volumio[7538]: info: CorePlayQueue::getTrack 0
Jun 20 22:26:39 rivoplus volumio[7538]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":0,"duration":282,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"O0$1$8I360715.wav","artist":null,"album":null,"uri":"http://192.168.1.11:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I360715.wav","trackType":"wav"}
Jun 20 22:26:39 rivoplus volumio[7538]: verbose: CURRENT POSITION 0
Jun 20 22:26:39 rivoplus volumio[7538]: info: CoreStateMachine::syncState stateService pause
Jun 20 22:26:39 rivoplus volumio[7538]: info: CoreStateMachine::syncState currentStatus stop
Jun 20 22:26:39 rivoplus volumio[7538]: info: CoreStateMachine::pushState
Jun 20 22:26:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Jun 20 22:26:39 rivoplus volumio[7538]: info: CoreCommandRouter::volumioPushState
Jun 20 22:26:39 rivoplus volumio[7538]: info: MRS: Pushing multiroomSync output update for this device
Jun 20 22:26:39 rivoplus volumio[7538]: info: MRS: Pushing multiroomSync output
Jun 20 22:26:39 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:39 rivoplus volumio[7538]: info: ------------------------------ 44ms
Jun 20 22:26:39 rivoplus volumio[7538]: error: Cannot write to RAAT Client: TypeError: Cannot read property 'write' of undefined
Jun 20 22:26:39 rivoplus volumio[7538]: info: Updating RAAT Signal Path
Jun 20 22:26:39 rivoplus volumio[7538]: error: Cannot write to RAAT Client: TypeError: Cannot read property 'write' of undefined
Jun 20 22:26:39 rivoplus volumio[7538]: info: sendMpdCommand clearerror took 40 milliseconds
Jun 20 22:26:39 rivoplus volumio[7538]: info: sendMpdCommand playlistinfo took 39 milliseconds
Jun 20 22:26:39 rivoplus volumio[7538]: verbose: ControllerMpd::parseTrackInfo
Jun 20 22:26:39 rivoplus volumio[7538]: info: ControllerMpd::pushState
Jun 20 22:26:39 rivoplus volumio[7538]: info: CoreCommandRouter::servicePushState
Jun 20 22:26:39 rivoplus volumio[7538]: info: CorePlayQueue::getTrack 0
Jun 20 22:26:39 rivoplus volumio[7538]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":0,"duration":282,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"O0$1$8I360715.wav","artist":null,"album":null,"uri":"http://192.168.1.11:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I360715.wav","trackType":"wav"}
Jun 20 22:26:39 rivoplus volumio[7538]: verbose: CURRENT POSITION 0
Jun 20 22:26:39 rivoplus volumio[7538]: info: CoreStateMachine::syncState stateService pause
Jun 20 22:26:39 rivoplus volumio[7538]: info: CoreStateMachine::syncState currentStatus stop
Jun 20 22:26:39 rivoplus volumio[7538]: info: CoreStateMachine::pushState
Jun 20 22:26:39 rivoplus volumio[7538]: info: CoreCommandRouter::volumioPushState
Jun 20 22:26:39 rivoplus volumio[7538]: info: MRS: Pushing multiroomSync output update for this device
Jun 20 22:26:39 rivoplus volumio[7538]: info: MRS: Pushing multiroomSync output
Jun 20 22:26:39 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:39 rivoplus volumio[7538]: info: ------------------------------ 78ms
Jun 20 22:26:39 rivoplus volumio[7538]: error: Cannot update RT Device info: Error: Reference.set failed: First argument contains undefined in property 'user_devices.DkIZnf2HcKdrMVcR4eWOlDPcj1h2.0a194fcdc28ae887328379643047b3f1.state.status'
Jun 20 22:26:39 rivoplus volumio[7538]: error: Cannot write to RAAT Client: TypeError: Cannot read property 'write' of undefined
Jun 20 22:26:39 rivoplus volumio[7538]: info: Updating RAAT Signal Path
Jun 20 22:26:39 rivoplus volumio[7538]: error: Cannot write to RAAT Client: TypeError: Cannot read property 'write' of undefined
Jun 20 22:26:39 rivoplus volumio[7538]: error: Failed to parse state for serial connection: TypeError: Cannot read property 'toUpperCase' of undefined
Jun 20 22:26:41 rivoplus volumio[7538]: info: Executing endpoint metavolumio
Jun 20 22:26:41 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
Jun 20 22:26:44 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
Jun 20 22:26:48 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: multiroom , enableAudioOutput
Jun 20 22:26:48 rivoplus volumio[7538]: info: MRS: Starting browser stream
Jun 20 22:26:48 rivoplus volumio[7538]: info: MRS: Setting this device as Streaming Server
Jun 20 22:26:48 rivoplus volumio[7538]: info:
Jun 20 22:26:48 rivoplus volumio[7538]: [1750426008572] ---------------------------- MRS: Setting Streaming Server
Jun 20 22:26:48 rivoplus volumio[7538]: info: Enabled audio output: browserPlayback
Jun 20 22:26:48 rivoplus volumio[7538]: info: MRS: enable multiroom server output
Jun 20 22:26:48 rivoplus volumio[7538]: info: MRS: Set multiroom target PCM to volumioMultiRoom
Jun 20 22:26:48 rivoplus volumio[7538]: info: Changed audio target for /tmp/multiroom/server/switch.target to volumioMultiRoom
Jun 20 22:26:48 rivoplus volumio[7538]: info: MRS: Set multiroom target PCM to volumioLocalPlayback
Jun 20 22:26:48 rivoplus volumio[7538]: info: Changed audio target for /tmp/multiroom/client/switch.target to volumioLocalPlayback
Jun 20 22:26:48 rivoplus volumio[7538]: info: MRS: STARTING volumioStreaming
Jun 20 22:26:48 rivoplus sudo[13864]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/rm -f /tmp/hls/*
Jun 20 22:26:48 rivoplus sudo[13864]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:48 rivoplus sudo[13864]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:48 rivoplus sudo[13867]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumioStreaming
Jun 20 22:26:48 rivoplus sudo[13867]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:48 rivoplus systemd[1]: Started VolumioStreamingService.
Jun 20 22:26:48 rivoplus sudo[13867]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:48 rivoplus volumio[7538]: info: MRS: volumioStreaming STARTED
Jun 20 22:26:48 rivoplus sudo[13872]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/rm -f /tmp/hls/*
Jun 20 22:26:48 rivoplus sudo[13872]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:48 rivoplus sudo[13872]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:53 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
Jun 20 22:26:53 rivoplus volumio[7538]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined
Jun 20 22:26:53 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates
Jun 20 22:26:53 rivoplus volumio[7538]: info: Received Get System Version
Jun 20 22:26:53 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Jun 20 22:26:53 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:26:53 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:26:53 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:26:53 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:26:53 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:53 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: multiroom , disableAudioOutput
Jun 20 22:26:55 rivoplus volumio[7538]: info: MRS: Starting browser stream
Jun 20 22:26:55 rivoplus volumio[7538]: info: MRS: Setting this device as single
Jun 20 22:26:55 rivoplus volumio[7538]: info:
Jun 20 22:26:55 rivoplus volumio[7538]: [1750426015059] ---------------------------- Setting Multiroom Single
Jun 20 22:26:55 rivoplus volumio[7538]: info: MRS: disable multiroom output
Jun 20 22:26:55 rivoplus volumio[7538]: info: MRS: Set multiroom target PCM to volumioDiscard
Jun 20 22:26:55 rivoplus volumio[7538]: info: Changed audio target for /tmp/multiroom/client/switch.target to volumioDiscard
Jun 20 22:26:55 rivoplus volumio[7538]: verbose: New Socket.io Connection to 192.168.1.15 from 192.168.1.2 UA: Mozilla/5.0 (Linux; Android 13; SO-51B Build/61.2.C.0.161; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/137.0.7151.89 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 14
Jun 20 22:26:55 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:26:55 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetVisibleSources
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
Jun 20 22:26:55 rivoplus volumio[7538]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom
Jun 20 22:26:55 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:26:55 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:55 rivoplus volumio[7538]: info: Listing playlists
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetQueue
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreStateMachine::getQueue
Jun 20 22:26:55 rivoplus volumio[7538]: info: CorePlayQueue::getQueue
Jun 20 22:26:55 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache
Jun 20 22:26:55 rivoplus volumio[7538]: info: MRS: Set multiroom target PCM to volumioLocalPlayback
Jun 20 22:26:55 rivoplus volumio[7538]: info: Changed audio target for /tmp/multiroom/server/switch.target to volumioLocalPlayback
Jun 20 22:26:56 rivoplus volumio[7538]: info: MRS: STOPPING volumioStreaming
Jun 20 22:26:56 rivoplus sudo[13903]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioStreaming
Jun 20 22:26:56 rivoplus sudo[13903]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:56 rivoplus sudo[13904]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/rm -f /tmp/hls/*
Jun 20 22:26:56 rivoplus sudo[13904]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:26:56 rivoplus systemd[1]: Stopping VolumioStreamingService...
Jun 20 22:26:56 rivoplus systemd[1]: volumioStreaming.service: Main process exited, code=killed, status=15/TERM
Jun 20 22:26:56 rivoplus volumio[7538]: ------------------------------------ BT MESSAGE: BT STATUS: running
Jun 20 22:26:56 rivoplus sudo[13904]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:56 rivoplus systemd[1]: volumioStreaming.service: Succeeded.
Jun 20 22:26:56 rivoplus systemd[1]: Stopped VolumioStreamingService.
Jun 20 22:26:56 rivoplus volumio[7538]: info: MRS: Removed streaming files
Jun 20 22:26:56 rivoplus sudo[13903]: pam_unix(sudo:session): session closed for user root
Jun 20 22:26:56 rivoplus volumio[7538]: info: MRS: volumioStreaming STOPPED
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreCommandRouter::volumioPlay
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreStateMachine::play index 0
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreStateMachine::setConsumeUpdateService undefined
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreStateMachine::stop
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreStateMachine::setConsumeUpdateService undefined
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreStateMachine::play index undefined
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreStateMachine::setConsumeUpdateService undefined
Jun 20 22:26:58 rivoplus volumio[7538]: info: CorePlayQueue::getTrack 0
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreStateMachine::startPlaybackTimer
Jun 20 22:26:58 rivoplus volumio[7538]: info: CorePlayQueue::getTrack 0
Jun 20 22:26:58 rivoplus volumio[7538]: info: [1750426018173] ControllerUPNPBrowser::clearAddPlayTrack
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand stop
Jun 20 22:26:58 rivoplus volumio[7538]: info:
Jun 20 22:26:58 rivoplus volumio[7538]: ---------------------------- MPD announces state update: player
Jun 20 22:26:58 rivoplus volumio[7538]: info: sendMpdCommand stop took 18 milliseconds
Jun 20 22:26:58 rivoplus volumio[7538]: info: ControllerMpd::getState
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand status
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand clear
Jun 20 22:26:58 rivoplus volumio[7538]: info:
Jun 20 22:26:58 rivoplus volumio[7538]: ---------------------------- MPD announces system playlist update
Jun 20 22:26:58 rivoplus volumio[7538]: info: Ignoring MPD Status Update
Jun 20 22:26:58 rivoplus volumio[7538]: info: sendMpdCommand status took 3 milliseconds
Jun 20 22:26:58 rivoplus volumio[7538]: info: sendMpdCommand clear took 3 milliseconds
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::parseState
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand load "http://192.168.1.11:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I360715.wav"
Jun 20 22:26:58 rivoplus volumio[7538]: error: updateQueue error: null
Jun 20 22:26:58 rivoplus volumio[7538]: info: ------------------------------ 4ms
Jun 20 22:26:58 rivoplus volumio[7538]: info: sendMpdCommand playlistinfo took 2 milliseconds
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::parseTrackInfo
Jun 20 22:26:58 rivoplus volumio[7538]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined
Jun 20 22:26:58 rivoplus volumio[7538]: info: ------------------------------ 9ms
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand add "http://192.168.1.11:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I360715.wav"
Jun 20 22:26:58 rivoplus volumio[7538]: info:
Jun 20 22:26:58 rivoplus volumio[7538]: ---------------------------- MPD announces system playlist update
Jun 20 22:26:58 rivoplus volumio[7538]: info: Ignoring MPD Status Update
Jun 20 22:26:58 rivoplus volumio[7538]: info: sendMpdCommand add "http://192.168.1.11:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I360715.wav" took 2 milliseconds
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreStateMachine::setConsumeUpdateService mpd
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand play
Jun 20 22:26:58 rivoplus volumio[7538]: info: ------------------------------ 3ms
Jun 20 22:26:58 rivoplus volumio[7538]: info: sendMpdCommand play took 2 milliseconds
Jun 20 22:26:58 rivoplus volumio[7538]: info:
Jun 20 22:26:58 rivoplus volumio[7538]: ---------------------------- MPD announces state update: player
Jun 20 22:26:58 rivoplus volumio[7538]: info: ControllerMpd::getState
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand status
Jun 20 22:26:58 rivoplus volumio[7538]: info:
Jun 20 22:26:58 rivoplus volumio[7538]: ---------------------------- MPD announces state update: player
Jun 20 22:26:58 rivoplus volumio[7538]: info: ControllerMpd::getState
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand status
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand clearerror
Jun 20 22:26:58 rivoplus volumio[7538]: info: sendMpdCommand status took 14 milliseconds
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::parseState
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand clearerror
Jun 20 22:26:58 rivoplus volumio[7538]: info: sendMpdCommand status took 19 milliseconds
Jun 20 22:26:58 rivoplus volumio[7538]: info: sendMpdCommand clearerror took 8 milliseconds
Jun 20 22:26:58 rivoplus volumio[7538]: info: sendMpdCommand playlistinfo took 6 milliseconds
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::parseState
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::parseTrackInfo
Jun 20 22:26:58 rivoplus volumio[7538]: info: ControllerMpd::pushState
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreCommandRouter::servicePushState
Jun 20 22:26:58 rivoplus volumio[7538]: info: CorePlayQueue::getTrack 0
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":0,"duration":282,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"O0$1$8I360715.wav","artist":null,"album":null,"uri":"http://192.168.1.11:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I360715.wav","trackType":"wav"}
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: CURRENT POSITION 0
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreStateMachine::syncState stateService pause
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreStateMachine::syncState currentStatus stop
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreStateMachine::pushState
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreCommandRouter::volumioPushState
Jun 20 22:26:58 rivoplus volumio[7538]: info: MRS: Pushing multiroomSync output update for this device
Jun 20 22:26:58 rivoplus volumio[7538]: info: MRS: Pushing multiroomSync output
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:58 rivoplus volumio[7538]: info: ------------------------------ 54ms
Jun 20 22:26:58 rivoplus volumio[7538]: error: Cannot write to RAAT Client: TypeError: Cannot read property 'write' of undefined
Jun 20 22:26:58 rivoplus volumio[7538]: info: Updating RAAT Signal Path
Jun 20 22:26:58 rivoplus volumio[7538]: error: Cannot write to RAAT Client: TypeError: Cannot read property 'write' of undefined
Jun 20 22:26:58 rivoplus volumio[7538]: info: sendMpdCommand clearerror took 57 milliseconds
Jun 20 22:26:58 rivoplus volumio[7538]: info: sendMpdCommand playlistinfo took 56 milliseconds
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: ControllerMpd::parseTrackInfo
Jun 20 22:26:58 rivoplus volumio[7538]: info: ControllerMpd::pushState
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreCommandRouter::servicePushState
Jun 20 22:26:58 rivoplus volumio[7538]: info: CorePlayQueue::getTrack 0
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":0,"duration":282,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"O0$1$8I360715.wav","artist":null,"album":null,"uri":"http://192.168.1.11:9000/disk/NON-DLNA-OP01-FLAGS01700000/O0$1$8I360715.wav","trackType":"wav"}
Jun 20 22:26:58 rivoplus volumio[7538]: verbose: CURRENT POSITION 0
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreStateMachine::syncState stateService pause
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreStateMachine::syncState currentStatus stop
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreStateMachine::pushState
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreCommandRouter::volumioPushState
Jun 20 22:26:58 rivoplus volumio[7538]: info: MRS: Pushing multiroomSync output update for this device
Jun 20 22:26:58 rivoplus volumio[7538]: info: MRS: Pushing multiroomSync output
Jun 20 22:26:58 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:26:58 rivoplus volumio[7538]: info: ------------------------------ 98ms
Jun 20 22:26:58 rivoplus volumio[7538]: error: Cannot update RT Device info: Error: Reference.set failed: First argument contains undefined in property 'user_devices.DkIZnf2HcKdrMVcR4eWOlDPcj1h2.0a194fcdc28ae887328379643047b3f1.state.status'
Jun 20 22:26:58 rivoplus volumio[7538]: error: Cannot write to RAAT Client: TypeError: Cannot read property 'write' of undefined
Jun 20 22:26:58 rivoplus volumio[7538]: info: Updating RAAT Signal Path
Jun 20 22:26:58 rivoplus volumio[7538]: error: Cannot write to RAAT Client: TypeError: Cannot read property 'write' of undefined
Jun 20 22:26:58 rivoplus volumio[7538]: error: Failed to parse state for serial connection: TypeError: Cannot read property 'toUpperCase' of undefined
Jun 20 22:27:00 rivoplus volumio[7538]: info: Executing endpoint metavolumio
Jun 20 22:27:00 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
Jun 20 22:27:03 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:27:03 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:27:03 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:27:03 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:03 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:27:04 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:04 rivoplus sudo[13917]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Jun 20 22:27:04 rivoplus sudo[13917]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:04 rivoplus sudo[13917]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:04 rivoplus sudo[13924]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Jun 20 22:27:04 rivoplus sudo[13924]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:04 rivoplus sudo[13924]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:04 rivoplus volumio[7538]: verbose: New Socket.io Connection to 192.168.1.15 from 192.168.1.2 UA: Mozilla/5.0 (Linux; Android 13; SO-51B Build/61.2.C.0.161; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/137.0.7151.89 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 12
Jun 20 22:27:04 rivoplus sudo[13942]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Jun 20 22:27:04 rivoplus sudo[13942]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:04 rivoplus sudo[13942]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:04 rivoplus sudo[13946]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Jun 20 22:27:04 rivoplus sudo[13946]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:04 rivoplus sudo[13946]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:04 rivoplus volumio[7538]: verbose: New Socket.io Connection to 192.168.1.15 from 192.168.1.2 UA: Mozilla/5.0 (Linux; Android 13; SO-51B Build/61.2.C.0.161; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/137.0.7151.89 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 13
Jun 20 22:27:04 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Jun 20 22:27:04 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetVisibleSources
Jun 20 22:27:04 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Jun 20 22:27:04 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:04 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
Jun 20 22:27:04 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
Jun 20 22:27:05 rivoplus volumio[7538]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom
Jun 20 22:27:05 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:27:05 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:27:05 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:27:05 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:27:05 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:05 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:27:05 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:05 rivoplus volumio[7538]: info: Listing playlists
Jun 20 22:27:05 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings
Jun 20 22:27:05 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
Jun 20 22:27:05 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache
Jun 20 22:27:06 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard
Jun 20 22:27:06 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Jun 20 22:27:06 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:27:06 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:27:06 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:27:06 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:27:06 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:06 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:27:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Jun 20 22:27:07 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:27:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:27:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:27:07 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:27:07 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:07 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:27:11 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Jun 20 22:27:11 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken
Jun 20 22:27:14 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
Jun 20 22:27:20 rivoplus volumio[7538]: info: Downloading plugin at https://plugins.volumio.workers.dev/pluginsv2/downloadLatestStable/fusiondsp/rivoplus/buster/armhf
Jun 20 22:27:24 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
Jun 20 22:27:24 rivoplus volumio[7538]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined
Jun 20 22:27:24 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates
Jun 20 22:27:24 rivoplus volumio[7538]: info: Received Get System Version
Jun 20 22:27:24 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Jun 20 22:27:24 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:27:24 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:27:24 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:27:24 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:27:24 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:24 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:27:26 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:26 rivoplus sudo[14035]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Jun 20 22:27:26 rivoplus sudo[14035]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:26 rivoplus sudo[14035]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:26 rivoplus sudo[14038]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Jun 20 22:27:26 rivoplus sudo[14038]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:26 rivoplus sudo[14038]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:26 rivoplus volumio[7538]: verbose: New Socket.io Connection to 192.168.1.15 from 192.168.1.2 UA: Mozilla/5.0 (Linux; Android 13; SO-51B Build/61.2.C.0.161; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/137.0.7151.89 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 14
Jun 20 22:27:26 rivoplus sudo[14043]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Jun 20 22:27:26 rivoplus sudo[14043]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:26 rivoplus sudo[14043]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:26 rivoplus sudo[14047]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Jun 20 22:27:26 rivoplus sudo[14047]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:26 rivoplus sudo[14047]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:26 rivoplus volumio[7538]: verbose: New Socket.io Connection to 192.168.1.15 from 192.168.1.2 UA: Mozilla/5.0 (Linux; Android 13; SO-51B Build/61.2.C.0.161; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/137.0.7151.89 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 15
Jun 20 22:27:26 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Jun 20 22:27:26 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetVisibleSources
Jun 20 22:27:26 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Jun 20 22:27:26 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:26 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
Jun 20 22:27:26 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
Jun 20 22:27:26 rivoplus volumio[7538]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom
Jun 20 22:27:26 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:27:26 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:27:26 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:27:26 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:27:26 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:26 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:27:26 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:26 rivoplus volumio[7538]: info: Listing playlists
Jun 20 22:27:26 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings
Jun 20 22:27:26 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
Jun 20 22:27:27 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache
Jun 20 22:27:28 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard
Jun 20 22:27:28 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Jun 20 22:27:28 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:27:28 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:27:28 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:27:28 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:27:28 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:28 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:27:29 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Jun 20 22:27:29 rivoplus volumio[7538]: info: Received Get System Info
Jun 20 22:27:29 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:27:29 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:27:29 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:27:29 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:29 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:27:29 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
Jun 20 22:27:29 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken
Jun 20 22:27:31 rivoplus volumio[7538]: info: END DOWNLOAD: https://plugins.volumio.workers.dev/pluginsv2/downloadLatestStable/fusiondsp/rivoplus/buster/armhf
Jun 20 22:27:31 rivoplus volumio[7538]: info: Check plugin dependencies
Jun 20 22:27:31 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Jun 20 22:27:31 rivoplus volumio[7538]: info: Rename folder
Jun 20 22:27:31 rivoplus volumio[7538]: info: Folder /tmp/downloaded_plugin.zip removed
Jun 20 22:27:31 rivoplus volumio[7538]: info: Move to category
Jun 20 22:27:32 rivoplus volumio[7538]: info: Checking if install.sh is present
Jun 20 22:27:32 rivoplus volumio[7538]: info: Executing install.sh
Jun 20 22:27:32 rivoplus sudo[14064]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/sh /data/plugins/audio_interface/fusiondsp/install.sh
Jun 20 22:27:32 rivoplus sudo[14064]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:32 rivoplus volumio[7538]: info: creating filters folder and copying demo filters
Jun 20 22:27:32 rivoplus volumio[7538]: info: copying demo flters
Jun 20 22:27:32 rivoplus volumio[7538]: info: Installing/fusiondsp dependencies
Jun 20 22:27:32 rivoplus sudo[14085]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/apt update
Jun 20 22:27:32 rivoplus sudo[14085]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:33 rivoplus volumio[7538]: info: Hit:1 http://deb.debian.org/debian buster InRelease
Jun 20 22:27:33 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Jun 20 22:27:33 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Jun 20 22:27:33 rivoplus volumio[7538]: info: Discovery: Getting this device information
Jun 20 22:27:33 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:33 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:27:33 rivoplus volumio[7538]: info: Hit:2 https://deb.nodesource.com/node_14.x buster InRelease
Jun 20 22:27:36 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
Jun 20 22:27:37 rivoplus volumio[7538]: info: Enabling plugin fusiondsp
Jun 20 22:27:37 rivoplus volumio[7538]: info: Loading plugin "fusiondsp"...
Jun 20 22:27:38 rivoplus volumio[7538]: info: Preparing to generate the ALSA configuration file
Jun 20 22:27:38 rivoplus volumio[7538]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf
Jun 20 22:27:38 rivoplus volumio[7538]: info: Reading ALSA contributions from plugins.
Jun 20 22:27:38 rivoplus volumio[7538]: info: Asound.conf file unchanged, so no further update is needed
Jun 20 22:27:38 rivoplus volumio[7538]: info: Output device has changed, restarting MPD
Jun 20 22:27:38 rivoplus volumio[7538]: info: Output device has changed, restarting Shairport Sync
Jun 20 22:27:38 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:38 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Jun 20 22:27:38 rivoplus sudo[14335]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf
Jun 20 22:27:38 rivoplus sudo[14335]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:38 rivoplus sudo[14335]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:38 rivoplus sudo[14337]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service
Jun 20 22:27:38 rivoplus sudo[14337]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:38 rivoplus systemd[1]: Stopping Music Player Daemon...
Jun 20 22:27:38 rivoplus volumio[7538]: No protocol specified
Jun 20 22:27:38 rivoplus volumio[7538]: xcb_connection_has_error() returned true
Jun 20 22:27:38 rivoplus volumio[7538]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0
Jun 20 22:27:38 rivoplus volumio[7538]: No protocol specified
Jun 20 22:27:38 rivoplus volumio[7538]: xcb_connection_has_error() returned true
Jun 20 22:27:38 rivoplus volumio[7538]: info: Reconfiguring and Restarting RAAT Plugin due to audio device changes
Jun 20 22:27:38 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:38 rivoplus volumio[7538]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration
Jun 20 22:27:38 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:38 rivoplus volumio[7538]: info: Output device has changed, restarting Shairport Sync
Jun 20 22:27:38 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:38 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Jun 20 22:27:38 rivoplus volumio[7538]: No protocol specified
Jun 20 22:27:38 rivoplus volumio[7538]: xcb_connection_has_error() returned true
Jun 20 22:27:38 rivoplus volumio[7538]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0
Jun 20 22:27:38 rivoplus volumio[7538]: No protocol specified
Jun 20 22:27:38 rivoplus volumio[7538]: xcb_connection_has_error() returned true
Jun 20 22:27:38 rivoplus volumio[7538]: info: QobuzConnect: setDeactiveState invoked
Jun 20 22:27:38 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:38 rivoplus vtcs[13258]: [2025-06-20 22:27:38.833] [tisoc] [warning] [SessionManagerImpl.cpp:240] Illegal State: IDLE
Jun 20 22:27:38 rivoplus vtcs[13258]: [2025-06-20 22:27:38.829] [tisoc] [error] [SpkconServer.cpp:375] recv error. socket disconnected
Jun 20 22:27:38 rivoplus systemd[1]: mpd.service: Succeeded.
Jun 20 22:27:38 rivoplus systemd[1]: Stopped Music Player Daemon.
Jun 20 22:27:38 rivoplus volumio[7538]: info: PLUGIN START: fusiondsp
Jun 20 22:27:38 rivoplus systemd[1]: Starting Music Player Daemon...
Jun 20 22:27:38 rivoplus volumio[7538]: info: Loading i18n strings for locale ja
Jun 20 22:27:38 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , updateALSAConfigFile
Jun 20 22:27:38 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:38 rivoplus volumio[7538]: info: FusionDsp - mixtype--------------------- undefined
Jun 20 22:27:38 rivoplus sudo[14349]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service
Jun 20 22:27:38 rivoplus sudo[14349]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:38 rivoplus volumio[7538]: info: Preparing to generate the ALSA configuration file
Jun 20 22:27:38 rivoplus volumio[7538]: info: Done.
Jun 20 22:27:38 rivoplus systemd[1]: Stopping Volumio Tidal Connect Service...
Jun 20 22:27:38 rivoplus systemd[1]: vtcs.service: Main process exited, code=killed, status=15/TERM
Jun 20 22:27:38 rivoplus systemd[1]: vtcs.service: Succeeded.
Jun 20 22:27:38 rivoplus systemd[1]: Stopped Volumio Tidal Connect Service.
Jun 20 22:27:38 rivoplus sudo[14349]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:39 rivoplus sudo[14354]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service
Jun 20 22:27:39 rivoplus sudo[14354]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:39 rivoplus sudo[14350]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log
Jun 20 22:27:39 rivoplus sudo[14350]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:39 rivoplus sudo[14354]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:39 rivoplus sudo[14350]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:39 rivoplus volumio[7538]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf
Jun 20 22:27:39 rivoplus volumio[7538]: info: Reading ALSA contributions from plugins.
Jun 20 22:27:39 rivoplus volumio[7538]: ------------------------------------ BT MESSAGE: BT STATUS: running
Jun 20 22:27:39 rivoplus volumio[7538]: ------------------------------------ BT MESSAGE: BT STATUS: waiting
Jun 20 22:27:39 rivoplus volumio[7538]: ------------------------------------ BT MESSAGE: BT STATUS: running
Jun 20 22:27:39 rivoplus volumio[7538]: ------------------------------------ BT MESSAGE: BT STATUS: running
Jun 20 22:27:39 rivoplus sudo[14362]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service
Jun 20 22:27:39 rivoplus sudo[14362]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::getUIConfigOnPlugin
Jun 20 22:27:39 rivoplus volumio[7538]: error: Failed to parse min max audio card capabilities, sending default vales: TypeError: Cannot read property 'split' of undefined
Jun 20 22:27:39 rivoplus volumio[7538]: info: MPD Permissions set
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:39 rivoplus sudo[14362]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:39 rivoplus sudo[14365]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service
Jun 20 22:27:39 rivoplus sudo[14365]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:39 rivoplus qobuz-connect[13248]: 20250620 22:27:39.202 [13248.13248] INFO SampleApp: Stopping Local configuration server
Jun 20 22:27:39 rivoplus systemd[1]: Stopping Volumio Qobuz Connect Service...
Jun 20 22:27:39 rivoplus qobuz-connect[13248]: 20250620 22:27:39.213 [13248.13248] INFO SampleApp: shat down connection on UNIX socket
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getCPUCoresNumber
Jun 20 22:27:39 rivoplus systemd[1]: qobuz-connect.service: Succeeded.
Jun 20 22:27:39 rivoplus systemd[1]: Stopped Volumio Qobuz Connect Service.
Jun 20 22:27:39 rivoplus systemd[1]: Started Volumio Qobuz Connect Service.
Jun 20 22:27:39 rivoplus sudo[14365]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Jun 20 22:27:39 rivoplus volumio[7538]: info: Not Reporting Auto name since its the default one
Jun 20 22:27:39 rivoplus volumio[7538]: ------------------------------------ BT MESSAGE: BT STATUS: running
Jun 20 22:27:39 rivoplus volumio[7538]: ------------------------------------ BT MESSAGE: BT STATUS: waiting
Jun 20 22:27:39 rivoplus volumio[7538]: info: QobuzConnect: Qobuz Connect client [object Object] disconnected
Jun 20 22:27:39 rivoplus volumio[7538]: info: QobuzConnect: setDeactiveState invoked
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:39 rivoplus volumio[7538]: info: Starting Shairport Sync
Jun 20 22:27:39 rivoplus volumio[7538]: info: Starting Shairport Sync
Jun 20 22:27:39 rivoplus sudo[14382]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync
Jun 20 22:27:39 rivoplus sudo[14382]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:39 rivoplus volumio[7538]: info: Executing endpoint qc_getconfig
Jun 20 22:27:39 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: qobuzconnect , onGetConfig
Jun 20 22:27:40 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkCurrentAudioDeviceAvailable
Jun 20 22:27:40 rivoplus qobuz-connect[14372]: 20250620 22:27:40.038 [14372.14372] INFO SampleApp: Started connection to /tmp/qbz-connect.socket UNIX socket
Jun 20 22:27:40 rivoplus sudo[14386]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync
Jun 20 22:27:40 rivoplus sudo[14386]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:40 rivoplus qobuz-connect[14372]: 20250620 22:27:40.080 [14372.14372] INFO VolumeManager: [0xab18e240]: Setting new playback volume: 75
Jun 20 22:27:40 rivoplus qobuz-connect[14372]: 20250620 22:27:40.080 [14372.14372] INFO VolumeManager: [0xab18e240]: Setting new mute state: 0
Jun 20 22:27:40 rivoplus qobuz-connect[14372]: 20250620 22:27:40.081 [14372.14372] INFO QobuzConnect: [0xab18ec10]: Client initialized!
Jun 20 22:27:40 rivoplus qobuz-connect[14372]: 20250620 22:27:40.081 [14372.14372] INFO SampleApp: Starting Avahi advertising, name: Rivoplus, service name: _qobuz-connect._tcp
Jun 20 22:27:40 rivoplus systemd[1]: Started Shairport Sync - AirPlay Audio Receiver.
Jun 20 22:27:40 rivoplus sudo[14382]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:40 rivoplus qobuz-connect[14372]: 20250620 22:27:40.146 [14372.14372] INFO LocalConfigManager: [0xab18db20]: Starting Local Configuration server
Jun 20 22:27:40 rivoplus qobuz-connect[14372]: 20250620 22:27:40.146 [14372.14372] INFO SampleApp: Starting Local configuration server
Jun 20 22:27:40 rivoplus qobuz-connect[14372]: 20250620 22:27:40.147 [14372.14372] INFO SampleApp: Connected to UNIX socket client 0xab183ed8
Jun 20 22:27:40 rivoplus qobuz-connect[14372]: 20250620 22:27:40.154 [14372.14372] INFO SampleApp: Playback volume changed: 75
Jun 20 22:27:40 rivoplus systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver...
Jun 20 22:27:40 rivoplus systemd[1]: shairport-sync.service: Main process exited, code=killed, status=15/TERM
Jun 20 22:27:40 rivoplus systemd[1]: shairport-sync.service: Succeeded.
Jun 20 22:27:40 rivoplus systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver.
Jun 20 22:27:40 rivoplus systemd[1]: Started Shairport Sync - AirPlay Audio Receiver.
Jun 20 22:27:40 rivoplus sudo[14386]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:40 rivoplus volumio[7538]: No protocol specified
Jun 20 22:27:40 rivoplus volumio[7538]: xcb_connection_has_error() returned true
Jun 20 22:27:40 rivoplus volumio[7538]: info: Configured Audio card not found, not starting RAAT
Jun 20 22:27:40 rivoplus volumio[7538]: info: Asound.conf file unchanged, so no further update is needed
Jun 20 22:27:40 rivoplus volumio[7538]: info: Output device has changed, restarting MPD
Jun 20 22:27:40 rivoplus sudo[14395]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf
Jun 20 22:27:40 rivoplus sudo[14395]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:40 rivoplus sudo[14395]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:40 rivoplus sudo[14399]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service
Jun 20 22:27:40 rivoplus sudo[14399]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:40 rivoplus volumio[7538]: info: Output device has changed, restarting Shairport Sync
Jun 20 22:27:40 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:40 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Jun 20 22:27:40 rivoplus systemd[1]: mpd.service: Main process exited, code=killed, status=15/TERM
Jun 20 22:27:40 rivoplus systemd[1]: mpd.service: Succeeded.
Jun 20 22:27:40 rivoplus systemd[1]: Stopped Music Player Daemon.
Jun 20 22:27:40 rivoplus systemd[1]: Starting Music Player Daemon...
Jun 20 22:27:40 rivoplus volumio[7538]: No protocol specified
Jun 20 22:27:40 rivoplus volumio[7538]: xcb_connection_has_error() returned true
Jun 20 22:27:40 rivoplus volumio[7538]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0
Jun 20 22:27:40 rivoplus volumio[7538]: No protocol specified
Jun 20 22:27:40 rivoplus volumio[7538]: xcb_connection_has_error() returned true
Jun 20 22:27:40 rivoplus volumio[7538]: info: Reconfiguring and Restarting RAAT Plugin due to audio device changes
Jun 20 22:27:40 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:40 rivoplus volumio[7538]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration
Jun 20 22:27:40 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:40 rivoplus volumio[7538]: info: Output device has changed, restarting Shairport Sync
Jun 20 22:27:40 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:40 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Jun 20 22:27:40 rivoplus volumio[7538]: No protocol specified
Jun 20 22:27:40 rivoplus volumio[7538]: xcb_connection_has_error() returned true
Jun 20 22:27:40 rivoplus volumio[7538]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0
Jun 20 22:27:40 rivoplus volumio[7538]: No protocol specified
Jun 20 22:27:40 rivoplus volumio[7538]: xcb_connection_has_error() returned true
Jun 20 22:27:40 rivoplus volumio[7538]: info: QobuzConnect: setDeactiveState invoked
Jun 20 22:27:40 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:40 rivoplus sudo[14404]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log
Jun 20 22:27:40 rivoplus sudo[14404]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:40 rivoplus sudo[14404]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:40 rivoplus sudo[14412]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service
Jun 20 22:27:40 rivoplus sudo[14412]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:40 rivoplus sudo[14412]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:40 rivoplus sudo[14416]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service
Jun 20 22:27:40 rivoplus sudo[14416]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:40 rivoplus volumio[7538]: info: QobuzConnect: Qobuz Connect socket /tmp/qbz-connect.socket connected to client [object Object]
Jun 20 22:27:40 rivoplus volumio[7538]: info: QobuzConnect: QOBUZ Connect daemon connected
Jun 20 22:27:40 rivoplus sudo[14416]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:40 rivoplus volumio[7538]: ------------------------------------ BT MESSAGE: BT STATUS: running
Jun 20 22:27:40 rivoplus volumio[7538]: ------------------------------------ BT MESSAGE: BT STATUS: waiting
Jun 20 22:27:40 rivoplus volumio[7538]: ------------------------------------ BT MESSAGE: BT STATUS: waiting
Jun 20 22:27:40 rivoplus volumio[7538]: ------------------------------------ BT MESSAGE: BT STATUS: running
Jun 20 22:27:40 rivoplus volumio[7538]: ------------------------------------ BT MESSAGE: BT STATUS: waiting
Jun 20 22:27:40 rivoplus volumio[7538]: ------------------------------------ BT MESSAGE: BT STATUS: running
Jun 20 22:27:40 rivoplus volumio[7538]: info: Shairport-Sync Started
Jun 20 22:27:40 rivoplus sudo[14424]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl reset-failed qobuz-connect.service
Jun 20 22:27:40 rivoplus sudo[14424]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:40 rivoplus volumio[7538]: info: Shairport-Sync Started
Jun 20 22:27:40 rivoplus volumio[7538]: info: Reading package lists...
Jun 20 22:27:40 rivoplus volumio[7538]: info: CoreCommandRouter::volumioGetState
Jun 20 22:27:40 rivoplus volumio[7538]: error: Failed to parse min max audio card capabilities, sending default vales: TypeError: Cannot read property 'split' of undefined
Jun 20 22:27:40 rivoplus volumio[7538]: info: MPD Permissions set
Jun 20 22:27:40 rivoplus sudo[14424]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:40 rivoplus sudo[14426]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart qobuz-connect.service
Jun 20 22:27:40 rivoplus sudo[14426]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:40 rivoplus qobuz-connect[14372]: 20250620 22:27:40.955 [14372.14372] INFO SampleApp: Stopping Local configuration server
Jun 20 22:27:40 rivoplus systemd[1]: Stopping Volumio Qobuz Connect Service...
Jun 20 22:27:40 rivoplus qobuz-connect[14372]: 20250620 22:27:40.966 [14372.14372] INFO SampleApp: shat down connection on UNIX socket
Jun 20 22:27:40 rivoplus systemd[1]: qobuz-connect.service: Succeeded.
Jun 20 22:27:40 rivoplus systemd[1]: Stopped Volumio Qobuz Connect Service.
Jun 20 22:27:40 rivoplus systemd[1]: Started Volumio Qobuz Connect Service.
Jun 20 22:27:41 rivoplus sudo[14426]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:41 rivoplus volumio[7538]: info: camilladsp spawned new process with pid undefined, instance 1, run: true
Jun 20 22:27:41 rivoplus volumio[7538]: info: camilladsp service started and running in background, instance 1
Jun 20 22:27:41 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:41 rivoplus volumio[7538]: /bin/sh: 1: /data/plugins/audio_interface/fusiondsp/hw_params: not found
Jun 20 22:27:41 rivoplus volumio[7538]: error: FusionDsp - ----Hw detection failed :Error: Command failed: /data/plugins/audio_interface/fusiondsp/hw_params volumioHw >/data/configuration/audio_interface/fusiondsp/hwinfo.json
Jun 20 22:27:41 rivoplus volumio[7538]: /bin/sh: 1: /data/plugins/audio_interface/fusiondsp/hw_params: not found
Jun 20 22:27:41 rivoplus volumio[7538]: info: FusionDsp loaded
Jun 20 22:27:41 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Jun 20 22:27:41 rivoplus sudo[14440]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start fusiondsp.service
Jun 20 22:27:41 rivoplus volumio[7538]: info: FusionDsp - Reporting Fusion DSP Enabled
Jun 20 22:27:41 rivoplus volumio[7538]: info: Adding Signal Path Element [object Object]
Jun 20 22:27:41 rivoplus volumio[7538]: info: Adding fusiondspeq DSP Signal Path Element
Jun 20 22:27:41 rivoplus volumio[7538]: info: Additional DSP elements updated
Jun 20 22:27:41 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:41 rivoplus volumio[7538]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Jun 20 22:27:41 rivoplus volumio[7538]: info: Updating RAAT Signal Path
Jun 20 22:27:41 rivoplus sudo[14440]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:41 rivoplus volumio[7538]: error: Cannot write to RAAT Client: TypeError: Cannot read property 'write' of undefined
Jun 20 22:27:41 rivoplus volumio[7538]: info: FusionDsp - ---- installed callbackRead
Jun 20 22:27:41 rivoplus volumio[7538]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Jun 20 22:27:41 rivoplus volumio[7538]: Error: spawn /data/plugins/audio_interface/fusiondsp/camilladsp ENOENT
Jun 20 22:27:41 rivoplus volumio[7538]: at Process.ChildProcess._handle.onexit (internal/child_process.js:277:19)
Jun 20 22:27:41 rivoplus volumio[7538]: at onErrorNT (internal/child_process.js:472:16)
Jun 20 22:27:41 rivoplus volumio[7538]: at processTicksAndRejections (internal/process/task_queues.js:82:21) {
Jun 20 22:27:41 rivoplus volumio[7538]: errno: -2,
Jun 20 22:27:41 rivoplus volumio[7538]: code: 'ENOENT',
Jun 20 22:27:41 rivoplus volumio[7538]: syscall: 'spawn /data/plugins/audio_interface/fusiondsp/camilladsp',
Jun 20 22:27:41 rivoplus volumio[7538]: path: '/data/plugins/audio_interface/fusiondsp/camilladsp',
Jun 20 22:27:41 rivoplus volumio[7538]: spawnargs: [
Jun 20 22:27:41 rivoplus volumio[7538]: '-p',
Jun 20 22:27:41 rivoplus volumio[7538]: 9876,
Jun 20 22:27:41 rivoplus volumio[7538]: '-o',
Jun 20 22:27:41 rivoplus volumio[7538]: '/tmp/camilladsp.log',
Jun 20 22:27:41 rivoplus volumio[7538]: '-l',
Jun 20 22:27:41 rivoplus volumio[7538]: 'warn',
Jun 20 22:27:41 rivoplus volumio[7538]: '/data/configuration/audio_interface/fusiondsp/camilladsp.yml'
Jun 20 22:27:41 rivoplus volumio[7538]: ]
Jun 20 22:27:41 rivoplus volumio[7538]: }
Jun 20 22:27:41 rivoplus volumio[7538]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Jun 20 22:27:41 rivoplus sudo[14085]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:41 rivoplus systemd[1]: Started FusionDsp Daemon.
Jun 20 22:27:41 rivoplus sudo[14440]: pam_unix(sudo:session): session closed for user root
Jun 20 22:27:41 rivoplus sudo[14444]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/apt -y install python3-aiohttp python3-pip
Jun 20 22:27:41 rivoplus sudo[14444]: pam_unix(sudo:session): session opened for user root by (uid=0)
Jun 20 22:27:41 rivoplus volumio[14443]: /usr/bin/python3: can't open file '/data/plugins/audio_interface/fusiondsp/cgui/main.py': [Errno 2] No such file or directory
Jun 20 22:27:41 rivoplus systemd[1]: fusiondsp.service: Main process exited, code=exited, status=2/INVALIDARGUMENT
Jun 20 22:27:41 rivoplus systemd[1]: fusiondsp.service: Failed with result 'exit-code'.
Jun 20 22:27:41 rivoplus sudo[14457]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-06-20 22:26
Jun 20 22:27:41 rivoplus sudo[14457]: pam_unix(sudo:session): session opened for user root by (uid=0)
PRETTY_NAME="Debian GNU/Linux 10 (buster)"
NAME="Debian GNU/Linux"
VERSION_ID="10"
VERSION="10 (buster)"
VERSION_CODENAME=buster
ID=debian
HOME_URL="https://www.debian.org/"
SUPPORT_URL="https://www.debian.org/support"
BUG_REPORT_URL="https://bugs.debian.org/"
VOLUMIO_BUILD_VERSION="a142ed2648fb91920de0dde3a60cd39b5d0ba4f6"
VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6"
VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a"
VOLUMIO_BE_VERSION="04c18c158cc4bac70764c3360b25fcce0c69266a"
VOLUMIO_ARCH="armv7"
VOLUMIO_VARIANT="rivoplus"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Tue 10 Jun 2025 05:41:30 PM CEST"
VOLUMIO_VERSION="3.816"
VOLUMIO_HARDWARE="mp1"
VOLUMIO_DEVICENAME="Volumio MP1"
VOLUMIO_VENDOR_MODEL="Volumio Rivo"
VOLUMIO_VENDOR="Volumio"
VOLUMIO_MODEL="Rivo"
VOLUMIO_HASH="e2256d79dd6d0ae59eb47f10e57a5e95"