-- Logs begin at Thu 2019-02-14 11:11:59 CET, end at Wed 2024-05-08 22:39:23 CEST. --
May 08 22:38:02 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
May 08 22:38:06 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
May 08 22:38:14 ucpi volumio[770]: info: Received OAUTH Data
May 08 22:38:14 ucpi volumio[770]: info: Refreshing TIDAL token
May 08 22:38:15 ucpi volumio[770]: info: TIDAL Access Token successfully retrieved
May 08 22:38:15 ucpi volumio[770]: info: Successfully retrieved User Session From TIDAL
May 08 22:38:15 ucpi volumio[770]: info: Adding TIDAL to Browse Sources
May 08 22:38:15 ucpi volumio[770]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object]
May 08 22:38:15 ucpi volumio[770]: info: [1715200695727] CoreMusicLibrary::Adding element TIDAL
May 08 22:38:15 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
May 08 22:38:15 ucpi volumio[770]: Cannot find translation for source YouTube2
May 08 22:38:15 ucpi volumio[770]: Cannot find translation for source RADIO 357
May 08 22:38:15 ucpi volumio[770]: Cannot find translation for source TIDAL
May 08 22:38:15 ucpi sudo[4797]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
May 08 22:38:15 ucpi sudo[4797]: pam_unix(sudo:session): session opened for user root by (uid=0)
May 08 22:38:15 ucpi sudo[4797]: pam_unix(sudo:session): session closed for user root
May 08 22:38:15 ucpi sudo[4800]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
May 08 22:38:15 ucpi sudo[4800]: pam_unix(sudo:session): session opened for user root by (uid=0)
May 08 22:38:15 ucpi sudo[4800]: pam_unix(sudo:session): session closed for user root
May 08 22:38:15 ucpi volumio[770]: verbose: New Socket.io Connection to 192.168.1.14 from 192.168.1.13 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64; rv:125.0) Gecko/20100101 Firefox/125.0 Total Clients: 7
May 08 22:38:16 ucpi volumio[770]: info: Successfully retrieved User Subscription From TIDAL
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::volumioGetVisibleSources
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::getUIConfigOnPlugin
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::getUIConfigOnPlugin
May 08 22:38:16 ucpi volumio[770]: info: Retrieving Cloud Streaming UI
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
May 08 22:38:16 ucpi volumio[770]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom
May 08 22:38:16 ucpi volumio[770]: info: Received Get System Info
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 08 22:38:16 ucpi volumio[770]: info: Discovery: Getting this device information
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:38:16 ucpi volumio[770]: info: Listing playlists
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
May 08 22:38:16 ucpi volumio[770]: info: Getting Tidal Cloud Configuration
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::getUIConfigOnPlugin
May 08 22:38:16 ucpi volumio[770]: info: Getting Qobuz Cloud Configuration
May 08 22:38:16 ucpi volumio[770]: info: Asking plugin for UI Config
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::getUIConfigOnPlugin
May 08 22:38:16 ucpi volumio[770]: info: Getting Spotify Cloud Configuration
May 08 22:38:16 ucpi volumio[770]: info: Asking plugin for UI Config
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::getUIConfigOnPlugin
May 08 22:38:16 ucpi volumio[770]: info: Saving Spotify Acccount
May 08 22:38:16 ucpi volumio[770]: info: Got it
May 08 22:38:16 ucpi volumio[770]: error: Could not retrieve Spotify Config from plugin Spotify: no section found
May 08 22:38:16 ucpi volumio[770]: info: Got Tidal Cloud Configuration
May 08 22:38:16 ucpi volumio[770]: info: Got it
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::getUIConfigOnPlugin
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::volumioGetBrowseSources
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::volumioGetBrowseSources
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::volumioGetBrowseSources
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
May 08 22:38:16 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares
May 08 22:38:17 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
May 08 22:38:17 ucpi volumio[770]: info: Received Get System Info
May 08 22:38:17 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 08 22:38:17 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 08 22:38:17 ucpi volumio[770]: info: Discovery: Getting this device information
May 08 22:38:17 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:38:17 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 08 22:38:18 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
May 08 22:38:18 ucpi volumio[770]: info: Received Get System Info
May 08 22:38:18 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 08 22:38:18 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 08 22:38:18 ucpi volumio[770]: info: Discovery: Getting this device information
May 08 22:38:18 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:38:18 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 08 22:38:20 ucpi volumio[770]: info: CALLMETHOD: music_service tidal logout
May 08 22:38:20 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: tidal , logout
May 08 22:38:20 ucpi volumio[770]: info: Executing Logout From TIDAL
May 08 22:38:20 ucpi volumio[770]: info: CoreCommandRouter::volumioRemoveToBrowseSourcesTIDAL
May 08 22:38:20 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
May 08 22:38:20 ucpi volumio[770]: Cannot find translation for source YouTube2
May 08 22:38:20 ucpi volumio[770]: Cannot find translation for source RADIO 357
May 08 22:38:26 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:38:49 ucpi volumio[770]: info: Received OAUTH Data
May 08 22:38:49 ucpi volumio[770]: info: Refreshing TIDAL token
May 08 22:38:49 ucpi sudo[4852]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
May 08 22:38:49 ucpi sudo[4852]: pam_unix(sudo:session): session opened for user root by (uid=0)
May 08 22:38:49 ucpi sudo[4852]: pam_unix(sudo:session): session closed for user root
May 08 22:38:49 ucpi sudo[4855]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
May 08 22:38:49 ucpi sudo[4855]: pam_unix(sudo:session): session opened for user root by (uid=0)
May 08 22:38:49 ucpi sudo[4855]: pam_unix(sudo:session): session closed for user root
May 08 22:38:49 ucpi volumio[770]: info: TIDAL Access Token successfully retrieved
May 08 22:38:50 ucpi volumio[770]: verbose: New Socket.io Connection to 192.168.1.14 from 192.168.1.13 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64; rv:125.0) Gecko/20100101 Firefox/125.0 Total Clients: 7
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::volumioGetVisibleSources
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::getUIConfigOnPlugin
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::getUIConfigOnPlugin
May 08 22:38:50 ucpi volumio[770]: info: Retrieving Cloud Streaming UI
May 08 22:38:50 ucpi volumio[770]: info: Getting Tidal Cloud Configuration
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::getUIConfigOnPlugin
May 08 22:38:50 ucpi volumio[770]: info: Getting Qobuz Cloud Configuration
May 08 22:38:50 ucpi volumio[770]: info: Asking plugin for UI Config
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::getUIConfigOnPlugin
May 08 22:38:50 ucpi volumio[770]: info: Getting Spotify Cloud Configuration
May 08 22:38:50 ucpi volumio[770]: info: Asking plugin for UI Config
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::getUIConfigOnPlugin
May 08 22:38:50 ucpi volumio[770]: info: Saving Spotify Acccount
May 08 22:38:50 ucpi volumio[770]: info: Got it
May 08 22:38:50 ucpi volumio[770]: error: Could not retrieve Spotify Config from plugin Spotify: no section found
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
May 08 22:38:50 ucpi volumio[770]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom
May 08 22:38:50 ucpi volumio[770]: info: Got Tidal Cloud Configuration
May 08 22:38:50 ucpi volumio[770]: info: Got it
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::getUIConfigOnPlugin
May 08 22:38:50 ucpi volumio[770]: info: Received Get System Info
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 08 22:38:50 ucpi volumio[770]: info: Discovery: Getting this device information
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::volumioGetBrowseSources
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::volumioGetBrowseSources
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::volumioGetBrowseSources
May 08 22:38:50 ucpi volumio[770]: info: Listing playlists
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
May 08 22:38:50 ucpi volumio[770]: info: Successfully retrieved User Session From TIDAL
May 08 22:38:50 ucpi volumio[770]: info: Adding TIDAL to Browse Sources
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object]
May 08 22:38:50 ucpi volumio[770]: info: [1715200730253] CoreMusicLibrary::Adding element TIDAL
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
May 08 22:38:50 ucpi volumio[770]: Cannot find translation for source YouTube2
May 08 22:38:50 ucpi volumio[770]: Cannot find translation for source RADIO 357
May 08 22:38:50 ucpi volumio[770]: Cannot find translation for source TIDAL
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
May 08 22:38:50 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares
May 08 22:38:50 ucpi volumio[770]: info: Successfully retrieved User Subscription From TIDAL
May 08 22:38:51 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
May 08 22:38:51 ucpi volumio[770]: info: Received Get System Info
May 08 22:38:51 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 08 22:38:51 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 08 22:38:51 ucpi volumio[770]: info: Discovery: Getting this device information
May 08 22:38:51 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:38:51 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 08 22:38:52 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
May 08 22:38:52 ucpi volumio[770]: info: Received Get System Info
May 08 22:38:52 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 08 22:38:52 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 08 22:38:52 ucpi volumio[770]: info: Discovery: Getting this device information
May 08 22:38:52 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:38:52 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 08 22:38:55 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:38:56 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:38:56 ucpi volumio[770]: info: CoreCommandRouter::volumioGetQueue
May 08 22:38:56 ucpi volumio[770]: info: CoreStateMachine::getQueue
May 08 22:38:56 ucpi volumio[770]: info: CorePlayQueue::getQueue
May 08 22:38:57 ucpi volumio[770]: info: Executing endpoint metavolumio
May 08 22:38:57 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
May 08 22:38:57 ucpi volumio[770]: info: Executing endpoint metavolumio
May 08 22:38:57 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
May 08 22:38:57 ucpi volumio[770]: info: Executing endpoint metavolumio
May 08 22:38:57 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
May 08 22:38:58 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: tidal , handleBrowseUri
May 08 22:38:59 ucpi volumio[770]: info: browseTIDALUri took 359 milliseconds
May 08 22:38:59 ucpi volumio[770]: info: Preload queue cleared
May 08 22:38:59 ucpi volumio[770]: info: Preload queue cleared
May 08 22:39:01 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: tidal , handleBrowseUri
May 08 22:39:01 ucpi volumio[770]: info: browseTIDALUri took 568 milliseconds
May 08 22:39:01 ucpi volumio[770]: info: Preload queue cleared
May 08 22:39:01 ucpi volumio[770]: error: Failed request for metavolumio API
May 08 22:39:03 ucpi volumio[770]: info: Preload queue cleared
May 08 22:39:03 ucpi volumio[770]: info: CoreCommandRouter::volumioReplaceandPlayItems
May 08 22:39:03 ucpi volumio[770]: info: CoreStateMachine::ClearQueue
May 08 22:39:03 ucpi volumio[770]: info: CoreStateMachine::stop
May 08 22:39:03 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:03 ucpi volumio[770]: info: CorePlayQueue::clearPlayQueue
May 08 22:39:03 ucpi volumio[770]: info: CorePlayQueue::saveQueue
May 08 22:39:03 ucpi volumio[770]: info: CoreCommandRouter::volumioPushQueue
May 08 22:39:03 ucpi volumio[770]: info: CoreStateMachine::addQueueItems
May 08 22:39:03 ucpi volumio[770]: info: CorePlayQueue::addQueueItems
May 08 22:39:03 ucpi volumio[770]: info: Preload queue cleared
May 08 22:39:03 ucpi volumio[770]: info: Adding Item to queue: tidal://mymusic/mixes/002abfb464b2901504ceaf0fba9245
May 08 22:39:03 ucpi volumio[770]: info: Exploding uri tidal://mymusic/mixes/002abfb464b2901504ceaf0fba9245 in service tidal
May 08 22:39:04 ucpi volumio[770]: error: Failed request for metavolumio API
May 08 22:39:04 ucpi volumio[770]: info: explodeTIDALUri took 826 milliseconds
May 08 22:39:04 ucpi volumio[770]: info: CoreCommandRouter::volumioPushQueue
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::saveQueue
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::updateTrackBlock
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::getTrackBlock
May 08 22:39:04 ucpi volumio[770]: info: CoreCommandRouter::volumioPlay
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::play index 0
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::stop
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::play index undefined
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::getTrack 0
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::startPlaybackTimer
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::getTrack 0
May 08 22:39:04 ucpi volumio[770]: info: [1715200744528] ControllerTidal::clearAddPlayTrack
May 08 22:39:04 ucpi volumio[770]: info: Getting stream with soundQuality HI_RES
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand stop
May 08 22:39:04 ucpi volumio[770]: info:
May 08 22:39:04 ucpi volumio[770]: ---------------------------- MPD announces state update: player
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand stop took 2 milliseconds
May 08 22:39:04 ucpi volumio[770]: info: ControllerMpd::getState
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand status
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand clear
May 08 22:39:04 ucpi volumio[770]: info:
May 08 22:39:04 ucpi volumio[770]: ---------------------------- MPD announces system playlist update
May 08 22:39:04 ucpi volumio[770]: info: Ignoring MPD Status Update
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand status took 2 milliseconds
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand clear took 1 milliseconds
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::parseState
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand add "http://127.0.0.1:3245?data=tidal://song/327729207&soundQuality=HI_RES"
May 08 22:39:04 ucpi volumio[770]: error: updateQueue error: null
May 08 22:39:04 ucpi volumio[770]: info:
May 08 22:39:04 ucpi volumio[770]: ---------------------------- MPD announces system playlist update
May 08 22:39:04 ucpi volumio[770]: info: Ignoring MPD Status Update
May 08 22:39:04 ucpi volumio[770]: info: ------------------------------ 2ms
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand playlistinfo took 1 milliseconds
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand add "http://127.0.0.1:3245?data=tidal://song/327729207&soundQuality=HI_RES" took 1 milliseconds
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::parseTrackInfo
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService mpd
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand play
May 08 22:39:04 ucpi volumio[770]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined
May 08 22:39:04 ucpi volumio[770]: info: ------------------------------ 5ms
May 08 22:39:04 ucpi volumio[770]: STREAMING PROXY: Handling url /?data=tidal://song/327729207&soundQuality=HI_RES
May 08 22:39:04 ucpi volumio[770]: info: ------------------------------ 3ms
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand play took 2 milliseconds
May 08 22:39:04 ucpi volumio[770]: info: No valid Plugin REST Endpoint: getStreamUrltidal
May 08 22:39:04 ucpi volumio[770]: STREAMING PROXY: Error: Failed to retrieve proper real streamUrl
May 08 22:39:04 ucpi volumio[770]: info: Preload queue cleared
May 08 22:39:04 ucpi volumio[770]: info: CoreCommandRouter::volumioReplaceandPlayItems
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::ClearQueue
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::stop
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::clearPlayQueue
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::saveQueue
May 08 22:39:04 ucpi volumio[770]: info: CoreCommandRouter::volumioPushQueue
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::addQueueItems
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::addQueueItems
May 08 22:39:04 ucpi volumio[770]: info: Preload queue cleared
May 08 22:39:04 ucpi volumio[770]: info: Adding Item to queue: tidal://mymusic/mixes/002abfb464b2901504ceaf0fba9245
May 08 22:39:04 ucpi volumio[770]: info: Using cached record of: tidal://mymusic/mixes/002abfb464b2901504ceaf0fba9245
May 08 22:39:04 ucpi volumio[770]: info: CoreCommandRouter::volumioPushQueue
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::saveQueue
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::updateTrackBlock
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::getTrackBlock
May 08 22:39:04 ucpi volumio[770]: info: CoreCommandRouter::volumioPlay
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::play index 0
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::stop
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::play index undefined
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::getTrack 0
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::startPlaybackTimer
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::getTrack 0
May 08 22:39:04 ucpi volumio[770]: info: [1715200744751] ControllerTidal::clearAddPlayTrack
May 08 22:39:04 ucpi volumio[770]: info: Getting stream with soundQuality HI_RES
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand stop
May 08 22:39:04 ucpi volumio[770]: info:
May 08 22:39:04 ucpi volumio[770]: ---------------------------- MPD announces state update: player
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand stop took 2 milliseconds
May 08 22:39:04 ucpi volumio[770]: info: ControllerMpd::getState
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand status
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand clear
May 08 22:39:04 ucpi volumio[770]: info:
May 08 22:39:04 ucpi volumio[770]: ---------------------------- MPD announces system playlist update
May 08 22:39:04 ucpi volumio[770]: info: Ignoring MPD Status Update
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand status took 1 milliseconds
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand clear took 2 milliseconds
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::parseState
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand add "http://127.0.0.1:3245?data=tidal://song/327729207&soundQuality=HI_RES"
May 08 22:39:04 ucpi volumio[770]: error: updateQueue error: null
May 08 22:39:04 ucpi volumio[770]: info:
May 08 22:39:04 ucpi volumio[770]: ---------------------------- MPD announces system playlist update
May 08 22:39:04 ucpi volumio[770]: info: Ignoring MPD Status Update
May 08 22:39:04 ucpi volumio[770]: info: ------------------------------ 2ms
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand playlistinfo took 2 milliseconds
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand add "http://127.0.0.1:3245?data=tidal://song/327729207&soundQuality=HI_RES" took 2 milliseconds
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::parseTrackInfo
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService mpd
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand play
May 08 22:39:04 ucpi volumio[770]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined
May 08 22:39:04 ucpi volumio[770]: info: ------------------------------ 6ms
May 08 22:39:04 ucpi volumio[770]: STREAMING PROXY: Handling url /?data=tidal://song/327729207&soundQuality=HI_RES
May 08 22:39:04 ucpi volumio[770]: info: ------------------------------ 4ms
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand play took 3 milliseconds
May 08 22:39:04 ucpi volumio[770]: info: No valid Plugin REST Endpoint: getStreamUrltidal
May 08 22:39:04 ucpi volumio[770]: STREAMING PROXY: Error: Failed to retrieve proper real streamUrl
May 08 22:39:04 ucpi volumio[770]: info: Preload queue cleared
May 08 22:39:04 ucpi volumio[770]: info: CoreCommandRouter::volumioReplaceandPlayItems
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::ClearQueue
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::stop
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::clearPlayQueue
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::saveQueue
May 08 22:39:04 ucpi volumio[770]: info: CoreCommandRouter::volumioPushQueue
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::addQueueItems
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::addQueueItems
May 08 22:39:04 ucpi volumio[770]: info: Preload queue cleared
May 08 22:39:04 ucpi volumio[770]: info: Adding Item to queue: tidal://mymusic/mixes/002abfb464b2901504ceaf0fba9245
May 08 22:39:04 ucpi volumio[770]: info: Using cached record of: tidal://mymusic/mixes/002abfb464b2901504ceaf0fba9245
May 08 22:39:04 ucpi volumio[770]: info: CoreCommandRouter::volumioPushQueue
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::saveQueue
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::updateTrackBlock
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::getTrackBlock
May 08 22:39:04 ucpi volumio[770]: info: CoreCommandRouter::volumioPlay
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::play index 0
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::stop
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::play index undefined
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::getTrack 0
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::startPlaybackTimer
May 08 22:39:04 ucpi volumio[770]: info: CorePlayQueue::getTrack 0
May 08 22:39:04 ucpi volumio[770]: info: [1715200744882] ControllerTidal::clearAddPlayTrack
May 08 22:39:04 ucpi volumio[770]: info: Getting stream with soundQuality HI_RES
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand stop
May 08 22:39:04 ucpi volumio[770]: info:
May 08 22:39:04 ucpi volumio[770]: ---------------------------- MPD announces state update: player
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand stop took 2 milliseconds
May 08 22:39:04 ucpi volumio[770]: info: ControllerMpd::getState
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand status
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand clear
May 08 22:39:04 ucpi volumio[770]: info:
May 08 22:39:04 ucpi volumio[770]: ---------------------------- MPD announces system playlist update
May 08 22:39:04 ucpi volumio[770]: info: Ignoring MPD Status Update
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand status took 2 milliseconds
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand clear took 2 milliseconds
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::parseState
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand add "http://127.0.0.1:3245?data=tidal://song/327729207&soundQuality=HI_RES"
May 08 22:39:04 ucpi volumio[770]: error: updateQueue error: null
May 08 22:39:04 ucpi volumio[770]: info:
May 08 22:39:04 ucpi volumio[770]: ---------------------------- MPD announces system playlist update
May 08 22:39:04 ucpi volumio[770]: info: Ignoring MPD Status Update
May 08 22:39:04 ucpi volumio[770]: info: ------------------------------ 2ms
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand playlistinfo took 1 milliseconds
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand add "http://127.0.0.1:3245?data=tidal://song/327729207&soundQuality=HI_RES" took 1 milliseconds
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::parseTrackInfo
May 08 22:39:04 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService mpd
May 08 22:39:04 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand play
May 08 22:39:04 ucpi volumio[770]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined
May 08 22:39:04 ucpi volumio[770]: info: ------------------------------ 5ms
May 08 22:39:04 ucpi volumio[770]: STREAMING PROXY: Handling url /?data=tidal://song/327729207&soundQuality=HI_RES
May 08 22:39:04 ucpi volumio[770]: info: ------------------------------ 3ms
May 08 22:39:04 ucpi volumio[770]: info: sendMpdCommand play took 2 milliseconds
May 08 22:39:04 ucpi volumio[770]: info: No valid Plugin REST Endpoint: getStreamUrltidal
May 08 22:39:04 ucpi volumio[770]: STREAMING PROXY: Error: Failed to retrieve proper real streamUrl
May 08 22:39:05 ucpi volumio[770]: info: Preload queue cleared
May 08 22:39:05 ucpi volumio[770]: info: CoreCommandRouter::volumioReplaceandPlayItems
May 08 22:39:05 ucpi volumio[770]: info: CoreStateMachine::ClearQueue
May 08 22:39:05 ucpi volumio[770]: info: CoreStateMachine::stop
May 08 22:39:05 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:05 ucpi volumio[770]: info: CorePlayQueue::clearPlayQueue
May 08 22:39:05 ucpi volumio[770]: info: CorePlayQueue::saveQueue
May 08 22:39:05 ucpi volumio[770]: info: CoreCommandRouter::volumioPushQueue
May 08 22:39:05 ucpi volumio[770]: info: CoreStateMachine::addQueueItems
May 08 22:39:05 ucpi volumio[770]: info: CorePlayQueue::addQueueItems
May 08 22:39:05 ucpi volumio[770]: info: Preload queue cleared
May 08 22:39:05 ucpi volumio[770]: info: Adding Item to queue: tidal://mymusic/mixes/002abfb464b2901504ceaf0fba9245
May 08 22:39:05 ucpi volumio[770]: info: Using cached record of: tidal://mymusic/mixes/002abfb464b2901504ceaf0fba9245
May 08 22:39:05 ucpi volumio[770]: info: CoreCommandRouter::volumioPushQueue
May 08 22:39:05 ucpi volumio[770]: info: CorePlayQueue::saveQueue
May 08 22:39:05 ucpi volumio[770]: info: CoreStateMachine::updateTrackBlock
May 08 22:39:05 ucpi volumio[770]: info: CorePlayQueue::getTrackBlock
May 08 22:39:05 ucpi volumio[770]: info: CoreCommandRouter::volumioPlay
May 08 22:39:05 ucpi volumio[770]: info: CoreStateMachine::play index 0
May 08 22:39:05 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:05 ucpi volumio[770]: info: CoreStateMachine::stop
May 08 22:39:05 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:05 ucpi volumio[770]: info: CoreStateMachine::play index undefined
May 08 22:39:05 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:05 ucpi volumio[770]: info: CorePlayQueue::getTrack 0
May 08 22:39:05 ucpi volumio[770]: info: CoreStateMachine::startPlaybackTimer
May 08 22:39:05 ucpi volumio[770]: info: CorePlayQueue::getTrack 0
May 08 22:39:05 ucpi volumio[770]: info: [1715200745096] ControllerTidal::clearAddPlayTrack
May 08 22:39:05 ucpi volumio[770]: info: Getting stream with soundQuality HI_RES
May 08 22:39:05 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand stop
May 08 22:39:05 ucpi volumio[770]: info:
May 08 22:39:05 ucpi volumio[770]: ---------------------------- MPD announces state update: player
May 08 22:39:05 ucpi volumio[770]: info: sendMpdCommand stop took 2 milliseconds
May 08 22:39:05 ucpi volumio[770]: info: ControllerMpd::getState
May 08 22:39:05 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand status
May 08 22:39:05 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand clear
May 08 22:39:05 ucpi volumio[770]: info:
May 08 22:39:05 ucpi volumio[770]: ---------------------------- MPD announces system playlist update
May 08 22:39:05 ucpi volumio[770]: info: Ignoring MPD Status Update
May 08 22:39:05 ucpi volumio[770]: info: sendMpdCommand status took 1 milliseconds
May 08 22:39:05 ucpi volumio[770]: info: sendMpdCommand clear took 1 milliseconds
May 08 22:39:05 ucpi volumio[770]: verbose: ControllerMpd::parseState
May 08 22:39:05 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 08 22:39:05 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand add "http://127.0.0.1:3245?data=tidal://song/327729207&soundQuality=HI_RES"
May 08 22:39:05 ucpi volumio[770]: error: updateQueue error: null
May 08 22:39:05 ucpi volumio[770]: info:
May 08 22:39:05 ucpi volumio[770]: ---------------------------- MPD announces system playlist update
May 08 22:39:05 ucpi volumio[770]: info: Ignoring MPD Status Update
May 08 22:39:05 ucpi volumio[770]: info: ------------------------------ 3ms
May 08 22:39:05 ucpi volumio[770]: info: sendMpdCommand playlistinfo took 2 milliseconds
May 08 22:39:05 ucpi volumio[770]: info: sendMpdCommand add "http://127.0.0.1:3245?data=tidal://song/327729207&soundQuality=HI_RES" took 2 milliseconds
May 08 22:39:05 ucpi volumio[770]: verbose: ControllerMpd::parseTrackInfo
May 08 22:39:05 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService mpd
May 08 22:39:05 ucpi volumio[770]: verbose: ControllerMpd::sendMpdCommand play
May 08 22:39:05 ucpi volumio[770]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined
May 08 22:39:05 ucpi volumio[770]: info: ------------------------------ 6ms
May 08 22:39:05 ucpi volumio[770]: info: ------------------------------ 3ms
May 08 22:39:05 ucpi volumio[770]: STREAMING PROXY: Handling url /?data=tidal://song/327729207&soundQuality=HI_RES
May 08 22:39:05 ucpi volumio[770]: info: sendMpdCommand play took 2 milliseconds
May 08 22:39:05 ucpi volumio[770]: info: No valid Plugin REST Endpoint: getStreamUrltidal
May 08 22:39:05 ucpi volumio[770]: STREAMING PROXY: Error: Failed to retrieve proper real streamUrl
May 08 22:39:07 ucpi volumio[770]: info: CoreCommandRouter::volumioStop
May 08 22:39:07 ucpi volumio[770]: info: CoreStateMachine::stop
May 08 22:39:07 ucpi volumio[770]: info: CoreStateMachine::setConsumeUpdateService undefined
May 08 22:39:09 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
May 08 22:39:09 ucpi volumio[770]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined
May 08 22:39:09 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates
May 08 22:39:09 ucpi volumio[770]: info: Received Get System Version
May 08 22:39:09 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
May 08 22:39:09 ucpi volumio[770]: info: Received Get System Info
May 08 22:39:09 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 08 22:39:09 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 08 22:39:09 ucpi volumio[770]: info: Discovery: Getting this device information
May 08 22:39:09 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:39:09 ucpi volumio[770]: info: CorePlayQueue::getTrack 0
May 08 22:39:09 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 08 22:39:12 ucpi volumio[770]: info: CoreCommandRouter::volumioGetState
May 08 22:39:12 ucpi volumio[770]: info: CorePlayQueue::getTrack 0
May 08 22:39:14 ucpi volumio[770]: info: Executing endpoint metavolumio
May 08 22:39:14 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
May 08 22:39:14 ucpi volumio[770]: info: Executing endpoint metavolumio
May 08 22:39:14 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
May 08 22:39:14 ucpi volumio[770]: info: Executing endpoint metavolumio
May 08 22:39:14 ucpi volumio[770]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
May 08 22:39:21 ucpi volumio[770]: error: Failed request for metavolumio API
May 08 22:39:22 ucpi volumio[770]: info: ___________ PLUGINS: Run onVolumioReboot Tasks ___________
May 08 22:39:22 ucpi volumio[770]: info: PLUGIN onReboot : networkfs
May 08 22:39:22 ucpi sudo[4906]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/umount -f /mnt/NAS/NAS
May 08 22:39:22 ucpi sudo[4906]: pam_unix(sudo:session): session opened for user root by (uid=0)
May 08 22:39:22 ucpi sudo[4906]: pam_unix(sudo:session): session closed for user root
May 08 22:39:22 ucpi volumio[770]: umount: /mnt/NAS/NAS: not mounted.
May 08 22:39:22 ucpi volumio[770]: error: Cannot umount share NAS : Error: Command failed: /usr/bin/sudo /bin/umount -f /mnt/NAS/NAS
May 08 22:39:22 ucpi volumio[770]: umount: /mnt/NAS/NAS: not mounted.
May 08 22:39:22 ucpi sudo[4909]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/umount -f /mnt/NAS/Wajkow_Coreelec
May 08 22:39:22 ucpi sudo[4909]: pam_unix(sudo:session): session opened for user root by (uid=0)
May 08 22:39:22 ucpi sudo[4909]: pam_unix(sudo:session): session closed for user root
May 08 22:39:22 ucpi volumio[770]: umount: /mnt/NAS/Wajkow_Coreelec: not mounted.
May 08 22:39:22 ucpi volumio[770]: error: Cannot umount share Wajkow_Coreelec : Error: Command failed: /usr/bin/sudo /bin/umount -f /mnt/NAS/Wajkow_Coreelec
May 08 22:39:22 ucpi volumio[770]: umount: /mnt/NAS/Wajkow_Coreelec: not mounted.
May 08 22:39:22 ucpi sudo[4912]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/umount -f /mnt/NAS/Zidoo
May 08 22:39:22 ucpi sudo[4912]: pam_unix(sudo:session): session opened for user root by (uid=0)
May 08 22:39:22 ucpi systemd[1]: mnt-NAS-Zidoo.mount: Succeeded.
May 08 22:39:23 ucpi sudo[4912]: pam_unix(sudo:session): session closed for user root
May 08 22:39:23 ucpi volumio[770]: info: PLUGIN onReboot : audiophonicsonoff
May 08 22:39:23 ucpi volumio[770]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
May 08 22:39:23 ucpi volumio[770]: TypeError: Cannot read property 'writeSync' of undefined
May 08 22:39:23 ucpi volumio[770]: at ControllerAudiophonicsOnOff.onVolumioReboot (/data/plugins/system_controller/audiophonicsonoff/index.js:35:25)
May 08 22:39:23 ucpi volumio[770]: at PluginManager.onVolumioRebootPlugin (/volumio/app/pluginmanager.js:684:30)
May 08 22:39:23 ucpi volumio[770]: at HashMap. (/volumio/app/pluginmanager.js:668:31)
May 08 22:39:23 ucpi volumio[770]: at HashMap.forEach (/volumio/node_modules/hashmap/hashmap.js:171:10)
May 08 22:39:23 ucpi volumio[770]: at HashMap.proto. [as forEach] (/volumio/node_modules/hashmap/hashmap.js:201:7)
May 08 22:39:23 ucpi volumio[770]: at PluginManager.onVolumioReboot (/volumio/app/pluginmanager.js:666:20)
May 08 22:39:23 ucpi volumio[770]: at CoreCommandRouter.reboot (/volumio/app/index.js:1325:22)
May 08 22:39:23 ucpi volumio[770]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:836:33)
May 08 22:39:23 ucpi volumio[770]: at Socket.emit (events.js:315:20)
May 08 22:39:23 ucpi volumio[770]: at /volumio/node_modules/socket.io/lib/socket.js:503:12
May 08 22:39:23 ucpi volumio[770]: at processTicksAndRejections (internal/process/task_queues.js:75:11)
May 08 22:39:23 ucpi volumio[770]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
May 08 22:39:23 ucpi sudo[4924]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-05-08 22:38
May 08 22:39:23 ucpi sudo[4924]: pam_unix(sudo:session): session opened for user root by (uid=0)
PRETTY_NAME="Raspbian GNU/Linux 10 (buster)"
NAME="Raspbian GNU/Linux"
VERSION_ID="10"
VERSION="10 (buster)"
VERSION_CODENAME=buster
ID=raspbian
ID_LIKE=debian
HOME_URL="http://www.raspbian.org/"
SUPPORT_URL="http://www.raspbian.org/RaspbianForums"
BUG_REPORT_URL="http://www.raspbian.org/RaspbianBugs"
VOLUMIO_BUILD_VERSION="e7445fab547cd22e23d9bef72406cfb610bc1d7d"
VOLUMIO_FE_VERSION="5d5e99f8f803b3ec5fc5e8ca13bb4023600f3eee"
VOLUMIO_FE3_VERSION="a6ae210575eae1ff43f06ab71e1cd17576840623"
VOLUMIO_BE_VERSION="a9e1e1dd6072ffb15c0fcb8938d9ea0d8900c0da"
VOLUMIO_ARCH="arm"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Wed 24 Apr 2024 02:10:14 PM CEST"
VOLUMIO_VERSION="3.661"
VOLUMIO_HARDWARE="pi"
VOLUMIO_DEVICENAME="Raspberry Pi"
VOLUMIO_HASH="5bdefd4af4423fd17aacb83a8538bf1f"