Feb 24 01:30:02 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:30:02 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:30:07 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:30:07 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:30:10 volumio sudo[15941]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Feb 24 01:30:10 volumio sudo[15941]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 24 01:30:10 volumio sudo[15941]: pam_unix(sudo:session): session closed for user root Feb 24 01:30:10 volumio sudo[15943]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Feb 24 01:30:10 volumio sudo[15943]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 24 01:30:10 volumio sudo[15943]: pam_unix(sudo:session): session closed for user root Feb 24 01:30:10 volumio volumio[1016]: verbose: New Socket.io Connection to 192.168.0.121 from 192.168.0.200 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/143.0.0.0 Safari/537.36 OPR/127.0.0.0 Engine version: 3 Transport: polling Total Clients: 6 Feb 24 01:30:10 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Feb 24 01:30:10 volumio volumio[1016]: info: CoreCommandRouter::volumioGetVisibleSources Feb 24 01:30:10 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Feb 24 01:30:10 volumio volumio[1016]: info: CoreCommandRouter::volumioGetState Feb 24 01:30:10 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:10 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Feb 24 01:30:10 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Feb 24 01:30:10 volumio volumio[1016]: info: Received Get System Info Feb 24 01:30:10 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 24 01:30:10 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 24 01:30:10 volumio volumio[1016]: info: Discovery: Getting this device information Feb 24 01:30:10 volumio volumio[1016]: info: CoreCommandRouter::volumioGetState Feb 24 01:30:10 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:10 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 24 01:30:10 volumio volumio[1016]: info: CoreCommandRouter::volumioGetState Feb 24 01:30:10 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:10 volumio volumio[1016]: info: Listing playlists Feb 24 01:30:10 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Feb 24 01:30:10 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Feb 24 01:30:10 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache Feb 24 01:30:11 volumio volumio[1016]: info: CoreCommandRouter::volumioGetState Feb 24 01:30:11 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:12 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: wizard , getOnboardingWizard Feb 24 01:30:12 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Feb 24 01:30:12 volumio volumio[1016]: info: Received Get System Info Feb 24 01:30:12 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 24 01:30:12 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 24 01:30:12 volumio volumio[1016]: info: Discovery: Getting this device information Feb 24 01:30:12 volumio volumio[1016]: info: CoreCommandRouter::volumioGetState Feb 24 01:30:12 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:12 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 24 01:30:12 volumio volumio[1016]: info: CoreCommandRouter::volumioGetQueue Feb 24 01:30:12 volumio volumio[1016]: info: CoreStateMachine::getQueue Feb 24 01:30:12 volumio volumio[1016]: info: CorePlayQueue::getQueue Feb 24 01:30:12 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:30:12 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:30:12 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Feb 24 01:30:12 volumio volumio[1016]: info: Received Get System Info Feb 24 01:30:12 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 24 01:30:12 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 24 01:30:12 volumio volumio[1016]: info: Discovery: Getting this device information Feb 24 01:30:12 volumio volumio[1016]: info: CoreCommandRouter::volumioGetState Feb 24 01:30:12 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:12 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 24 01:30:17 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:30:17 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:30:20 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Feb 24 01:30:22 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:30:22 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:30:27 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: mpd , updateDb Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand update Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:27 volumio volumio[1016]: info: Feb 24 01:30:27 volumio volumio[1016]: ---------------------------- MPD announces state update: update Feb 24 01:30:27 volumio volumio[1016]: info: sendMpdCommand update took 1 milliseconds Feb 24 01:30:27 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:27 volumio volumio[1016]: info: sendMpdCommand status took 1 milliseconds Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:27 volumio volumio[1016]: info: Command Router : Notfying DB Updatetrue Feb 24 01:30:27 volumio volumio[1016]: info: CoreCommandRouter::Close All Modals sent Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:27 volumio volumio[1016]: info: Feb 24 01:30:27 volumio volumio[1016]: ---------------------------- MPD announces state update: update Feb 24 01:30:27 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:27 volumio volumio[1016]: info: Feb 24 01:30:27 volumio volumio[1016]: ---------------------------- MPD announces state update: update Feb 24 01:30:27 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:27 volumio volumio[1016]: info: sendMpdCommand status took 24 milliseconds Feb 24 01:30:27 volumio volumio[1016]: info: sendMpdCommand status took 3 milliseconds Feb 24 01:30:27 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:27 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:27 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:27 volumio volumio[1016]: info: Command Router : Notfying DB Updatetrue Feb 24 01:30:27 volumio volumio[1016]: info: CoreCommandRouter::Close All Modals sent Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:27 volumio volumio[1016]: info: Command Router : Notfying DB Updatetrue Feb 24 01:30:27 volumio volumio[1016]: info: CoreCommandRouter::Close All Modals sent Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:27 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 45 milliseconds Feb 24 01:30:27 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 26 milliseconds Feb 24 01:30:27 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 7 milliseconds Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:27 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:27 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:27 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:27 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":true,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:27 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:27 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:27 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:27 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:27 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:27 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Feb 24 01:30:27 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:27 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:27 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:27 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:27 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:27 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":true,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:27 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:27 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:27 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:27 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:27 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:27 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:27 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:27 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:27 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:27 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:27 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":true,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:27 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:27 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:27 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:27 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:27 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:27 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:27 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:27 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:27.496+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:27 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:27.496+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:27 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:27.496+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:27 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:27.496+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:27 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:27.497+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:27 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:27.497+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:27 volumio volumio[1016]: info: ------------------------------ 79ms Feb 24 01:30:27 volumio volumio[1016]: info: ------------------------------ 57ms Feb 24 01:30:27 volumio volumio[1016]: info: ------------------------------ 56ms Feb 24 01:30:27 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:30:27 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:30:27 volumio volumio[1016]: info: MPD Database updated - AlbumList cache refreshed Feb 24 01:30:27 volumio volumio[1016]: info: Feb 24 01:30:27 volumio volumio[1016]: ---------------------------- MPD announces state update: database Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:27 volumio volumio[1016]: info: Feb 24 01:30:27 volumio volumio[1016]: ---------------------------- MPD announces state update: update Feb 24 01:30:27 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:27 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:27 volumio volumio[1016]: info: MPD Database updated - AlbumList cache refreshed Feb 24 01:30:27 volumio volumio[1016]: info: Feb 24 01:30:27 volumio volumio[1016]: ---------------------------- MPD announces state update: database Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:27 volumio volumio[1016]: info: Feb 24 01:30:27 volumio volumio[1016]: ---------------------------- MPD announces state update: update Feb 24 01:30:27 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:27 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:27 volumio volumio[1016]: info: MPD Database updated - AlbumList cache refreshed Feb 24 01:30:27 volumio volumio[1016]: info: Feb 24 01:30:27 volumio volumio[1016]: ---------------------------- MPD announces state update: database Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:27 volumio volumio[1016]: info: Feb 24 01:30:27 volumio volumio[1016]: ---------------------------- MPD announces state update: update Feb 24 01:30:27 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:27 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:27 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand status took 525 milliseconds Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand status took 525 milliseconds Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand status took 525 milliseconds Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:28 volumio volumio[1016]: info: Command Router : Notfying DB Updatefalse Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::Close All Modals sent Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Feb 24 01:30:28 volumio volumio[1016]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Feb 24 01:30:28 volumio volumio[1016]: info: Received Get System Version Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Feb 24 01:30:28 volumio volumio[1016]: info: Received Get System Info Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 24 01:30:28 volumio volumio[1016]: info: Discovery: Getting this device information Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::volumioGetState Feb 24 01:30:28 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand status took 818 milliseconds Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand status took 818 milliseconds Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand status took 818 milliseconds Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:28 volumio volumio[1016]: info: Command Router : Notfying DB Updatefalse Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::Close All Modals sent Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand status took 1143 milliseconds Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand status took 1143 milliseconds Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand status took 1143 milliseconds Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 599 milliseconds Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 599 milliseconds Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 307 milliseconds Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 307 milliseconds Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:28 volumio volumio[1016]: info: Command Router : Notfying DB Updatefalse Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::Close All Modals sent Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:28 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:28 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:28 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:28 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:28 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:28 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:28 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:28 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:28 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:28 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:28 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:28 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:28 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:28 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:28 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:28 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:28 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:28 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:28 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:28 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:28 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:28.944+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:28 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:28.945+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:28 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:28.944+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:28 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:28.945+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:28 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:28.945+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:28 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:28.945+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:28 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:28.946+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:28 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:28.946+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:28 volumio volumio[1016]: info: ------------------------------ 1175ms Feb 24 01:30:28 volumio volumio[1016]: info: ------------------------------ 1176ms Feb 24 01:30:28 volumio volumio[1016]: info: ------------------------------ 1175ms Feb 24 01:30:28 volumio volumio[1016]: info: ------------------------------ 1175ms Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 11 milliseconds Feb 24 01:30:28 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 11 milliseconds Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:28 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:28 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:28 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:28 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:28 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:28 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:28 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:28 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:28 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:28 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:28 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:28 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:28 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:28 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:28.952+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:28 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:28.952+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:28 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:28.952+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:28 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:28.952+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:28 volumio volumio[1016]: info: ------------------------------ 1180ms Feb 24 01:30:28 volumio volumio[1016]: info: ------------------------------ 1180ms Feb 24 01:30:32 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:30:32 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:30:32 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: mpd , updateDb Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand update Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:32 volumio volumio[1016]: info: Feb 24 01:30:32 volumio volumio[1016]: ---------------------------- MPD announces state update: update Feb 24 01:30:32 volumio volumio[1016]: info: sendMpdCommand update took 2 milliseconds Feb 24 01:30:32 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:32 volumio volumio[1016]: info: Feb 24 01:30:32 volumio volumio[1016]: ---------------------------- MPD announces state update: update Feb 24 01:30:32 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:32 volumio volumio[1016]: info: Feb 24 01:30:32 volumio volumio[1016]: ---------------------------- MPD announces state update: update Feb 24 01:30:32 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:32 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:32 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:32 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:32 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:32 volumio volumio[1016]: info: sendMpdCommand status took 1 milliseconds Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:32 volumio volumio[1016]: info: Command Router : Notfying DB Updatetrue Feb 24 01:30:32 volumio volumio[1016]: info: CoreCommandRouter::Close All Modals sent Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:32 volumio volumio[1016]: info: Command Router : Notfying DB Updatetrue Feb 24 01:30:32 volumio volumio[1016]: info: CoreCommandRouter::Close All Modals sent Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:32 volumio volumio[1016]: info: Command Router : Notfying DB Updatetrue Feb 24 01:30:32 volumio volumio[1016]: info: CoreCommandRouter::Close All Modals sent Feb 24 01:30:32 volumio volumio[1016]: info: sendMpdCommand status took 62 milliseconds Feb 24 01:30:32 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 43 milliseconds Feb 24 01:30:32 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 24 milliseconds Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:32 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:32 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:32 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:32 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":true,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:32 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:32 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:32 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:32 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:32 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:32 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Feb 24 01:30:32 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:32 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:32 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:32 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:32 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:32 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":true,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:32 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:32 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:32 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:32 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:32 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:32 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:32 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:32 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:32.929+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:32 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:32.930+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:32 volumio volumio[1016]: info: ------------------------------ 72ms Feb 24 01:30:32 volumio volumio[1016]: info: ------------------------------ 71ms Feb 24 01:30:32 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:32.933+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:32 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:32.934+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:32 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 10 milliseconds Feb 24 01:30:32 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:32 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:32 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:32 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:32 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":true,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:32 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:32 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:32 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:32 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:32 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:32 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:32 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:32 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:32.938+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:32 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:32.938+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:32 volumio volumio[1016]: info: ------------------------------ 77ms Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:33 volumio volumio[1016]: info: Feb 24 01:30:33 volumio volumio[1016]: ---------------------------- MPD announces state update: update Feb 24 01:30:33 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:33 volumio volumio[1016]: info: Feb 24 01:30:33 volumio volumio[1016]: ---------------------------- MPD announces state update: update Feb 24 01:30:33 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:33 volumio volumio[1016]: info: Feb 24 01:30:33 volumio volumio[1016]: ---------------------------- MPD announces state update: update Feb 24 01:30:33 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:33 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:33 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:33 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:33 volumio volumio[1016]: info: Command Router : Notfying DB Updatefalse Feb 24 01:30:33 volumio volumio[1016]: info: CoreCommandRouter::Close All Modals sent Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:33 volumio volumio[1016]: info: Command Router : Notfying DB Updatefalse Feb 24 01:30:33 volumio volumio[1016]: info: CoreCommandRouter::Close All Modals sent Feb 24 01:30:33 volumio volumio[1016]: info: sendMpdCommand status took 40 milliseconds Feb 24 01:30:33 volumio volumio[1016]: info: sendMpdCommand status took 40 milliseconds Feb 24 01:30:33 volumio volumio[1016]: info: sendMpdCommand status took 40 milliseconds Feb 24 01:30:33 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 20 milliseconds Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:33 volumio volumio[1016]: info: Command Router : Notfying DB Updatefalse Feb 24 01:30:33 volumio volumio[1016]: info: CoreCommandRouter::Close All Modals sent Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:33 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:33 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:33 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:33 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:33 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:33 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:33 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:33 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:33 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:33 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Feb 24 01:30:33 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:33 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:33 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:33.116+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:33 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:33.117+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:33 volumio volumio[1016]: info: ------------------------------ 64ms Feb 24 01:30:33 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 24 milliseconds Feb 24 01:30:33 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 6 milliseconds Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:33 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:33 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:33 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:33 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:33 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:33 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:33 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:33 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:33 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:33 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:33 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:33 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:33 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:33 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:33 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:33 volumio volumio[1016]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":46969,"duration":305,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"1411 Kbps","isStreaming":false,"title":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:33 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:33 volumio volumio[1016]: info: CoreStateMachine::syncState stateService pause Feb 24 01:30:33 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus pause Feb 24 01:30:33 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:33 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:33 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:33 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:33 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:33.123+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:33 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:33.123+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_PAUSED positionMs=48366 volume=100 Feb 24 01:30:33 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:33.123+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:33 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:33.124+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:33 volumio volumio[1016]: info: ------------------------------ 70ms Feb 24 01:30:33 volumio volumio[1016]: info: ------------------------------ 70ms Feb 24 01:30:34 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Feb 24 01:30:34 volumio volumio[1016]: info: CURURI: music-library/NAS/Synology/Imelda May Feb 24 01:30:34 volumio volumio[1016]: info: Preload queue cleared Feb 24 01:30:36 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Feb 24 01:30:36 volumio volumio[1016]: info: CURURI: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored] Feb 24 01:30:36 volumio volumio[1016]: info: Preload queue cleared Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/03. Should've Been You.wav Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/04. Sixth Sense.wav Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/05. Human.wav Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/06. How Bad Can a Good Girl Be.wav Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/07. Bad Habit.wav Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/08. Levitate.wav Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/09. When It's My Time .wav Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/10. Leave Me Lonely.wav Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/11. The Girl I Used to Be.wav Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/12. The Longing [bonus track].wav Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/13. Flesh and Blood [bonus track].wav Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/14. Game Changer [bonus track].wav Feb 24 01:30:36 volumio volumio[1016]: info: Preloading song: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/15. Love and Fear [bonus track].wav Feb 24 01:30:36 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav in service mpd Feb 24 01:30:36 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F01.%20Call%20Me.wav&metadata=false Feb 24 01:30:36 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav Feb 24 01:30:36 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav in service mpd Feb 24 01:30:36 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F02.%20Black%20Tears%20%5Bfeat.%20Jeff%20Beck%5D.wav&metadata=false Feb 24 01:30:36 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav Feb 24 01:30:36 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/03. Should've Been You.wav in service mpd Feb 24 01:30:36 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F03.%20Should've%20Been%20You.wav&metadata=false Feb 24 01:30:36 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/03. Should've Been You.wav Feb 24 01:30:36 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/04. Sixth Sense.wav in service mpd Feb 24 01:30:36 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F04.%20Sixth%20Sense.wav&metadata=false Feb 24 01:30:36 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/04. Sixth Sense.wav Feb 24 01:30:36 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/05. Human.wav in service mpd Feb 24 01:30:36 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F05.%20Human.wav&metadata=false Feb 24 01:30:36 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/05. Human.wav Feb 24 01:30:36 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/06. How Bad Can a Good Girl Be.wav in service mpd Feb 24 01:30:37 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F06.%20How%20Bad%20Can%20a%20Good%20Girl%20Be.wav&metadata=false Feb 24 01:30:37 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/06. How Bad Can a Good Girl Be.wav Feb 24 01:30:37 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/07. Bad Habit.wav in service mpd Feb 24 01:30:37 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F07.%20Bad%20Habit.wav&metadata=false Feb 24 01:30:37 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/07. Bad Habit.wav Feb 24 01:30:37 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/08. Levitate.wav in service mpd Feb 24 01:30:37 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F08.%20Levitate.wav&metadata=false Feb 24 01:30:37 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/08. Levitate.wav Feb 24 01:30:37 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/09. When It's My Time .wav in service mpd Feb 24 01:30:37 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F09.%20When%20It's%20My%20Time%20.wav&metadata=false Feb 24 01:30:37 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/09. When It's My Time .wav Feb 24 01:30:37 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/10. Leave Me Lonely.wav in service mpd Feb 24 01:30:37 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F10.%20Leave%20Me%20Lonely.wav&metadata=false Feb 24 01:30:37 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/10. Leave Me Lonely.wav Feb 24 01:30:37 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/11. The Girl I Used to Be.wav in service mpd Feb 24 01:30:37 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F11.%20The%20Girl%20I%20Used%20to%20Be.wav&metadata=false Feb 24 01:30:37 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/11. The Girl I Used to Be.wav Feb 24 01:30:37 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/12. The Longing [bonus track].wav in service mpd Feb 24 01:30:37 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F12.%20The%20Longing%20%5Bbonus%20track%5D.wav&metadata=false Feb 24 01:30:37 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/12. The Longing [bonus track].wav Feb 24 01:30:37 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/13. Flesh and Blood [bonus track].wav in service mpd Feb 24 01:30:37 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F13.%20Flesh%20and%20Blood%20%5Bbonus%20track%5D.wav&metadata=false Feb 24 01:30:37 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/13. Flesh and Blood [bonus track].wav Feb 24 01:30:37 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/14. Game Changer [bonus track].wav in service mpd Feb 24 01:30:37 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F14.%20Game%20Changer%20%5Bbonus%20track%5D.wav&metadata=false Feb 24 01:30:37 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/14. Game Changer [bonus track].wav Feb 24 01:30:37 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/15. Love and Fear [bonus track].wav in service mpd Feb 24 01:30:37 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F15.%20Love%20and%20Fear%20%5Bbonus%20track%5D.wav&metadata=false Feb 24 01:30:37 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/15. Love and Fear [bonus track].wav Feb 24 01:30:37 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:30:37 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:30:40 volumio volumio[1016]: info: Preload queue cleared Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioReplaceandPlayItems Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::ClearQueue Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::stop Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::updateTrackBlock Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrackBlock Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::stPlaybackTimer Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::serviceStop Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::serviceStop Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::stop Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand stop Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::clearPlayQueue Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::saveQueue Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushQueue Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::addQueueItems Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::addQueueItems Feb 24 01:30:40 volumio volumio[1016]: info: Preload queue cleared Feb 24 01:30:40 volumio volumio[1016]: info: Adding Item to queue: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored] Feb 24 01:30:40 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored] in service mpd Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.933+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.933+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav" title="02 - A Touch Of Paradise.wav" Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand stop took 12 milliseconds Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F01.%20Call%20Me.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F02.%20Black%20Tears%20%5Bfeat.%20Jeff%20Beck%5D.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F03.%20Should've%20Been%20You.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/03. Should've Been You.wav Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F04.%20Sixth%20Sense.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/04. Sixth Sense.wav Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F05.%20Human.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/05. Human.wav Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F06.%20How%20Bad%20Can%20a%20Good%20Girl%20Be.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/06. How Bad Can a Good Girl Be.wav Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F07.%20Bad%20Habit.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/07. Bad Habit.wav Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F08.%20Levitate.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/08. Levitate.wav Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F09.%20When%20It's%20My%20Time%20.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/09. When It's My Time .wav Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F10.%20Leave%20Me%20Lonely.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/10. Leave Me Lonely.wav Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F11.%20The%20Girl%20I%20Used%20to%20Be.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/11. The Girl I Used to Be.wav Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F12.%20The%20Longing%20%5Bbonus%20track%5D.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/12. The Longing [bonus track].wav Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F13.%20Flesh%20and%20Blood%20%5Bbonus%20track%5D.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/13. Flesh and Blood [bonus track].wav Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F14.%20Game%20Changer%20%5Bbonus%20track%5D.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/14. Game Changer [bonus track].wav Feb 24 01:30:40 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2017%20-%20Life%20Love%20Flesh%20Blood%20%5Brestored%5D%2F15.%20Love%20and%20Fear%20%5Bbonus%20track%5D.wav&metadata=false Feb 24 01:30:40 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/15. Love and Fear [bonus track].wav Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand status took 5 milliseconds Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand status took 4 milliseconds Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand status took 4 milliseconds Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushQueue Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::saveQueue Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::updateTrackBlock Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrackBlock Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPlay Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::play index 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::stop Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::play index undefined Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::startPlaybackTimer Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::clearAddPlayTracks NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand stop Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 5 milliseconds Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 4 milliseconds Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 4 milliseconds Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand stop took 1 milliseconds Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand clear Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: 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":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:40 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio[1016]: info: No code Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: 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":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:40 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio[1016]: info: No code Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: 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":"02 - A Touch Of Paradise.wav","artist":null,"album":null,"uri":"NAS/Synology/BEADY BELLE/Beady Belle - Belvedere 2008/02 - A Touch Of Paradise.wav","trackType":"wav"} Feb 24 01:30:40 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio[1016]: info: No code Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.956+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.956+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.957+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.957+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.957+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.958+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.958+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.958+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:40 volumio volumio[1016]: info: ------------------------------ 23ms Feb 24 01:30:40 volumio volumio[1016]: info: ------------------------------ 22ms Feb 24 01:30:40 volumio volumio[1016]: info: ------------------------------ 23ms Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.958+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.958+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.958+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.958+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.958+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.958+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.959+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.957+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.959+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.959+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:40 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand clear took 18 milliseconds Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand add "NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:40 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:40 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:40 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:40 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:40 volumio volumio[1016]: info: ------------------------------ 3ms Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand add "NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" took 2 milliseconds Feb 24 01:30:40 volumio volumio[1016]: info: ------------------------------ 2ms Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand play Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:40 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:40 volumio volumio[1016]: info: ------------------------------ 3ms Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:40 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:40 volumio volumio[1016]: info: ------------------------------ 5ms Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand play took 5 milliseconds Feb 24 01:30:40 volumio volumio[1016]: info: ------------------------------ 5ms Feb 24 01:30:40 volumio volumio[1016]: info: ------------------------------ 3ms Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand status took 6 milliseconds Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand status took 6 milliseconds Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand status took 6 milliseconds Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:40 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:40 volumio volumio[1016]: info: Feb 24 01:30:40 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 2 milliseconds Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 2 milliseconds Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 2 milliseconds Feb 24 01:30:40 volumio volumio[1016]: info: sendMpdCommand status took 1 milliseconds Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:40 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:40 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio[1016]: info: No code Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:30:40 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:30:40 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:30:40 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:40 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio[1016]: info: No code Feb 24 01:30:40 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:40 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:40 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.999+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.999+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.999+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.999+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.999+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:40 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.999+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.000+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.000+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:40.999+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.000+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.000+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.000+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio[1016]: info: ------------------------------ 15ms Feb 24 01:30:41 volumio volumio[1016]: info: ------------------------------ 21ms Feb 24 01:30:41 volumio volumio[1016]: info: ------------------------------ 20ms Feb 24 01:30:41 volumio volumio[1016]: info: ------------------------------ 20ms Feb 24 01:30:41 volumio volumio[1016]: info: ------------------------------ 13ms Feb 24 01:30:41 volumio volumio[1016]: info: Feb 24 01:30:41 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:41 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:41 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:41 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:41 volumio volumio[1016]: info: ------------------------------ 15ms Feb 24 01:30:41 volumio volumio[1016]: info: sendMpdCommand status took 14 milliseconds Feb 24 01:30:41 volumio volumio[1016]: info: sendMpdCommand status took 1 milliseconds Feb 24 01:30:41 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:41 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:41 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:41 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:41 volumio volumio[1016]: info: No code Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:41 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:41 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:41 volumio volumio[1016]: info: No code Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.010+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.010+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.010+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.010+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.011+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.011+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.011+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.011+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.011+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.011+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.011+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.011+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio[1016]: info: ------------------------------ 23ms Feb 24 01:30:41 volumio volumio[1016]: info: ------------------------------ 10ms Feb 24 01:30:41 volumio volumio[1016]: info: Feb 24 01:30:41 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:41 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:41 volumio volumio[1016]: info: Feb 24 01:30:41 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:41 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:41 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:41 volumio volumio[1016]: info: Feb 24 01:30:41 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:41 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:41 volumio volumio[1016]: info: Feb 24 01:30:41 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:41 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:41 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:41 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:41 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:41 volumio volumio[1016]: info: ------------------------------ 6ms Feb 24 01:30:41 volumio volumio[1016]: info: sendMpdCommand status took 6 milliseconds Feb 24 01:30:41 volumio volumio[1016]: info: ------------------------------ 6ms Feb 24 01:30:41 volumio volumio[1016]: info: sendMpdCommand status took 5 milliseconds Feb 24 01:30:41 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:41 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:41 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:41 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:41 volumio volumio[1016]: info: No code Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:41 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:41 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:41 volumio volumio[1016]: info: No code Feb 24 01:30:41 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:41 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:41 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.026+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.026+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.026+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.027+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.027+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.027+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.027+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.027+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.028+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.028+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:41 volumio volumio[1016]: info: ------------------------------ 15ms Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.028+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:41 volumio volumio[1016]: info: ------------------------------ 14ms Feb 24 01:30:41 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:41.028+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:42 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:30:42 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:30:44 volumio volumio[1016]: info: CoreCommandRouter::volumioGetState Feb 24 01:30:44 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:47 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:30:47 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPlay Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::play index undefined Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::startPlaybackTimer Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::clearAddPlayTracks NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand stop Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand stop took 0 milliseconds Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand clear Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:50 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand clear took 1 milliseconds Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand add "NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:50 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:50 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:50 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand add "NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" took 1 milliseconds Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand play Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:50 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:50 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 2ms Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand play took 2 milliseconds Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:50 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand status took 6 milliseconds Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand status took 7 milliseconds Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand status took 7 milliseconds Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:50 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand status took 3 milliseconds Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 3 milliseconds Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand status took 3 milliseconds Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 2 milliseconds Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 2 milliseconds Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand status took 1 milliseconds Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:50 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: info: No code Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:50 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: info: No code Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:30:50 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:50 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: info: No code Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.641+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.641+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.642+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.642+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.642+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.643+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.643+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.643+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.643+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.643+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.644+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.644+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.644+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.644+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.644+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.644+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.645+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.645+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 20ms Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 26ms Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 20ms Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 26ms Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 26ms Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 18ms Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:50 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:50 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:50 volumio volumio[1016]: info: Feb 24 01:30:50 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:50 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:50 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:50 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 21ms Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand status took 20 milliseconds Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 2ms Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:50 volumio volumio[1016]: info: sendMpdCommand status took 1 milliseconds Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:50 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:50 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: info: No code Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:50 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: info: No code Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:50 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio[1016]: info: No code Feb 24 01:30:50 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:50 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:50 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.659+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.659+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.660+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.660+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.660+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.660+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.660+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.660+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.661+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.661+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.661+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 33ms Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 15ms Feb 24 01:30:50 volumio volumio[1016]: info: ------------------------------ 14ms Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.665+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.665+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.665+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.665+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.666+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.666+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:50 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:50.666+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:30:52 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPlay Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::play index undefined Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::startPlaybackTimer Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::clearAddPlayTracks NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand stop Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand stop took 1 milliseconds Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand clear Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:52 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand clear took 0 milliseconds Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand add "NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:52 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:52 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:52 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:52 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 2ms Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand add "NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" took 1 milliseconds Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand play Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:52 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:52 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand play took 1 milliseconds Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 0ms Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand status took 6 milliseconds Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand status took 7 milliseconds Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand status took 7 milliseconds Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:52 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand status took 3 milliseconds Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 3 milliseconds Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand status took 3 milliseconds Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 2 milliseconds Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 2 milliseconds Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand status took 1 milliseconds Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:52 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: info: No code Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:52 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: info: No code Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:30:52 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:52 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: info: No code Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.747+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.747+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.747+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.747+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.748+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.748+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.748+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.748+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.749+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.749+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.749+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.749+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.749+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.749+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.749+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.750+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.750+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.750+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 17ms Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 23ms Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 17ms Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 23ms Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 23ms Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 15ms Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:52 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:52 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:52 volumio volumio[1016]: info: Feb 24 01:30:52 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:52 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:52 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:52 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 17ms Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand status took 17 milliseconds Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 2ms Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 2ms Feb 24 01:30:52 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:52 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:52 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: info: No code Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:52 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: info: No code Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:52 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio[1016]: info: No code Feb 24 01:30:52 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:52 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:30:52 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.762+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.762+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.763+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.763+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.763+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.763+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.763+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.763+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.763+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.763+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.763+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.763+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.763+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.763+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.764+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.764+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.764+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:52 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:52.764+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 28ms Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 13ms Feb 24 01:30:52 volumio volumio[1016]: info: ------------------------------ 13ms Feb 24 01:30:57 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:30:57 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioNext Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::next Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::stop Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::play index undefined Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::startPlaybackTimer Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::clearAddPlayTracks NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand stop Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::updateTrackBlock Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrackBlock Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand stop took 1 milliseconds Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand clear Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:58 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand clear took 0 milliseconds Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand add "NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:58 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:58 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:58 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand add "NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" took 2 milliseconds Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand play Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:58 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:58 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand play took 1 milliseconds Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 0ms Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 0ms Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand status took 5 milliseconds Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand status took 6 milliseconds Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand status took 6 milliseconds Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:58 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:58 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand status took 6 milliseconds Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 6 milliseconds Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand status took 5 milliseconds Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 4 milliseconds Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 4 milliseconds Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand status took 3 milliseconds Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand status took 1 milliseconds Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:58 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: info: No code Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:58 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: info: No code Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:30:58 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:58 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: info: No code Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:58 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: info: No code Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.608+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.609+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.609+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.608+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.609+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.609+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.609+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.609+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.609+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.609+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.610+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.610+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.610+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.610+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.610+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.610+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.611+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.611+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.611+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.611+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.611+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.611+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.611+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.611+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 21ms Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 26ms Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 21ms Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 27ms Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 26ms Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 19ms Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 17ms Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:58 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:30:58 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:30:58 volumio volumio[1016]: info: Feb 24 01:30:58 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:30:58 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:58 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 3ms Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand status took 3 milliseconds Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 2ms Feb 24 01:30:58 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:58 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:58 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: info: No code Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:30:58 volumio volumio[1016]: verbose: CURRENT POSITION 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio[1016]: info: No code Feb 24 01:30:58 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:30:58 volumio volumio[1016]: info: CorePlayQueue::getTrack 1 Feb 24 01:30:58 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.628+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.628+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.628+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.628+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.628+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.628+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.628+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.629+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.629+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.629+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=0 volume=100 Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 12ms Feb 24 01:30:58 volumio volumio[1016]: info: ------------------------------ 10ms Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.629+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:30:58 volumio volumio5-onboarding[1356]: time=2026-02-24T01:30:58.629+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/02. Black Tears [feat. Jeff Beck].wav" title="02. Black Tears [feat. Jeff Beck].wav" Feb 24 01:31:02 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:31:02 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:31:07 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:31:07 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:31:09 volumio volumio[1016]: info: Preload queue cleared Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioReplaceandPlayItems Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::ClearQueue Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::stop Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::clearPlayQueue Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::saveQueue Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushQueue Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::addQueueItems Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::addQueueItems Feb 24 01:31:09 volumio volumio[1016]: info: Preload queue cleared Feb 24 01:31:09 volumio volumio[1016]: info: Adding Item to queue: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored] Feb 24 01:31:09 volumio volumio[1016]: info: Using cached record of: music-library/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored] Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushQueue Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::saveQueue Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::updateTrackBlock Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrackBlock Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPlay Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::play index 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::stop Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::play index undefined Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::startPlaybackTimer Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::clearAddPlayTracks NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand stop Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand stop took 1 milliseconds Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand clear Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:31:09 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand clear took 0 milliseconds Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand add "NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:31:09 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:31:09 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:31:09 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:31:09 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 2ms Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand add "NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" took 1 milliseconds Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 2ms Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 2ms Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand play Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:31:09 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:31:09 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 2ms Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand play took 1 milliseconds Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 1ms Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand status took 5 milliseconds Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand status took 6 milliseconds Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand status took 6 milliseconds Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand playlistinfo Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:31:09 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand status took 6 milliseconds Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 5 milliseconds Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand status took 5 milliseconds Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 4 milliseconds Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand playlistinfo took 4 milliseconds Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand status took 3 milliseconds Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::parseTrackInfo Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:31:09 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: info: No code Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:31:09 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: info: No code Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:31:09 volumio volumio[1016]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split') Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:31:09 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: info: No code Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.854+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.854+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.854+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.855+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.855+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.855+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.855+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.855+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.855+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.855+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.855+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.855+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.855+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.855+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.855+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.855+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.856+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.856+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 22ms Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 27ms Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 22ms Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 27ms Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 27ms Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 20ms Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:31:09 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces system playlist update Feb 24 01:31:09 volumio volumio[1016]: info: Ignoring MPD Status Update Feb 24 01:31:09 volumio volumio[1016]: info: Feb 24 01:31:09 volumio volumio[1016]: ---------------------------- MPD announces state update: player Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::getState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::sendMpdCommand status Feb 24 01:31:09 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:31:09 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:31:09 volumio volumio[1016]: error: updateQueue error: null Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 23ms Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand status took 20 milliseconds Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 3ms Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand status took 3 milliseconds Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 2ms Feb 24 01:31:09 volumio volumio[1016]: info: sendMpdCommand status took 2 milliseconds Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:31:09 volumio volumio[1016]: verbose: ControllerMpd::parseState Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:31:09 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: info: No code Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:31:09 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: info: No code Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: info: ControllerMpd::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::servicePushState Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Feb 24 01:31:09 volumio volumio[1016]: verbose: CURRENT POSITION 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::syncState stateService stop Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::syncState currentStatus stop Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio[1016]: info: No code Feb 24 01:31:09 volumio volumio[1016]: info: CoreStateMachine::pushState Feb 24 01:31:09 volumio volumio[1016]: info: CorePlayQueue::getTrack 0 Feb 24 01:31:09 volumio volumio[1016]: info: CoreCommandRouter::volumioPushState Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.875+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.875+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.875+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.875+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.875+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.875+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.875+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.875+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.875+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.875+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.875+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.875+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.876+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.876+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.876+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.876+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.876+02:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" state=STATUS_STOPPED positionMs=18 volume=100 Feb 24 01:31:09 volumio volumio5-onboarding[1356]: time=2026-02-24T01:31:09.876+02:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.0.136:43384 @ 0xc000279200" id="mnt/NAS/Synology/Imelda May/2017 - Life Love Flesh Blood [restored]/01. Call Me.wav" title="01. Call Me.wav" Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 38ms Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 18ms Feb 24 01:31:09 volumio volumio[1016]: info: ------------------------------ 18ms Feb 24 01:31:12 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:31:12 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:31:17 volumio dbus-daemon[828]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256) Feb 24 01:31:17 volumio volumio[1016]: info: Discovery: Restarting Browsing Feb 24 01:31:19 volumio volumio[1016]: info: Preload queue cleared Feb 24 01:31:19 volumio volumio[1016]: info: CoreCommandRouter::volumioReplaceandPlayItems Feb 24 01:31:19 volumio volumio[1016]: info: CoreStateMachine::ClearQueue Feb 24 01:31:19 volumio volumio[1016]: info: CoreStateMachine::stop Feb 24 01:31:19 volumio volumio[1016]: info: CoreStateMachine::setConsumeUpdateService undefined Feb 24 01:31:19 volumio volumio[1016]: info: CorePlayQueue::clearPlayQueue Feb 24 01:31:19 volumio volumio[1016]: info: CorePlayQueue::saveQueue Feb 24 01:31:19 volumio volumio[1016]: info: CoreCommandRouter::volumioPushQueue Feb 24 01:31:19 volumio volumio[1016]: info: CoreStateMachine::addQueueItems Feb 24 01:31:19 volumio volumio[1016]: info: CorePlayQueue::addQueueItems Feb 24 01:31:19 volumio volumio[1016]: info: Preload queue cleared Feb 24 01:31:19 volumio volumio[1016]: info: Adding Item to queue: music-library/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored] Feb 24 01:31:19 volumio volumio[1016]: info: Exploding uri music-library/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored] in service mpd Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F01.%2011%20Past%20the%20Hour.flac&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/01. 11 Past the Hour.flac Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F01.%2011%20Past%20the%20Hour.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/01. 11 Past the Hour.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F01.%2011%20Past%20the%20Hour_097_flac.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/01. 11 Past the Hour_097_flac.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F02.%20Breathe.flac&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/02. Breathe.flac Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F02.%20Breathe.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/02. Breathe.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F02.%20Breathe_098_flac.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/02. Breathe_098_flac.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F03.%20Made%20to%20Love%20%5Bfeat.%20Ronnie%20Wood%2C%20Gina%20Martin%20and%20Shola%20Mos-Shogbamimu%5D.flac&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/03. Made to Love [feat. Ronnie Wood, Gina Martin and Shola Mos-Shogbamimu].flac Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F03.%20Made%20to%20Love%20%5Bfeat.%20Ronnie%20Wood%2C%20Gina%20Martin%20and%20Shola%20Mos-Shogbamimu%5D.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/03. Made to Love [feat. Ronnie Wood, Gina Martin and Shola Mos-Shogbamimu].wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F04.%20Different%20Kinds%20of%20Love.flac&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/04. Different Kinds of Love.flac Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F04.%20Different%20Kinds%20of%20Love.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/04. Different Kinds of Love.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F04.%20Different%20Kinds%20of%20Love_100_flac.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/04. Different Kinds of Love_100_flac.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F05.%20Diamonds.flac&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/05. Diamonds.flac Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F05.%20Diamonds.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/05. Diamonds.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F05.%20Diamonds_101_flac.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/05. Diamonds_101_flac.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F06.%20Don't%20Let%20Me%20Stand%20on%20My%20Own%20%5Bfeat.%20Niall%20McNamee%5D.flac&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/06. Don't Let Me Stand on My Own [feat. Niall McNamee].flac Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F06.%20Don't%20Let%20Me%20Stand%20on%20My%20Own%20%5Bfeat.%20Niall%20McNamee%5D.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/06. Don't Let Me Stand on My Own [feat. Niall McNamee].wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F06.%20Don't%20Let%20Me%20Stand%20on%20My%20Own%20%5Bfeat.%20Niall%20McNamee%5D_102_flac.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/06. Don't Let Me Stand on My Own [feat. Niall McNamee]_102_flac.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F07.%20What%20We%20Did%20in%20the%20Dark%20%5Bfeat.%20Miles%20Kane%5D.flac&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/07. What We Did in the Dark [feat. Miles Kane].flac Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F07.%20What%20We%20Did%20in%20the%20Dark%20%5Bfeat.%20Miles%20Kane%5D.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/07. What We Did in the Dark [feat. Miles Kane].wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F07.%20What%20We%20Did%20in%20the%20Dark%20%5Bfeat.%20Miles%20Kane%5D_103_flac.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/07. What We Did in the Dark [feat. Miles Kane]_103_flac.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F08.%20Can't%20Say.flac&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/08. Can't Say.flac Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F08.%20Can't%20Say.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/08. Can't Say.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F08.%20Can't%20Say_104_flac.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/08. Can't Say_104_flac.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F09.%20Just%20One%20Kiss%20%5Bfeat.%20Noel%20Gallagher%20%26%20Ronnie%20Wood%5D.flac&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/09. Just One Kiss [feat. Noel Gallagher & Ronnie Wood].flac Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F09.%20Just%20One%20Kiss%20%5Bfeat.%20Noel%20Gallagher%20%26%20Ronnie%20Wood%5D.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/09. Just One Kiss [feat. Noel Gallagher & Ronnie Wood].wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F09.%20Just%20One%20Kiss%20%5Bfeat.%20Noel%20Gallagher%20%26%20Ronnie%20Wood%5D_105_flac.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/09. Just One Kiss [feat. Noel Gallagher & Ronnie Wood]_105_flac.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F10.%20Solace.flac&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/10. Solace.flac Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F10.%20Solace.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/10. Solace.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F10.%20Solace_106_flac.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/10. Solace_106_flac.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F11.%20Never%20Look%20Back.flac&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/11. Never Look Back.flac Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F11.%20Never%20Look%20Back.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/11. Never Look Back.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2F11.%20Never%20Look%20Back_107_flac.wav&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/11. Never Look Back_107_flac.wav Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2FImelda%20May%20-%2011%20Past%20the%20Hour.flac.cue&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/Imelda May - 11 Past the Hour.flac.cue Feb 24 01:31:19 volumio volumio[1016]: info: ALBUMART /albumart?cacheid=293&path=%2Fmnt%2FNAS%2FSynology%2FImelda%20May%2F2021%20-%2011%20Past%20the%20Hour%20%5Brestored%5D%2FImelda%20May%20-%2011%20Past%20the%20Hour.flac.cue&metadata=false Feb 24 01:31:19 volumio volumio[1016]: info: URI /mnt/NAS/Synology/Imelda May/2021 - 11 Past the Hour [restored]/Imelda May - 11 Past the Hour.flac.cue Feb 24 01:31:19 volumio volumio[1016]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Feb 24 01:31:19 volumio volumio[1016]: Error: Unable to resolve or reject the same promise twice Feb 24 01:31:19 volumio volumio[1016]: at Promise.resolve (/volumio/node_modules/kew/kew.js:140:43) Feb 24 01:31:19 volumio volumio[1016]: at /volumio/app/plugins/music_service/mpd/index.js:2582:21 Feb 24 01:31:19 volumio volumio[1016]: at MpdClient.handleMessage (/volumio/app/plugins/music_service/mpd/lib/mpd.js:77:3) Feb 24 01:31:19 volumio volumio[1016]: at MpdClient.receive (/volumio/app/plugins/music_service/mpd/lib/mpd.js:68:12) Feb 24 01:31:19 volumio volumio[1016]: at Socket. (/volumio/app/plugins/music_service/mpd/lib/mpd.js:43:12) Feb 24 01:31:19 volumio volumio[1016]: at Socket.emit (node:events:514:28) Feb 24 01:31:19 volumio volumio[1016]: at addChunk (node:internal/streams/readable:343:12) Feb 24 01:31:19 volumio volumio[1016]: at readableAddChunk (node:internal/streams/readable:312:11) Feb 24 01:31:19 volumio volumio[1016]: at Readable.push (node:internal/streams/readable:253:10) Feb 24 01:31:19 volumio volumio[1016]: at Pipe.onStreamRead (node:internal/stream_base_commons:190:23) Feb 24 01:31:19 volumio volumio[1016]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Feb 24 01:31:19 volumio sudo[16266]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-02-24 01:30' Feb 24 01:31:19 volumio sudo[16266]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) PRETTY_NAME="Debian GNU/Linux 12 (bookworm)" NAME="Debian GNU/Linux" VERSION_ID="12" VERSION="12 (bookworm)" VERSION_CODENAME=bookworm 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="a78d359cf1dc63ac74e9d151015afd30d31a709a" VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd" VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2" VOLUMIO_BE_VERSION="c1ffe93b2136013fc1b5903a4ed7e3f34e0a7bec" VOLUMIO_ARCH="x64" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Thu Feb 5 14:31:57 UTC 2026" VOLUMIO_VERSION="4.096" VOLUMIO_HARDWARE="x86_amd64" VOLUMIO_DEVICENAME="x86_64" VOLUMIO_HASH="6759e875c98b942866984e844891d6c1"