-- Logs begin at Wed 2025-04-30 17:31:37 CEST, end at Fri 2025-05-09 18:02:52 CEST. --
May 09 18:01:14 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 09 18:01:14 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 09 18:01:14 volumio-primo volumio[869]: info: Discovery: Getting this device information
May 09 18:01:14 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetState
May 09 18:01:14 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:01:14 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 09 18:01:31 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri
May 09 18:01:31 volumio-primo volumio[869]: info: Preload queue cleared
May 09 18:01:32 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri
May 09 18:01:32 volumio-primo volumio[869]: info: Preload queue cleared
May 09 18:01:34 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri
May 09 18:01:34 volumio-primo volumio[869]: info: Preload queue cleared
May 09 18:01:35 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri
May 09 18:01:35 volumio-primo volumio[869]: info: Preload queue cleared
May 09 18:01:40 volumio-primo volumiologrotate[548]: ls: cannot access '/var/log/samba/log.wb-VOLUMIO': No such file or directory
May 09 18:01:40 volumio-primo volumiologrotate[548]: ls: cannot access 'PRIMO': No such file or directory
May 09 18:01:44 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 09 18:01:44 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 09 18:01:44 volumio-primo volumio[869]: info: Discovery: Getting this device information
May 09 18:01:44 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetState
May 09 18:01:44 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:01:44 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 09 18:02:05 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri
May 09 18:02:05 volumio-primo volumio[869]: info: Preload queue cleared
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$0
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$1
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$2
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$3
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$4
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$5
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$6
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$7
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$8
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$9
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$A
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$B
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$C
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$D
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$E
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$F
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$10
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$11
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$12
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$13
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$14
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$15
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$16
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$17
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$18
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$19
May 09 18:02:05 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$1A
May 09 18:02:05 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$0 in service upnp_browser
May 09 18:02:05 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$1 in service upnp_browser
May 09 18:02:05 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$2 in service upnp_browser
May 09 18:02:05 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$3 in service upnp_browser
May 09 18:02:05 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$4 in service upnp_browser
May 09 18:02:05 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$5 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$6 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$7 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$8 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$9 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$A in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$B in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$C in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$D in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$E in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$F in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$10 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$11 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$12 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$13 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$14 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$15 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$16 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$17 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$131$18 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: Preload queue cleared
May 09 18:02:06 volumio-primo volumio[869]: info: CoreCommandRouter::volumioReplaceandPlayItems
May 09 18:02:06 volumio-primo volumio[869]: info: CoreStateMachine::ClearQueue
May 09 18:02:06 volumio-primo volumio[869]: info: CoreStateMachine::stop
May 09 18:02:06 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService undefined
May 09 18:02:06 volumio-primo volumio[869]: info: CorePlayQueue::clearPlayQueue
May 09 18:02:06 volumio-primo volumio[869]: info: CorePlayQueue::saveQueue
May 09 18:02:06 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushQueue
May 09 18:02:06 volumio-primo volumio[869]: info: CoreStateMachine::addQueueItems
May 09 18:02:06 volumio-primo volumio[869]: info: CorePlayQueue::addQueueItems
May 09 18:02:06 volumio-primo volumio[869]: info: Preload queue cleared
May 09 18:02:06 volumio-primo volumio[869]: info: Adding Item to queue: upnp/folder/http://192.168.178.8:8200/ctl/ContentDir@64$1$131
May 09 18:02:06 volumio-primo volumio[869]: info: Exploding uri upnp/folder/http://192.168.178.8:8200/ctl/ContentDir@64$1$131 in service upnp_browser
May 09 18:02:06 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushQueue
May 09 18:02:07 volumio-primo volumio[869]: info: CorePlayQueue::saveQueue
May 09 18:02:07 volumio-primo volumio[869]: info: CoreStateMachine::updateTrackBlock
May 09 18:02:07 volumio-primo volumio[869]: info: CorePlayQueue::getTrackBlock
May 09 18:02:07 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPlay
May 09 18:02:07 volumio-primo volumio[869]: info: CoreStateMachine::play index 0
May 09 18:02:07 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService undefined
May 09 18:02:07 volumio-primo volumio[869]: info: CoreStateMachine::stop
May 09 18:02:07 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService undefined
May 09 18:02:07 volumio-primo volumio[869]: info: CoreStateMachine::play index undefined
May 09 18:02:07 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService undefined
May 09 18:02:07 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:07 volumio-primo volumio[869]: info: CoreStateMachine::startPlaybackTimer
May 09 18:02:07 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:07 volumio-primo volumio[869]: info: [1746806527004] ControllerUPNPBrowser::clearAddPlayTrack
May 09 18:02:07 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand stop
May 09 18:02:07 volumio-primo volumio[869]: info: sendMpdCommand stop took 3 milliseconds
May 09 18:02:07 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand clear
May 09 18:02:07 volumio-primo volumio[869]: info:
May 09 18:02:07 volumio-primo volumio[869]: ---------------------------- MPD announces system playlist update
May 09 18:02:07 volumio-primo volumio[869]: info: Ignoring MPD Status Update
May 09 18:02:07 volumio-primo volumio[869]: info: sendMpdCommand clear took 1 milliseconds
May 09 18:02:07 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand load "http://192.168.178.8:8200/MediaItems/34285.mp3"
May 09 18:02:07 volumio-primo volumio[869]: error: updateQueue error: null
May 09 18:02:07 volumio-primo volumio[869]: info: ------------------------------ 2ms
May 09 18:02:07 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand add "http://192.168.178.8:8200/MediaItems/34285.mp3"
May 09 18:02:07 volumio-primo volumio[869]: info:
May 09 18:02:07 volumio-primo volumio[869]: ---------------------------- MPD announces system playlist update
May 09 18:02:07 volumio-primo volumio[869]: info: Ignoring MPD Status Update
May 09 18:02:07 volumio-primo volumio[869]: info: sendMpdCommand add "http://192.168.178.8:8200/MediaItems/34285.mp3" took 2 milliseconds
May 09 18:02:07 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService mpd
May 09 18:02:07 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand play
May 09 18:02:07 volumio-primo volumio[869]: info: ------------------------------ 2ms
May 09 18:02:07 volumio-primo volumio[869]: info: sendMpdCommand play took 2 milliseconds
May 09 18:02:07 volumio-primo volumio[869]: info:
May 09 18:02:07 volumio-primo volumio[869]: ---------------------------- MPD announces state update: player
May 09 18:02:07 volumio-primo volumio[869]: info: ControllerMpd::getState
May 09 18:02:07 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand status
May 09 18:02:07 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand clearerror
May 09 18:02:07 volumio-primo volumio[869]: info: sendMpdCommand status took 5 milliseconds
May 09 18:02:07 volumio-primo volumio[869]: verbose: ControllerMpd::parseState
May 09 18:02:07 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 09 18:02:07 volumio-primo volumio[869]: info: sendMpdCommand clearerror took 2 milliseconds
May 09 18:02:07 volumio-primo volumio[869]: info: sendMpdCommand playlistinfo took 1 milliseconds
May 09 18:02:07 volumio-primo volumio[869]: verbose: ControllerMpd::parseTrackInfo
May 09 18:02:07 volumio-primo volumio[869]: info: ControllerMpd::pushState
May 09 18:02:07 volumio-primo volumio[869]: info: CoreCommandRouter::servicePushState
May 09 18:02:07 volumio-primo volumio[869]: info: CoreStateMachine::pushState
May 09 18:02:07 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 09 18:02:07 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushState
May 09 18:02:07 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:07 volumio-primo volumio[869]: verbose: STATE SERVICE {"status":"stop","position":0,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"34285.mp3","artist":null,"album":null,"uri":"http://192.168.178.8:8200/MediaItems/34285.mp3","trackType":"mp3"}
May 09 18:02:07 volumio-primo volumio[869]: verbose: CURRENT POSITION 0
May 09 18:02:07 volumio-primo volumio[869]: info: CoreStateMachine::syncState stateService stop
May 09 18:02:07 volumio-primo volumio[869]: info: CoreStateMachine::syncState currentStatus stop
May 09 18:02:07 volumio-primo volumio[869]: info: CoreStateMachine::pushState
May 09 18:02:07 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushState
May 09 18:02:07 volumio-primo volumio[869]: info: No code
May 09 18:02:07 volumio-primo volumio[869]: info: CoreStateMachine::pushState
May 09 18:02:07 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushState
May 09 18:02:07 volumio-primo volumio[869]: info: ------------------------------ 27ms
May 09 18:02:09 volumio-primo volumio[869]: info: Executing endpoint metavolumio
May 09 18:02:09 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
May 09 18:02:09 volumio-primo volumio[869]: info: Executing endpoint metavolumio
May 09 18:02:09 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
May 09 18:02:14 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetState
May 09 18:02:14 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 09 18:02:14 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 09 18:02:14 volumio-primo volumio[869]: info: Discovery: Getting this device information
May 09 18:02:14 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetState
May 09 18:02:14 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 09 18:02:15 volumio-primo sudo[15423]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
May 09 18:02:15 volumio-primo sudo[15423]: pam_unix(sudo:session): session opened for user root by (uid=0)
May 09 18:02:15 volumio-primo sudo[15427]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
May 09 18:02:15 volumio-primo sudo[15423]: pam_unix(sudo:session): session closed for user root
May 09 18:02:15 volumio-primo sudo[15427]: pam_unix(sudo:session): session opened for user root by (uid=0)
May 09 18:02:15 volumio-primo sudo[15427]: pam_unix(sudo:session): session closed for user root
May 09 18:02:15 volumio-primo volumio[869]: verbose: New Socket.io Connection to 192.168.178.40 from 192.168.178.60 UA: Mozilla/5.0 (Linux; Android 14; SM-P613 Build/UP1A.231005.007; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.60 Safari/537.36 Engine version: 3 Transport: polling Total Clients: 9
May 09 18:02:15 volumio-primo sudo[15444]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
May 09 18:02:15 volumio-primo sudo[15444]: pam_unix(sudo:session): session opened for user root by (uid=0)
May 09 18:02:15 volumio-primo sudo[15447]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
May 09 18:02:15 volumio-primo sudo[15444]: pam_unix(sudo:session): session closed for user root
May 09 18:02:15 volumio-primo sudo[15447]: pam_unix(sudo:session): session opened for user root by (uid=0)
May 09 18:02:15 volumio-primo sudo[15447]: pam_unix(sudo:session): session closed for user root
May 09 18:02:15 volumio-primo volumio[869]: verbose: New Socket.io Connection to 192.168.178.40 from 192.168.178.60 UA: Mozilla/5.0 (Linux; Android 14; SM-P613 Build/UP1A.231005.007; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/136.0.7103.60 Safari/537.36 Engine version: 3 Transport: polling Total Clients: 10
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetVisibleSources
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetState
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetQueue
May 09 18:02:16 volumio-primo volumio[869]: info: CoreStateMachine::getQueue
May 09 18:02:16 volumio-primo volumio[869]: info: CorePlayQueue::getQueue
May 09 18:02:16 volumio-primo volumio[869]: info: Listing playlists
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
May 09 18:02:16 volumio-primo volumio[869]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom
May 09 18:02:16 volumio-primo volumio[869]: info: Received Get System Info
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 09 18:02:16 volumio-primo volumio[869]: info: Discovery: Getting this device information
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetState
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetState
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
May 09 18:02:16 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache
May 09 18:02:17 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
May 09 18:02:17 volumio-primo volumio[869]: info: Received Get System Info
May 09 18:02:17 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 09 18:02:17 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 09 18:02:17 volumio-primo volumio[869]: info: Discovery: Getting this device information
May 09 18:02:17 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetState
May 09 18:02:17 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 09 18:02:17 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard
May 09 18:02:18 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus
May 09 18:02:18 volumio-primo volumio[869]: info: Received Get System Info
May 09 18:02:18 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 09 18:02:18 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 09 18:02:18 volumio-primo volumio[869]: info: Discovery: Getting this device information
May 09 18:02:18 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetState
May 09 18:02:18 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 09 18:02:22 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri
May 09 18:02:22 volumio-primo volumio[869]: info: Preload queue cleared
May 09 18:02:23 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri
May 09 18:02:23 volumio-primo volumio[869]: info: Preload queue cleared
May 09 18:02:23 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$0
May 09 18:02:23 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$1
May 09 18:02:23 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$2
May 09 18:02:23 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$3
May 09 18:02:23 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$4
May 09 18:02:23 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$5
May 09 18:02:23 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$6
May 09 18:02:23 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$7
May 09 18:02:23 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$8
May 09 18:02:23 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$9
May 09 18:02:23 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$A
May 09 18:02:24 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$0 in service upnp_browser
May 09 18:02:24 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$1 in service upnp_browser
May 09 18:02:24 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$2 in service upnp_browser
May 09 18:02:24 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$3 in service upnp_browser
May 09 18:02:24 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$4 in service upnp_browser
May 09 18:02:24 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$5 in service upnp_browser
May 09 18:02:24 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$6 in service upnp_browser
May 09 18:02:24 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$7 in service upnp_browser
May 09 18:02:24 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$8 in service upnp_browser
May 09 18:02:24 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$9 in service upnp_browser
May 09 18:02:24 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0$A in service upnp_browser
May 09 18:02:25 volumio-primo volumio[869]: info: Preload queue cleared
May 09 18:02:25 volumio-primo volumio[869]: info: CoreCommandRouter::volumioReplaceandPlayItems
May 09 18:02:25 volumio-primo volumio[869]: info: CoreStateMachine::ClearQueue
May 09 18:02:25 volumio-primo volumio[869]: info: CoreStateMachine::stop
May 09 18:02:25 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService undefined
May 09 18:02:25 volumio-primo volumio[869]: info: CorePlayQueue::clearPlayQueue
May 09 18:02:25 volumio-primo volumio[869]: info: CorePlayQueue::saveQueue
May 09 18:02:25 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushQueue
May 09 18:02:25 volumio-primo volumio[869]: info: CoreStateMachine::addQueueItems
May 09 18:02:25 volumio-primo volumio[869]: info: CorePlayQueue::addQueueItems
May 09 18:02:25 volumio-primo volumio[869]: info: Preload queue cleared
May 09 18:02:25 volumio-primo volumio[869]: info: Adding Item to queue: upnp/folder/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0
May 09 18:02:25 volumio-primo volumio[869]: info: Exploding uri upnp/folder/http://192.168.178.8:8200/ctl/ContentDir@64$1$D$0 in service upnp_browser
May 09 18:02:25 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushQueue
May 09 18:02:25 volumio-primo volumio[869]: info: CorePlayQueue::saveQueue
May 09 18:02:25 volumio-primo volumio[869]: info: CoreStateMachine::updateTrackBlock
May 09 18:02:25 volumio-primo volumio[869]: info: CorePlayQueue::getTrackBlock
May 09 18:02:25 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPlay
May 09 18:02:25 volumio-primo volumio[869]: info: CoreStateMachine::play index 0
May 09 18:02:25 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService undefined
May 09 18:02:25 volumio-primo volumio[869]: info: CoreStateMachine::stop
May 09 18:02:25 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService undefined
May 09 18:02:25 volumio-primo volumio[869]: info: CoreStateMachine::play index undefined
May 09 18:02:25 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService undefined
May 09 18:02:25 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:25 volumio-primo volumio[869]: info: CoreStateMachine::startPlaybackTimer
May 09 18:02:25 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:25 volumio-primo volumio[869]: info: [1746806545165] ControllerUPNPBrowser::clearAddPlayTrack
May 09 18:02:25 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand stop
May 09 18:02:25 volumio-primo volumio[869]: info: sendMpdCommand stop took 2 milliseconds
May 09 18:02:25 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand clear
May 09 18:02:25 volumio-primo volumio[869]: info:
May 09 18:02:25 volumio-primo volumio[869]: ---------------------------- MPD announces system playlist update
May 09 18:02:25 volumio-primo volumio[869]: info: Ignoring MPD Status Update
May 09 18:02:25 volumio-primo volumio[869]: info: sendMpdCommand clear took 1 milliseconds
May 09 18:02:25 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand load "http://192.168.178.8:8200/MediaItems/1588.flac"
May 09 18:02:25 volumio-primo volumio[869]: error: updateQueue error: null
May 09 18:02:25 volumio-primo volumio[869]: info: ------------------------------ 3ms
May 09 18:02:25 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted
May 09 18:02:26 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand add "http://192.168.178.8:8200/MediaItems/1588.flac"
May 09 18:02:26 volumio-primo volumio[869]: info:
May 09 18:02:26 volumio-primo volumio[869]: ---------------------------- MPD announces system playlist update
May 09 18:02:26 volumio-primo volumio[869]: info: Ignoring MPD Status Update
May 09 18:02:26 volumio-primo volumio[869]: info: sendMpdCommand add "http://192.168.178.8:8200/MediaItems/1588.flac" took 1 milliseconds
May 09 18:02:26 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService mpd
May 09 18:02:26 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand play
May 09 18:02:26 volumio-primo volumio[869]: info: ------------------------------ 3ms
May 09 18:02:26 volumio-primo volumio[869]: info: sendMpdCommand play took 2 milliseconds
May 09 18:02:26 volumio-primo volumio[869]: info:
May 09 18:02:26 volumio-primo volumio[869]: ---------------------------- MPD announces state update: player
May 09 18:02:26 volumio-primo volumio[869]: info: ControllerMpd::getState
May 09 18:02:26 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand status
May 09 18:02:26 volumio-primo volumio[869]: info:
May 09 18:02:26 volumio-primo volumio[869]: ---------------------------- MPD announces state update: player
May 09 18:02:26 volumio-primo volumio[869]: info: ControllerMpd::getState
May 09 18:02:26 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand status
May 09 18:02:26 volumio-primo volumio[869]: info:
May 09 18:02:26 volumio-primo volumio[869]: ---------------------------- MPD announces system playlist update
May 09 18:02:26 volumio-primo volumio[869]: info: Ignoring MPD Status Update
May 09 18:02:26 volumio-primo volumio[869]: info:
May 09 18:02:26 volumio-primo volumio[869]: ---------------------------- MPD announces state update: player
May 09 18:02:26 volumio-primo volumio[869]: info: sendMpdCommand status took 21 milliseconds
May 09 18:02:26 volumio-primo volumio[869]: info: ControllerMpd::getState
May 09 18:02:26 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand status
May 09 18:02:26 volumio-primo volumio[869]: verbose: ControllerMpd::parseState
May 09 18:02:26 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 09 18:02:26 volumio-primo volumio[869]: info: sendMpdCommand status took 5 milliseconds
May 09 18:02:26 volumio-primo volumio[869]: info: ------------------------------ 4ms
May 09 18:02:26 volumio-primo volumio[869]: info: sendMpdCommand status took 3 milliseconds
May 09 18:02:26 volumio-primo volumio[869]: info: sendMpdCommand playlistinfo took 2 milliseconds
May 09 18:02:26 volumio-primo volumio[869]: verbose: ControllerMpd::parseState
May 09 18:02:26 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 09 18:02:26 volumio-primo volumio[869]: verbose: ControllerMpd::parseState
May 09 18:02:26 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 09 18:02:26 volumio-primo volumio[869]: verbose: ControllerMpd::parseTrackInfo
May 09 18:02:26 volumio-primo volumio[869]: info: ControllerMpd::pushState
May 09 18:02:26 volumio-primo volumio[869]: info: CoreCommandRouter::servicePushState
May 09 18:02:26 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:26 volumio-primo volumio[869]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":295,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Hello","artist":"Adele","album":"25","uri":"http://192.168.178.8:8200/MediaItems/1588.flac","trackType":"flac"}
May 09 18:02:26 volumio-primo volumio[869]: verbose: CURRENT POSITION 0
May 09 18:02:26 volumio-primo volumio[869]: info: CoreStateMachine::syncState stateService play
May 09 18:02:26 volumio-primo volumio[869]: info: CoreStateMachine::syncState currentStatus stop
May 09 18:02:26 volumio-primo volumio[869]: info: ------------------------------ 29ms
May 09 18:02:26 volumio-primo volumio[869]: info: sendMpdCommand playlistinfo took 2 milliseconds
May 09 18:02:26 volumio-primo volumio[869]: verbose: ControllerMpd::parseTrackInfo
May 09 18:02:26 volumio-primo volumio[869]: info: ControllerMpd::pushState
May 09 18:02:26 volumio-primo volumio[869]: info: CoreCommandRouter::servicePushState
May 09 18:02:26 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:26 volumio-primo volumio[869]: verbose: STATE SERVICE {"status":"play","position":0,"seek":983,"duration":295,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"396 Kbps","isStreaming":false,"title":"Hello","artist":"Adele","album":"25","uri":"http://192.168.178.8:8200/MediaItems/1588.flac","trackType":"flac"}
May 09 18:02:26 volumio-primo volumio[869]: verbose: CURRENT POSITION 0
May 09 18:02:26 volumio-primo volumio[869]: info: CoreStateMachine::syncState stateService play
May 09 18:02:26 volumio-primo volumio[869]: info: CoreStateMachine::syncState currentStatus play
May 09 18:02:26 volumio-primo volumio[869]: info: Received an update from plugin. extracting info from payload
May 09 18:02:26 volumio-primo volumio[869]: info: CoreStateMachine::pushState
May 09 18:02:26 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 09 18:02:26 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushState
May 09 18:02:26 volumio-primo volumio[869]: info: CoreStateMachine::pushState
May 09 18:02:26 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushState
May 09 18:02:26 volumio-primo volumio[869]: info: ControllerMpd::pushState
May 09 18:02:26 volumio-primo volumio[869]: info: CoreCommandRouter::servicePushState
May 09 18:02:26 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:26 volumio-primo volumio[869]: verbose: STATE SERVICE {"status":"play","position":0,"seek":983,"duration":295,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"366 Kbps","isStreaming":false,"title":"Hello","artist":"Adele","album":"25","uri":"http://192.168.178.8:8200/MediaItems/1588.flac","trackType":"flac"}
May 09 18:02:26 volumio-primo volumio[869]: verbose: CURRENT POSITION 0
May 09 18:02:26 volumio-primo volumio[869]: info: CoreStateMachine::syncState stateService play
May 09 18:02:26 volumio-primo volumio[869]: info: CoreStateMachine::syncState currentStatus play
May 09 18:02:26 volumio-primo volumio[869]: info: Received an update from plugin. extracting info from payload
May 09 18:02:26 volumio-primo volumio[869]: info: CoreStateMachine::pushState
May 09 18:02:26 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 09 18:02:26 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushState
May 09 18:02:26 volumio-primo volumio[869]: info: CoreStateMachine::pushState
May 09 18:02:26 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushState
May 09 18:02:26 volumio-primo volumio[869]: info: ------------------------------ 87ms
May 09 18:02:26 volumio-primo volumio[869]: info: ------------------------------ 71ms
May 09 18:02:26 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetQueue
May 09 18:02:26 volumio-primo volumio[869]: info: CoreStateMachine::getQueue
May 09 18:02:26 volumio-primo volumio[869]: info: CorePlayQueue::getQueue
May 09 18:02:27 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetQueue
May 09 18:02:27 volumio-primo volumio[869]: info: CoreStateMachine::getQueue
May 09 18:02:27 volumio-primo volumio[869]: info: CorePlayQueue::getQueue
May 09 18:02:27 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetQueue
May 09 18:02:27 volumio-primo volumio[869]: info: CoreStateMachine::getQueue
May 09 18:02:27 volumio-primo volumio[869]: info: CorePlayQueue::getQueue
May 09 18:02:27 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetQueue
May 09 18:02:27 volumio-primo volumio[869]: info: CoreStateMachine::getQueue
May 09 18:02:27 volumio-primo volumio[869]: info: CorePlayQueue::getQueue
May 09 18:02:28 volumio-primo volumio[869]: info: Executing endpoint metavolumio
May 09 18:02:28 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
May 09 18:02:28 volumio-primo volumio[869]: info: Executing endpoint metavolumio
May 09 18:02:28 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
May 09 18:02:28 volumio-primo volumio[869]: info: Executing endpoint metavolumio
May 09 18:02:28 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
May 09 18:02:33 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
May 09 18:02:33 volumio-primo volumio[869]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined
May 09 18:02:33 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates
May 09 18:02:33 volumio-primo volumio[869]: info: Received Get System Version
May 09 18:02:33 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
May 09 18:02:33 volumio-primo volumio[869]: info: Received Get System Info
May 09 18:02:33 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 09 18:02:33 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 09 18:02:33 volumio-primo volumio[869]: info: Discovery: Getting this device information
May 09 18:02:33 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetState
May 09 18:02:33 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 09 18:02:39 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri
May 09 18:02:40 volumio-primo volumio[869]: info: Preload queue cleared
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$0
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$1
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$2
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$3
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$4
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$5
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$6
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$7
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$8
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$9
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$A
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$B
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$C
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$D
May 09 18:02:40 volumio-primo volumio[869]: info: Preloading song: upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$E
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$0 in service upnp_browser
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$1 in service upnp_browser
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$2 in service upnp_browser
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$3 in service upnp_browser
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$4 in service upnp_browser
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$5 in service upnp_browser
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$6 in service upnp_browser
May 09 18:02:40 volumio-primo volumiologrotate[548]: ls: cannot access '/var/log/samba/log.wb-VOLUMIO': No such file or directory
May 09 18:02:40 volumio-primo volumiologrotate[548]: ls: cannot access 'PRIMO': No such file or directory
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$7 in service upnp_browser
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$8 in service upnp_browser
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$9 in service upnp_browser
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$A in service upnp_browser
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$B in service upnp_browser
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$C in service upnp_browser
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$D in service upnp_browser
May 09 18:02:40 volumio-primo volumio[869]: info: Exploding uri upnp/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B$E in service upnp_browser
May 09 18:02:41 volumio-primo volumio[869]: info: Preload queue cleared
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::volumioReplaceandPlayItems
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::ClearQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::stop
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService undefined
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::stPlaybackTimer
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::updateTrackBlock
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::getTrackBlock
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::pushState
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushState
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::serviceStop
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::serviceStop
May 09 18:02:41 volumio-primo volumio[869]: info: [1746806561173] ControllerUPNPBrowser::stop
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand stop
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::clearPlayQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::saveQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::addQueueItems
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::addQueueItems
May 09 18:02:41 volumio-primo volumio[869]: info: Preload queue cleared
May 09 18:02:41 volumio-primo volumio[869]: info: Adding Item to queue: upnp/folder/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B
May 09 18:02:41 volumio-primo volumio[869]: info: Exploding uri upnp/folder/http://192.168.178.8:8200/ctl/ContentDir@64$1$1B in service upnp_browser
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::saveQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::updateTrackBlock
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::getTrackBlock
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPlay
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::play index 0
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService undefined
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::stop
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService undefined
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::play index undefined
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService undefined
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::startPlaybackTimer
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:41 volumio-primo volumio[869]: info: [1746806561222] ControllerUPNPBrowser::clearAddPlayTrack
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand stop
May 09 18:02:41 volumio-primo volumio[869]: info:
May 09 18:02:41 volumio-primo volumio[869]: ---------------------------- MPD announces state update: player
May 09 18:02:41 volumio-primo volumio[869]: info: sendMpdCommand stop took 57 milliseconds
May 09 18:02:41 volumio-primo volumio[869]: info: ControllerMpd::getState
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand status
May 09 18:02:41 volumio-primo volumio[869]: info: sendMpdCommand stop took 4 milliseconds
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand clear
May 09 18:02:41 volumio-primo volumio[869]: info:
May 09 18:02:41 volumio-primo volumio[869]: ---------------------------- MPD announces system playlist update
May 09 18:02:41 volumio-primo volumio[869]: info: Ignoring MPD Status Update
May 09 18:02:41 volumio-primo volumio[869]: info: sendMpdCommand status took 7 milliseconds
May 09 18:02:41 volumio-primo volumio[869]: info: sendMpdCommand clear took 6 milliseconds
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::parseState
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand load "http://192.168.178.8:8200/MediaItems/1919.mp3"
May 09 18:02:41 volumio-primo volumio[869]: error: updateQueue error: null
May 09 18:02:41 volumio-primo volumio[869]: info: ------------------------------ 16ms
May 09 18:02:41 volumio-primo volumio[869]: info: sendMpdCommand playlistinfo took 16 milliseconds
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::parseTrackInfo
May 09 18:02:41 volumio-primo volumio[869]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined
May 09 18:02:41 volumio-primo volumio[869]: info: ------------------------------ 26ms
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand add "http://192.168.178.8:8200/MediaItems/1919.mp3"
May 09 18:02:41 volumio-primo volumio[869]: info:
May 09 18:02:41 volumio-primo volumio[869]: ---------------------------- MPD announces system playlist update
May 09 18:02:41 volumio-primo volumio[869]: info: Ignoring MPD Status Update
May 09 18:02:41 volumio-primo volumio[869]: info: sendMpdCommand add "http://192.168.178.8:8200/MediaItems/1919.mp3" took 1 milliseconds
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::setConsumeUpdateService mpd
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand play
May 09 18:02:41 volumio-primo volumio[869]: info: ------------------------------ 2ms
May 09 18:02:41 volumio-primo volumio[869]: info: sendMpdCommand play took 2 milliseconds
May 09 18:02:41 volumio-primo volumio[869]: info:
May 09 18:02:41 volumio-primo volumio[869]: ---------------------------- MPD announces state update: player
May 09 18:02:41 volumio-primo volumio[869]: info: ControllerMpd::getState
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand status
May 09 18:02:41 volumio-primo volumio[869]: info:
May 09 18:02:41 volumio-primo volumio[869]: ---------------------------- MPD announces state update: player
May 09 18:02:41 volumio-primo volumio[869]: info: sendMpdCommand status took 4 milliseconds
May 09 18:02:41 volumio-primo volumio[869]: info: ControllerMpd::getState
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand status
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::parseState
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 09 18:02:41 volumio-primo volumio[869]: info: sendMpdCommand status took 4 milliseconds
May 09 18:02:41 volumio-primo volumio[869]: info: sendMpdCommand playlistinfo took 3 milliseconds
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::parseState
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::parseTrackInfo
May 09 18:02:41 volumio-primo volumio[869]: info: ControllerMpd::pushState
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::servicePushState
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:41 volumio-primo volumio[869]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":376,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"1919.mp3","artist":null,"album":null,"uri":"http://192.168.178.8:8200/MediaItems/1919.mp3","trackType":"mp3"}
May 09 18:02:41 volumio-primo volumio[869]: verbose: CURRENT POSITION 0
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::syncState stateService play
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::syncState currentStatus stop
May 09 18:02:41 volumio-primo volumio[869]: info: ------------------------------ 38ms
May 09 18:02:41 volumio-primo volumio[869]: info:
May 09 18:02:41 volumio-primo volumio[869]: ---------------------------- MPD announces system playlist update
May 09 18:02:41 volumio-primo volumio[869]: info: Ignoring MPD Status Update
May 09 18:02:41 volumio-primo volumio[869]: info:
May 09 18:02:41 volumio-primo volumio[869]: ---------------------------- MPD announces state update: player
May 09 18:02:41 volumio-primo volumio[869]: info: ControllerMpd::getState
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand status
May 09 18:02:41 volumio-primo volumio[869]: info: sendMpdCommand playlistinfo took 28 milliseconds
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::parseTrackInfo
May 09 18:02:41 volumio-primo volumio[869]: info: ControllerMpd::pushState
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::servicePushState
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:41 volumio-primo volumio[869]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":376,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Music Is The Answer (Gabriel Vezzola Mix)","artist":"Danny Tenaglia & Celeda","album":"Music Is The Answer","uri":"http://192.168.178.8:8200/MediaItems/1919.mp3","trackType":"mp3"}
May 09 18:02:41 volumio-primo volumio[869]: verbose: CURRENT POSITION 0
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::syncState stateService play
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::syncState currentStatus play
May 09 18:02:41 volumio-primo volumio[869]: info: Received an update from plugin. extracting info from payload
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::pushState
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushState
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::pushState
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushState
May 09 18:02:41 volumio-primo volumio[869]: info: ------------------------------ 99ms
May 09 18:02:41 volumio-primo volumio[869]: info: ------------------------------ 70ms
May 09 18:02:41 volumio-primo volumio[869]: info: sendMpdCommand status took 67 milliseconds
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::parseState
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::sendMpdCommand playlistinfo
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::getQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::getQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::getQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::getQueue
May 09 18:02:41 volumio-primo volumio[869]: info: sendMpdCommand playlistinfo took 113 milliseconds
May 09 18:02:41 volumio-primo volumio[869]: verbose: ControllerMpd::parseTrackInfo
May 09 18:02:41 volumio-primo volumio[869]: info: ControllerMpd::pushState
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::servicePushState
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::getTrack 0
May 09 18:02:41 volumio-primo volumio[869]: verbose: STATE SERVICE {"status":"play","position":0,"seek":1005,"duration":376,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"320 Kbps","isStreaming":false,"title":"Music Is The Answer (Gabriel Vezzola Mix)","artist":"Danny Tenaglia & Celeda","album":"Music Is The Answer","uri":"http://192.168.178.8:8200/MediaItems/1919.mp3","trackType":"mp3"}
May 09 18:02:41 volumio-primo volumio[869]: verbose: CURRENT POSITION 0
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::syncState stateService play
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::syncState currentStatus play
May 09 18:02:41 volumio-primo volumio[869]: info: Received an update from plugin. extracting info from payload
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::pushState
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushState
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::pushState
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::volumioPushState
May 09 18:02:41 volumio-primo volumio[869]: info: ------------------------------ 207ms
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::getQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::getQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CoreStateMachine::getQueue
May 09 18:02:41 volumio-primo volumio[869]: info: CorePlayQueue::getQueue
May 09 18:02:43 volumio-primo volumio[869]: info: Executing endpoint metavolumio
May 09 18:02:43 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
May 09 18:02:43 volumio-primo volumio[869]: info: Executing endpoint metavolumio
May 09 18:02:43 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
May 09 18:02:43 volumio-primo volumio[869]: info: Executing endpoint metavolumio
May 09 18:02:43 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio
May 09 18:02:44 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
May 09 18:02:44 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
May 09 18:02:44 volumio-primo volumio[869]: info: Discovery: Getting this device information
May 09 18:02:44 volumio-primo volumio[869]: info: CoreCommandRouter::volumioGetState
May 09 18:02:44 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
May 09 18:02:52 volumio-primo volumio[869]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri
May 09 18:02:52 volumio-primo volumio[869]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
May 09 18:02:52 volumio-primo volumio[869]: TypeError: Cannot read property 'length' of undefined
May 09 18:02:52 volumio-primo volumio[869]: at /volumio/app/plugins/music_service/upnp_browser/index.js:341:25
May 09 18:02:52 volumio-primo volumio[869]: at /volumio/app/plugins/music_service/upnp_browser/dlna-browser.js:131:13
May 09 18:02:52 volumio-primo volumio[869]: at Parser. (/volumio/node_modules/xml2js/lib/parser.js:304:18)
May 09 18:02:52 volumio-primo volumio[869]: at Parser.emit (events.js:400:28)
May 09 18:02:52 volumio-primo volumio[869]: at SAXParser.onclosetag (/volumio/node_modules/xml2js/lib/parser.js:262:26)
May 09 18:02:52 volumio-primo volumio[869]: at emit (/volumio/node_modules/sax/lib/sax.js:624:35)
May 09 18:02:52 volumio-primo volumio[869]: at emitNode (/volumio/node_modules/sax/lib/sax.js:629:5)
May 09 18:02:52 volumio-primo volumio[869]: at closeTag (/volumio/node_modules/sax/lib/sax.js:889:7)
May 09 18:02:52 volumio-primo volumio[869]: at SAXParser.write (/volumio/node_modules/sax/lib/sax.js:1436:13)
May 09 18:02:52 volumio-primo volumio[869]: at Parser.exports.Parser.Parser.parseString (/volumio/node_modules/xml2js/lib/parser.js:323:31)
May 09 18:02:52 volumio-primo volumio[869]: at Parser.parseString (/volumio/node_modules/xml2js/lib/parser.js:5:59)
May 09 18:02:52 volumio-primo volumio[869]: at Object.exports.parseString (/volumio/node_modules/xml2js/lib/parser.js:369:19)
May 09 18:02:52 volumio-primo volumio[869]: at IncomingMessage. (/volumio/app/plugins/music_service/upnp_browser/dlna-browser.js:92:15)
May 09 18:02:52 volumio-primo volumio[869]: at IncomingMessage.emit (events.js:412:35)
May 09 18:02:52 volumio-primo volumio[869]: at endReadableNT (internal/streams/readable.js:1333:12)
May 09 18:02:52 volumio-primo volumio[869]: at processTicksAndRejections (internal/process/task_queues.js:82:21)
May 09 18:02:52 volumio-primo volumio[869]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
May 09 18:02:52 volumio-primo sudo[15584]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-05-09 18:01
May 09 18:02:52 volumio-primo sudo[15584]: 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="147953990fca4aa103a8f90538ef56fb0454638c"
VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6"
VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a"
VOLUMIO_BE_VERSION="9ab87de061b3649c303da550e73c92d340b0f989"
VOLUMIO_ARCH="armv7"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Thu 24 Apr 2025 09:53:51 AM CEST"
VOLUMIO_VERSION="3.804"
VOLUMIO_HARDWARE="tinkerboard"
VOLUMIO_DEVICENAME="Asus Tinkerboard"
VOLUMIO_HASH="53825f995260683aee752aed6b29f24e"