Apr 14 21:34:02 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri
Apr 14 21:34:02 volumio volumio[1127]: info: CURURI: artists://Jet
Apr 14 21:34:02 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:34:02 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Get Born/01. Last Chance.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Get Born/02. Are You Gonna Be My Girl.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Get Born/03. Rollover DJ.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Get Born/04. Look What You've Done.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Get Born/05. Get What You Need.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Get Born/06. Move On.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Get Born/07. Radio Song.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Get Born/08. Get Me Outta Here.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Get Born/09. Cold Hard Bitch.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Get Born/10. Come Around Again.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Get Born/11. Take It Or Leave It.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Get Born/12. Lazy Gun.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Get Born/13. Timothy.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Shine On/01-jet-lesprit_descalier.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Shine On/02-jet-holiday.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Shine On/03-jet-put_your_money_where_your_mouth_is.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Shine On/04-jet-bring_it_on_back.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Shine On/05-jet-thats_all_lies.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Shine On/06-jet-kings_horses.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Shine On/07-jet-shine_on.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Shine On/08-jet-come_on_come_on.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Shine On/10-jet-rip_it_up.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Shine On/11-jet-skin_and_bones.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Shine On/12-jet-shiny_magazine.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Shine On/13-jet-eleanor.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Jet/Shine On/14-jet-all_you_have_to_do.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Get Born/01. Last Chance.mp3 in service mpd
Apr 14 21:34:02 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Get%20Born/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FGet%20Born%2F01.%20Last%20Chance.mp3&metadata=false
Apr 14 21:34:02 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Get Born/01. Last Chance.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: No valid Plugin REST Endpoint
Apr 14 21:34:02 volumio volumio[1127]: info: No valid Plugin REST Endpoint
Apr 14 21:34:02 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Get Born/02. Are You Gonna Be My Girl.mp3 in service mpd
Apr 14 21:34:02 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Get%20Born/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FGet%20Born%2F02.%20Are%20You%20Gonna%20Be%20My%20Girl.mp3&metadata=false
Apr 14 21:34:02 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Get Born/02. Are You Gonna Be My Girl.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Get Born/03. Rollover DJ.mp3 in service mpd
Apr 14 21:34:02 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Get%20Born/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FGet%20Born%2F03.%20Rollover%20DJ.mp3&metadata=false
Apr 14 21:34:02 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Get Born/03. Rollover DJ.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Get Born/04. Look What You've Done.mp3 in service mpd
Apr 14 21:34:02 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Get%20Born/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FGet%20Born%2F04.%20Look%20What%20You've%20Done.mp3&metadata=false
Apr 14 21:34:02 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Get Born/04. Look What You've Done.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Get Born/05. Get What You Need.mp3 in service mpd
Apr 14 21:34:02 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Get%20Born/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FGet%20Born%2F05.%20Get%20What%20You%20Need.mp3&metadata=false
Apr 14 21:34:02 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Get Born/05. Get What You Need.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Get Born/06. Move On.mp3 in service mpd
Apr 14 21:34:02 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Get%20Born/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FGet%20Born%2F06.%20Move%20On.mp3&metadata=false
Apr 14 21:34:02 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Get Born/06. Move On.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Get Born/07. Radio Song.mp3 in service mpd
Apr 14 21:34:02 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Get%20Born/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FGet%20Born%2F07.%20Radio%20Song.mp3&metadata=false
Apr 14 21:34:02 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Get Born/07. Radio Song.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Get Born/08. Get Me Outta Here.mp3 in service mpd
Apr 14 21:34:02 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Get%20Born/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FGet%20Born%2F08.%20Get%20Me%20Outta%20Here.mp3&metadata=false
Apr 14 21:34:02 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Get Born/08. Get Me Outta Here.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:34:02 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Get Born/09. Cold Hard Bitch.mp3 in service mpd
Apr 14 21:34:02 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Get%20Born/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FGet%20Born%2F09.%20Cold%20Hard%20Bitch.mp3&metadata=false
Apr 14 21:34:02 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Get Born/09. Cold Hard Bitch.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Get Born/10. Come Around Again.mp3 in service mpd
Apr 14 21:34:02 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Get%20Born/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FGet%20Born%2F10.%20Come%20Around%20Again.mp3&metadata=false
Apr 14 21:34:02 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Get Born/10. Come Around Again.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Get Born/11. Take It Or Leave It.mp3 in service mpd
Apr 14 21:34:02 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Get%20Born/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FGet%20Born%2F11.%20Take%20It%20Or%20Leave%20It.mp3&metadata=false
Apr 14 21:34:02 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Get Born/11. Take It Or Leave It.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Get Born/12. Lazy Gun.mp3 in service mpd
Apr 14 21:34:02 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Get%20Born/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FGet%20Born%2F12.%20Lazy%20Gun.mp3&metadata=false
Apr 14 21:34:02 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Get Born/12. Lazy Gun.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Get Born/13. Timothy.mp3 in service mpd
Apr 14 21:34:02 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Get%20Born/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FGet%20Born%2F13.%20Timothy.mp3&metadata=false
Apr 14 21:34:02 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Get Born/13. Timothy.mp3
Apr 14 21:34:02 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Shine On/01-jet-lesprit_descalier.mp3 in service mpd
Apr 14 21:34:02 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Shine%20On/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FShine%20On%2F01-jet-lesprit_descalier.mp3&metadata=false
Apr 14 21:34:02 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Shine On/01-jet-lesprit_descalier.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Shine On/02-jet-holiday.mp3 in service mpd
Apr 14 21:34:03 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Shine%20On/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FShine%20On%2F02-jet-holiday.mp3&metadata=false
Apr 14 21:34:03 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Shine On/02-jet-holiday.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Shine On/03-jet-put_your_money_where_your_mouth_is.mp3 in service mpd
Apr 14 21:34:03 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Shine%20On/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FShine%20On%2F03-jet-put_your_money_where_your_mouth_is.mp3&metadata=false
Apr 14 21:34:03 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Shine On/03-jet-put_your_money_where_your_mouth_is.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Shine On/04-jet-bring_it_on_back.mp3 in service mpd
Apr 14 21:34:03 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Shine%20On/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FShine%20On%2F04-jet-bring_it_on_back.mp3&metadata=false
Apr 14 21:34:03 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Shine On/04-jet-bring_it_on_back.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Shine On/05-jet-thats_all_lies.mp3 in service mpd
Apr 14 21:34:03 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Shine%20On/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FShine%20On%2F05-jet-thats_all_lies.mp3&metadata=false
Apr 14 21:34:03 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Shine On/05-jet-thats_all_lies.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Shine On/06-jet-kings_horses.mp3 in service mpd
Apr 14 21:34:03 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Shine%20On/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FShine%20On%2F06-jet-kings_horses.mp3&metadata=false
Apr 14 21:34:03 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Shine On/06-jet-kings_horses.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Shine On/07-jet-shine_on.mp3 in service mpd
Apr 14 21:34:03 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Shine%20On/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FShine%20On%2F07-jet-shine_on.mp3&metadata=false
Apr 14 21:34:03 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Shine On/07-jet-shine_on.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Shine On/08-jet-come_on_come_on.mp3 in service mpd
Apr 14 21:34:03 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Shine%20On/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FShine%20On%2F08-jet-come_on_come_on.mp3&metadata=false
Apr 14 21:34:03 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Shine On/08-jet-come_on_come_on.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3 in service mpd
Apr 14 21:34:03 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Shine%20On/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FShine%20On%2F09-jet-stand_up.mp3&metadata=false
Apr 14 21:34:03 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Shine On/10-jet-rip_it_up.mp3 in service mpd
Apr 14 21:34:03 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Shine%20On/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FShine%20On%2F10-jet-rip_it_up.mp3&metadata=false
Apr 14 21:34:03 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Shine On/10-jet-rip_it_up.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioReplaceandPlayItems
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::ClearQueue
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::stop
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::stPlaybackTimer
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::updateTrackBlock
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrackBlock
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::serviceStop
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::serviceStop
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::stop
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand stop
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::clearPlayQueue
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::saveQueue
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushQueue
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::addQueueItems
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::addQueueItems
Apr 14 21:34:03 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Get Born/01. Last Chance.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Get Born/01. Last Chance.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Get Born/02. Are You Gonna Be My Girl.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Get Born/02. Are You Gonna Be My Girl.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Get Born/03. Rollover DJ.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Get Born/03. Rollover DJ.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Get Born/04. Look What You've Done.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Get Born/04. Look What You've Done.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Get Born/05. Get What You Need.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Get Born/05. Get What You Need.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Get Born/06. Move On.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Get Born/06. Move On.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Get Born/07. Radio Song.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Get Born/07. Radio Song.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Get Born/08. Get Me Outta Here.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Get Born/08. Get Me Outta Here.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Get Born/09. Cold Hard Bitch.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Get Born/09. Cold Hard Bitch.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Get Born/10. Come Around Again.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Get Born/10. Come Around Again.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Get Born/11. Take It Or Leave It.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Get Born/11. Take It Or Leave It.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Get Born/12. Lazy Gun.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Get Born/12. Lazy Gun.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Get Born/13. Timothy.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Get Born/13. Timothy.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Shine On/01-jet-lesprit_descalier.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Shine On/01-jet-lesprit_descalier.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Shine On/02-jet-holiday.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Shine On/02-jet-holiday.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Shine On/03-jet-put_your_money_where_your_mouth_is.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Shine On/03-jet-put_your_money_where_your_mouth_is.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Shine On/04-jet-bring_it_on_back.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Shine On/04-jet-bring_it_on_back.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Shine On/05-jet-thats_all_lies.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Shine On/05-jet-thats_all_lies.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Shine On/06-jet-kings_horses.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Shine On/06-jet-kings_horses.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Shine On/07-jet-shine_on.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Shine On/07-jet-shine_on.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Shine On/08-jet-come_on_come_on.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Shine On/08-jet-come_on_come_on.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.525+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.526+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="music-library/USB/B63F-82DE/Music/Beck/Guero/01 E-Pro.mp3" title=E-Pro
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushQueue
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::saveQueue
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::updateTrackBlock
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrackBlock
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPlay
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::play index 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::addQueueItems
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::addQueueItems
Apr 14 21:34:03 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Shine On/10-jet-rip_it_up.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Jet/Shine On/10-jet-rip_it_up.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Shine On/11-jet-skin_and_bones.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Shine On/11-jet-skin_and_bones.mp3 in service mpd
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Shine On/12-jet-shiny_magazine.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Shine On/12-jet-shiny_magazine.mp3 in service mpd
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Shine On/13-jet-eleanor.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Shine On/13-jet-eleanor.mp3 in service mpd
Apr 14 21:34:03 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Jet/Shine On/14-jet-all_you_have_to_do.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Jet/Shine On/14-jet-all_you_have_to_do.mp3 in service mpd
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::stop
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::play index undefined
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::startPlaybackTimer
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::clearAddPlayTracks USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand stop
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:03 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Shine%20On/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FShine%20On%2F11-jet-skin_and_bones.mp3&metadata=false
Apr 14 21:34:03 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Shine On/11-jet-skin_and_bones.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Shine%20On/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FShine%20On%2F12-jet-shiny_magazine.mp3&metadata=false
Apr 14 21:34:03 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Shine On/12-jet-shiny_magazine.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Shine%20On/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FShine%20On%2F13-jet-eleanor.mp3&metadata=false
Apr 14 21:34:03 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Shine On/13-jet-eleanor.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Jet/Shine%20On/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FJet%2FShine%20On%2F14-jet-all_you_have_to_do.mp3&metadata=false
Apr 14 21:34:03 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Jet/Shine On/14-jet-all_you_have_to_do.mp3
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand stop took 90 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand stop took 26 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand clear
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushQueue
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::saveQueue
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::updateTrackBlock
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrackBlock
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:34:03 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand status took 33 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand clear took 32 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand status took 14 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand status took 14 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand add "USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3"
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: 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}
Apr 14 21:34:03 volumio volumio[1127]: verbose: CURRENT POSITION 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState stateService stop
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus stop
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: No code
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: 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}
Apr 14 21:34:03 volumio volumio[1127]: verbose: CURRENT POSITION 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState stateService stop
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus stop
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: No code
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.664+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.665+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.666+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.667+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.669+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.669+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.671+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.672+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.673+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.674+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.676+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.676+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio[1127]: info: ------------------------------ 107ms
Apr 14 21:34:03 volumio volumio[1127]: info: ------------------------------ 107ms
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:34:03 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:34:03 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:34:03 volumio volumio[1127]: error: updateQueue error: null
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:34:03 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:34:03 volumio volumio[1127]: info: ------------------------------ 130ms
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 126 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand add "USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" took 126 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: ------------------------------ 35ms
Apr 14 21:34:03 volumio volumio[1127]: info: ------------------------------ 33ms
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand play
Apr 14 21:34:03 volumio volumio[1127]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split')
Apr 14 21:34:03 volumio volumio[1127]: info: ------------------------------ 171ms
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:34:03 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:34:03 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:34:03 volumio volumio[1127]: info: ------------------------------ 17ms
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand play took 12 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: ------------------------------ 10ms
Apr 14 21:34:03 volumio volumio[1127]: info: ------------------------------ 9ms
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand status took 18 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand status took 10 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:03 volumio volumio[1127]: info:
Apr 14 21:34:03 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand status took 20 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand status took 17 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 16 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 18 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand status took 9 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand status took 9 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":273,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Stand Up","artist":"Jet","album":"Shine On","uri":"USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3","trackType":"mp3"}
Apr 14 21:34:03 volumio volumio[1127]: verbose: CURRENT POSITION 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState stateService play
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus stop
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":273,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Stand Up","artist":"Jet","album":"Shine On","uri":"USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3","trackType":"mp3"}
Apr 14 21:34:03 volumio volumio[1127]: verbose: CURRENT POSITION 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState stateService play
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus play
Apr 14 21:34:03 volumio volumio[1127]: info: Received an update from plugin. extracting info from payload
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: ------------------------------ 68ms
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.867+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=0 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.868+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.870+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=0 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.871+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio[1127]: info: ------------------------------ 81ms
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 53 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 54 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 51 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 51 milliseconds
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:34:03 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: verbose: STATE SERVICE {"status":"play","position":0,"seek":962,"duration":273,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"Stand Up","artist":"Jet","album":"Shine On","uri":"USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3","trackType":"mp3"}
Apr 14 21:34:03 volumio volumio[1127]: verbose: CURRENT POSITION 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState stateService play
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus play
Apr 14 21:34:03 volumio volumio[1127]: info: Received an update from plugin. extracting info from payload
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: verbose: STATE SERVICE {"status":"play","position":0,"seek":962,"duration":273,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"Stand Up","artist":"Jet","album":"Shine On","uri":"USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3","trackType":"mp3"}
Apr 14 21:34:03 volumio volumio[1127]: verbose: CURRENT POSITION 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState stateService play
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus play
Apr 14 21:34:03 volumio volumio[1127]: info: Received an update from plugin. extracting info from payload
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: verbose: STATE SERVICE {"status":"play","position":0,"seek":962,"duration":273,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"Stand Up","artist":"Jet","album":"Shine On","uri":"USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3","trackType":"mp3"}
Apr 14 21:34:03 volumio volumio[1127]: verbose: CURRENT POSITION 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState stateService play
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus play
Apr 14 21:34:03 volumio volumio[1127]: info: Received an update from plugin. extracting info from payload
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: verbose: STATE SERVICE {"status":"play","position":0,"seek":962,"duration":273,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"192 Kbps","isStreaming":false,"title":"Stand Up","artist":"Jet","album":"Shine On","uri":"USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3","trackType":"mp3"}
Apr 14 21:34:03 volumio volumio[1127]: verbose: CURRENT POSITION 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState stateService play
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus play
Apr 14 21:34:03 volumio volumio[1127]: info: Received an update from plugin. extracting info from payload
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:03 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:03 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.937+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=962 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.937+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.940+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=962 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.940+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.944+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=962 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.944+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.948+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=962 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.948+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.952+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=962 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.953+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.955+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=962 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.955+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.962+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=962 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.963+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.967+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=962 volume=100
Apr 14 21:34:03 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:03.967+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:04 volumio volumio[1127]: info: ------------------------------ 254ms
Apr 14 21:34:04 volumio volumio[1127]: info: ------------------------------ 250ms
Apr 14 21:34:04 volumio volumio[1127]: info: ------------------------------ 237ms
Apr 14 21:34:04 volumio volumio[1127]: info: ------------------------------ 237ms
Apr 14 21:34:06 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:34:10 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:34:12 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri
Apr 14 21:34:12 volumio volumio[1127]: info: CURURI: artists://Black%20Mountain
Apr 14 21:34:12 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:34:12 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:34:12 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/01-black_mountain-the_hair_song.mp3
Apr 14 21:34:12 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/02-black_mountain-old_fangs.mp3
Apr 14 21:34:12 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/03-black_mountain-radiant_hearts.mp3
Apr 14 21:34:12 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/04-black_mountain-rollercoaster.mp3
Apr 14 21:34:12 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/05-black_mountain-let_spirits_ride.mp3
Apr 14 21:34:12 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:12 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/07-black_mountain-the_way_to_go.mp3
Apr 14 21:34:12 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/08-black_mountain-wilderness_heart.mp3
Apr 14 21:34:12 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/09-black_mountain-the_space_in_your_mind.mp3
Apr 14 21:34:12 volumio volumio[1127]: info: Preloading song: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/10-black_mountain-sadie.mp3
Apr 14 21:34:12 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/01-black_mountain-the_hair_song.mp3 in service mpd
Apr 14 21:34:12 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Black%20Mountain/Wilderness%20Heart/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FBlack%20Mountain%2FWilderness%20Heart%2F01-black_mountain-the_hair_song.mp3&metadata=false
Apr 14 21:34:12 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/01-black_mountain-the_hair_song.mp3
Apr 14 21:34:12 volumio volumio[1127]: info: No valid Plugin REST Endpoint
Apr 14 21:34:12 volumio volumio[1127]: info: No valid Plugin REST Endpoint
Apr 14 21:34:12 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/02-black_mountain-old_fangs.mp3 in service mpd
Apr 14 21:34:12 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Black%20Mountain/Wilderness%20Heart/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FBlack%20Mountain%2FWilderness%20Heart%2F02-black_mountain-old_fangs.mp3&metadata=false
Apr 14 21:34:12 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/02-black_mountain-old_fangs.mp3
Apr 14 21:34:12 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/03-black_mountain-radiant_hearts.mp3 in service mpd
Apr 14 21:34:12 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Black%20Mountain/Wilderness%20Heart/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FBlack%20Mountain%2FWilderness%20Heart%2F03-black_mountain-radiant_hearts.mp3&metadata=false
Apr 14 21:34:12 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/03-black_mountain-radiant_hearts.mp3
Apr 14 21:34:12 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/04-black_mountain-rollercoaster.mp3 in service mpd
Apr 14 21:34:12 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Black%20Mountain/Wilderness%20Heart/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FBlack%20Mountain%2FWilderness%20Heart%2F04-black_mountain-rollercoaster.mp3&metadata=false
Apr 14 21:34:12 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/04-black_mountain-rollercoaster.mp3
Apr 14 21:34:13 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/05-black_mountain-let_spirits_ride.mp3 in service mpd
Apr 14 21:34:13 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Black%20Mountain/Wilderness%20Heart/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FBlack%20Mountain%2FWilderness%20Heart%2F05-black_mountain-let_spirits_ride.mp3&metadata=false
Apr 14 21:34:13 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/05-black_mountain-let_spirits_ride.mp3
Apr 14 21:34:13 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3 in service mpd
Apr 14 21:34:13 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Black%20Mountain/Wilderness%20Heart/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FBlack%20Mountain%2FWilderness%20Heart%2F06-black_mountain-buried_by_the_blues.mp3&metadata=false
Apr 14 21:34:13 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:13 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/07-black_mountain-the_way_to_go.mp3 in service mpd
Apr 14 21:34:13 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Black%20Mountain/Wilderness%20Heart/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FBlack%20Mountain%2FWilderness%20Heart%2F07-black_mountain-the_way_to_go.mp3&metadata=false
Apr 14 21:34:13 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/07-black_mountain-the_way_to_go.mp3
Apr 14 21:34:13 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/08-black_mountain-wilderness_heart.mp3 in service mpd
Apr 14 21:34:13 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Black%20Mountain/Wilderness%20Heart/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FBlack%20Mountain%2FWilderness%20Heart%2F08-black_mountain-wilderness_heart.mp3&metadata=false
Apr 14 21:34:13 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/08-black_mountain-wilderness_heart.mp3
Apr 14 21:34:13 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/09-black_mountain-the_space_in_your_mind.mp3 in service mpd
Apr 14 21:34:13 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Black%20Mountain/Wilderness%20Heart/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FBlack%20Mountain%2FWilderness%20Heart%2F09-black_mountain-the_space_in_your_mind.mp3&metadata=false
Apr 14 21:34:13 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/09-black_mountain-the_space_in_your_mind.mp3
Apr 14 21:34:13 volumio volumio[1127]: info: Exploding uri music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/10-black_mountain-sadie.mp3 in service mpd
Apr 14 21:34:13 volumio volumio[1127]: info: ALBUMART /albumart?cacheid=949&web=Black%20Mountain/Wilderness%20Heart/extralarge&path=%2Fmnt%2FUSB%2FB63F-82DE%2FMusic%2FBlack%20Mountain%2FWilderness%20Heart%2F10-black_mountain-sadie.mp3&metadata=false
Apr 14 21:34:13 volumio volumio[1127]: info: URI /mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/10-black_mountain-sadie.mp3
Apr 14 21:34:14 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:34:15 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri
Apr 14 21:34:15 volumio volumio[1127]: info: CURURI: artists://Black%20Mountain/Wilderness%20Heart
Apr 14 21:34:15 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:34:15 volumio volumio[1127]: info: No valid Plugin REST Endpoint
Apr 14 21:34:15 volumio volumio[1127]: info: No valid Plugin REST Endpoint
Apr 14 21:34:18 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:34:20 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::volumioReplaceandPlayItems
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::ClearQueue
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::stop
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::stPlaybackTimer
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::updateTrackBlock
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrackBlock
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::serviceStop
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrack 21
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::serviceStop
Apr 14 21:34:20 volumio volumio[1127]: info: ControllerMpd::stop
Apr 14 21:34:20 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand stop
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::clearPlayQueue
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::saveQueue
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::volumioPushQueue
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::addQueueItems
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::addQueueItems
Apr 14 21:34:20 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:34:20 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/01-black_mountain-the_hair_song.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/01-black_mountain-the_hair_song.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/02-black_mountain-old_fangs.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/02-black_mountain-old_fangs.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/03-black_mountain-radiant_hearts.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/03-black_mountain-radiant_hearts.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/04-black_mountain-rollercoaster.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/04-black_mountain-rollercoaster.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/05-black_mountain-let_spirits_ride.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/05-black_mountain-let_spirits_ride.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:20 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:20.799+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:34:20 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:20.806+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Jet/Shine On/09-jet-stand_up.mp3" title="Stand Up"
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::volumioPushQueue
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::saveQueue
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::updateTrackBlock
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrackBlock
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::volumioPlay
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::play index 5
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::addQueueItems
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::addQueueItems
Apr 14 21:34:20 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:34:20 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/07-black_mountain-the_way_to_go.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/07-black_mountain-the_way_to_go.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/08-black_mountain-wilderness_heart.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/08-black_mountain-wilderness_heart.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/09-black_mountain-the_space_in_your_mind.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/09-black_mountain-the_space_in_your_mind.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Adding Item to queue: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/10-black_mountain-sadie.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: Using cached record of: music-library/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/10-black_mountain-sadie.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::stop
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::volumioPushQueue
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::saveQueue
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::play index undefined
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::updateTrackBlock
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrackBlock
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::startPlaybackTimer
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:20 volumio volumio[1127]: verbose: ControllerMpd::clearAddPlayTracks USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:20 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand stop
Apr 14 21:34:20 volumio volumio[1127]: info:
Apr 14 21:34:20 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:20 volumio volumio[1127]: info: sendMpdCommand stop took 77 milliseconds
Apr 14 21:34:20 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:20 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:20 volumio volumio[1127]: info: sendMpdCommand stop took 11 milliseconds
Apr 14 21:34:20 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand clear
Apr 14 21:34:20 volumio volumio[1127]: info:
Apr 14 21:34:20 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:20 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:20 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:20 volumio volumio[1127]: info:
Apr 14 21:34:20 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:20 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:20 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:20 volumio volumio[1127]: info:
Apr 14 21:34:20 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:34:20 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:34:20 volumio volumio[1127]: info: sendMpdCommand status took 10 milliseconds
Apr 14 21:34:20 volumio volumio[1127]: info: sendMpdCommand clear took 9 milliseconds
Apr 14 21:34:20 volumio volumio[1127]: info: sendMpdCommand status took 8 milliseconds
Apr 14 21:34:20 volumio volumio[1127]: info: sendMpdCommand status took 7 milliseconds
Apr 14 21:34:20 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:20 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:34:20 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand add "USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3"
Apr 14 21:34:20 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:20 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:20 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:20 volumio volumio[1127]: 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}
Apr 14 21:34:20 volumio volumio[1127]: verbose: CURRENT POSITION 5
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::syncState stateService stop
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus stop
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:20 volumio volumio[1127]: info: No code
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:20 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:20 volumio volumio[1127]: 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}
Apr 14 21:34:20 volumio volumio[1127]: verbose: CURRENT POSITION 5
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::syncState stateService stop
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus stop
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:20 volumio volumio[1127]: info: No code
Apr 14 21:34:20 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:20 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:20 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:20 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:20.900+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:34:20 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:20.900+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:20 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:20.903+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:34:20 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:20.904+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:20 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:20.906+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:34:20 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:20.906+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:20 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:20.909+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:34:20 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:20.909+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:20 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:20.912+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:34:20 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:20.912+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:20 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:20.915+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:34:20 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:20.915+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:20 volumio volumio[1127]: info: ------------------------------ 96ms
Apr 14 21:34:20 volumio volumio[1127]: info: ------------------------------ 96ms
Apr 14 21:34:20 volumio volumio[1127]: info:
Apr 14 21:34:20 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:34:20 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:34:20 volumio volumio[1127]: info:
Apr 14 21:34:20 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:34:20 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:34:20 volumio volumio[1127]: error: updateQueue error: null
Apr 14 21:34:20 volumio volumio[1127]: info:
Apr 14 21:34:20 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:34:20 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:34:20 volumio volumio[1127]: info: ------------------------------ 97ms
Apr 14 21:34:20 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 96 milliseconds
Apr 14 21:34:20 volumio volumio[1127]: info: sendMpdCommand add "USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" took 96 milliseconds
Apr 14 21:34:20 volumio volumio[1127]: info: ------------------------------ 9ms
Apr 14 21:34:20 volumio volumio[1127]: info: ------------------------------ 7ms
Apr 14 21:34:20 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:34:20 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand play
Apr 14 21:34:20 volumio volumio[1127]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split')
Apr 14 21:34:20 volumio volumio[1127]: info: ------------------------------ 110ms
Apr 14 21:34:20 volumio volumio[1127]: info:
Apr 14 21:34:20 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:34:20 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:34:20 volumio volumio[1127]: info:
Apr 14 21:34:20 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:34:20 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:34:21 volumio volumio[1127]: info:
Apr 14 21:34:21 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:21 volumio volumio[1127]: info: ------------------------------ 39ms
Apr 14 21:34:21 volumio volumio[1127]: info: sendMpdCommand play took 36 milliseconds
Apr 14 21:34:21 volumio volumio[1127]: info: ------------------------------ 35ms
Apr 14 21:34:21 volumio volumio[1127]: info: ------------------------------ 34ms
Apr 14 21:34:21 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:21 volumio volumio[1127]: info:
Apr 14 21:34:21 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:21 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:21 volumio volumio[1127]: info:
Apr 14 21:34:21 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:21 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:21 volumio volumio[1127]: info:
Apr 14 21:34:21 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:21 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:21 volumio volumio[1127]: info: sendMpdCommand status took 16 milliseconds
Apr 14 21:34:21 volumio volumio[1127]: info: sendMpdCommand status took 16 milliseconds
Apr 14 21:34:21 volumio volumio[1127]: info: sendMpdCommand status took 12 milliseconds
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:34:21 volumio volumio[1127]: info:
Apr 14 21:34:21 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:21 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:21 volumio volumio[1127]: info:
Apr 14 21:34:21 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:34:21 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:34:21 volumio volumio[1127]: info: sendMpdCommand status took 15 milliseconds
Apr 14 21:34:21 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 13 milliseconds
Apr 14 21:34:21 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 13 milliseconds
Apr 14 21:34:21 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 13 milliseconds
Apr 14 21:34:21 volumio volumio[1127]: info: sendMpdCommand status took 12 milliseconds
Apr 14 21:34:21 volumio volumio[1127]: info: sendMpdCommand status took 10 milliseconds
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:34:21 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: verbose: STATE SERVICE {"status":"play","position":0,"seek":968,"duration":243,"samplerate":"48 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"320 Kbps","isStreaming":false,"title":"06-black_mountain-buried_by_the_blues.mp3","artist":"Black Mountain","album":"Wilderness Heart","uri":"USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3","trackType":"mp3"}
Apr 14 21:34:21 volumio volumio[1127]: verbose: CURRENT POSITION 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::syncState stateService play
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus stop
Apr 14 21:34:21 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: verbose: STATE SERVICE {"status":"play","position":0,"seek":968,"duration":243,"samplerate":"48 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"320 Kbps","isStreaming":false,"title":"06-black_mountain-buried_by_the_blues.mp3","artist":"Black Mountain","album":"Wilderness Heart","uri":"USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3","trackType":"mp3"}
Apr 14 21:34:21 volumio volumio[1127]: verbose: CURRENT POSITION 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::syncState stateService play
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus play
Apr 14 21:34:21 volumio volumio[1127]: info: Received an update from plugin. extracting info from payload
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:21 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: verbose: STATE SERVICE {"status":"play","position":0,"seek":968,"duration":243,"samplerate":"48 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"320 Kbps","isStreaming":false,"title":"06-black_mountain-buried_by_the_blues.mp3","artist":"Black Mountain","album":"Wilderness Heart","uri":"USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3","trackType":"mp3"}
Apr 14 21:34:21 volumio volumio[1127]: verbose: CURRENT POSITION 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::syncState stateService play
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus play
Apr 14 21:34:21 volumio volumio[1127]: info: Received an update from plugin. extracting info from payload
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:21 volumio volumio[1127]: info: ------------------------------ 57ms
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.070+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=968 volume=100
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.071+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.073+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=968 volume=100
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.074+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.076+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=968 volume=100
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.077+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.079+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=968 volume=100
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.080+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:21 volumio volumio[1127]: info: ------------------------------ 112ms
Apr 14 21:34:21 volumio volumio[1127]: info: ------------------------------ 108ms
Apr 14 21:34:21 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 86 milliseconds
Apr 14 21:34:21 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 85 milliseconds
Apr 14 21:34:21 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 85 milliseconds
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:34:21 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:34:21 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: verbose: STATE SERVICE {"status":"play","position":0,"seek":968,"duration":243,"samplerate":"48 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"320 Kbps","isStreaming":false,"title":"06-black_mountain-buried_by_the_blues.mp3","artist":"Black Mountain","album":"Wilderness Heart","uri":"USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3","trackType":"mp3"}
Apr 14 21:34:21 volumio volumio[1127]: verbose: CURRENT POSITION 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::syncState stateService play
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus play
Apr 14 21:34:21 volumio volumio[1127]: info: Received an update from plugin. extracting info from payload
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:21 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: verbose: STATE SERVICE {"status":"play","position":0,"seek":968,"duration":243,"samplerate":"48 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"320 Kbps","isStreaming":false,"title":"06-black_mountain-buried_by_the_blues.mp3","artist":"Black Mountain","album":"Wilderness Heart","uri":"USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3","trackType":"mp3"}
Apr 14 21:34:21 volumio volumio[1127]: verbose: CURRENT POSITION 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::syncState stateService play
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus play
Apr 14 21:34:21 volumio volumio[1127]: info: Received an update from plugin. extracting info from payload
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:21 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: verbose: STATE SERVICE {"status":"play","position":0,"seek":968,"duration":243,"samplerate":"48 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"320 Kbps","isStreaming":false,"title":"06-black_mountain-buried_by_the_blues.mp3","artist":"Black Mountain","album":"Wilderness Heart","uri":"USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3","trackType":"mp3"}
Apr 14 21:34:21 volumio volumio[1127]: verbose: CURRENT POSITION 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::syncState stateService play
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus play
Apr 14 21:34:21 volumio volumio[1127]: info: Received an update from plugin. extracting info from payload
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:21 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:34:21 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:34:21 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.159+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=968 volume=100
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.159+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.162+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=968 volume=100
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.162+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.165+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=968 volume=100
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.165+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.168+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=968 volume=100
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.168+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.174+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=968 volume=100
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.175+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.177+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_PLAYING positionMs=968 volume=100
Apr 14 21:34:21 volumio volumio5-onboarding[1460]: time=2026-04-14T21:34:21.178+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:34:21 volumio volumio[1127]: info: ------------------------------ 201ms
Apr 14 21:34:21 volumio volumio[1127]: info: ------------------------------ 197ms
Apr 14 21:34:21 volumio volumio[1127]: info: ------------------------------ 196ms
Apr 14 21:34:22 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:34:26 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:34:30 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:34:34 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:34:38 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:34:42 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:34:46 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:34:50 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:34:54 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:34:58 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:35:02 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:35:06 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:35:10 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:35:14 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:35:18 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:35:22 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:35:26 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Apr 14 21:35:28 volumio volumio[1127]: info: CoreCommandRouter::volumioGetState
Apr 14 21:35:28 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:35:39 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: motherearthradio , handleBrowseUri
Apr 14 21:35:39 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:35:48 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:35:48 volumio volumio[1127]: info: CoreCommandRouter::volumioReplaceandPlayItems
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::ClearQueue
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::stop
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::stPlaybackTimer
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::updateTrackBlock
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::getTrackBlock
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:35:48 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Apr 14 21:35:48 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::serviceStop
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::getTrack 5
Apr 14 21:35:48 volumio volumio[1127]: info: CoreCommandRouter::serviceStop
Apr 14 21:35:48 volumio volumio[1127]: info: ControllerMpd::stop
Apr 14 21:35:48 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand stop
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::clearPlayQueue
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::saveQueue
Apr 14 21:35:48 volumio volumio[1127]: info: CoreCommandRouter::volumioPushQueue
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::addQueueItems
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::addQueueItems
Apr 14 21:35:48 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:35:48 volumio volumio[1127]: info: Adding Item to queue: motherearthradio/instrumental/flac192
Apr 14 21:35:48 volumio volumio[1127]: info: Exploding uri motherearthradio/instrumental/flac192 in service motherearthradio
Apr 14 21:35:48 volumio volumio5-onboarding[1460]: time=2026-04-14T21:35:48.761+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:35:48 volumio volumio5-onboarding[1460]: time=2026-04-14T21:35:48.763+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id="mnt/USB/B63F-82DE/Music/Black Mountain/Wilderness Heart/06-black_mountain-buried_by_the_blues.mp3" title=06-black_mountain-buried_by_the_blues.mp3
Apr 14 21:35:48 volumio volumio[1127]: info: CoreCommandRouter::volumioPushQueue
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::saveQueue
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::updateTrackBlock
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::getTrackBlock
Apr 14 21:35:48 volumio volumio[1127]: info: CoreCommandRouter::volumioPlay
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::play index 0
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::stop
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::play index undefined
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::startPlaybackTimer
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:48 volumio volumio[1127]: info: [MER] ▶️ Playing: https://stream.motherearthradio.de/listen/motherearth_instrumental/motherearth.instrumental
Apr 14 21:35:48 volumio volumio[1127]: info: [MER] 🔌 Starting SSE for Instrumental
Apr 14 21:35:48 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand stop
Apr 14 21:35:48 volumio volumio[1127]: info:
Apr 14 21:35:48 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:35:48 volumio volumio[1127]: info: sendMpdCommand stop took 47 milliseconds
Apr 14 21:35:48 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:35:48 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:35:48 volumio volumio[1127]: info: sendMpdCommand stop took 10 milliseconds
Apr 14 21:35:48 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand clear
Apr 14 21:35:48 volumio volumio[1127]: info:
Apr 14 21:35:48 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:35:48 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:35:48 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:35:48 volumio volumio[1127]: info:
Apr 14 21:35:48 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:35:48 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:35:48 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:35:48 volumio volumio[1127]: info:
Apr 14 21:35:48 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:35:48 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:35:48 volumio volumio[1127]: info: sendMpdCommand status took 7 milliseconds
Apr 14 21:35:48 volumio volumio[1127]: info: sendMpdCommand clear took 5 milliseconds
Apr 14 21:35:48 volumio volumio[1127]: info: sendMpdCommand status took 4 milliseconds
Apr 14 21:35:48 volumio volumio[1127]: info: sendMpdCommand status took 2 milliseconds
Apr 14 21:35:48 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:35:48 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:35:48 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand add "https://stream.motherearthradio.de/listen/motherearth_instrumental/motherearth.instrumental"
Apr 14 21:35:48 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:35:48 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:35:48 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:35:48 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:48 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Apr 14 21:35:48 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:48 volumio volumio[1127]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current motherearthradio Received mpd
Apr 14 21:35:48 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:35:48 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:48 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:48 volumio volumio[1127]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current motherearthradio Received mpd
Apr 14 21:35:48 volumio volumio5-onboarding[1460]: time=2026-04-14T21:35:48.829+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:35:48 volumio volumio5-onboarding[1460]: time=2026-04-14T21:35:48.829+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id=motherearthradio/instrumental/flac192 title=Instrumental
Apr 14 21:35:48 volumio volumio5-onboarding[1460]: time=2026-04-14T21:35:48.831+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:35:48 volumio volumio5-onboarding[1460]: time=2026-04-14T21:35:48.831+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id=motherearthradio/instrumental/flac192 title=Instrumental
Apr 14 21:35:48 volumio volumio[1127]: info: ------------------------------ 38ms
Apr 14 21:35:48 volumio volumio[1127]: info: ------------------------------ 37ms
Apr 14 21:35:48 volumio volumio[1127]: info:
Apr 14 21:35:48 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:35:48 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:35:48 volumio volumio[1127]: info:
Apr 14 21:35:48 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:35:48 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:35:48 volumio volumio[1127]: error: updateQueue error: null
Apr 14 21:35:48 volumio volumio[1127]: info:
Apr 14 21:35:48 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:35:48 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:35:48 volumio volumio[1127]: info: ------------------------------ 41ms
Apr 14 21:35:48 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 39 milliseconds
Apr 14 21:35:48 volumio volumio[1127]: info: sendMpdCommand add "https://stream.motherearthradio.de/listen/motherearth_instrumental/motherearth.instrumental" took 39 milliseconds
Apr 14 21:35:48 volumio volumio[1127]: info: ------------------------------ 5ms
Apr 14 21:35:48 volumio volumio[1127]: info: ------------------------------ 4ms
Apr 14 21:35:48 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:35:48 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand play
Apr 14 21:35:48 volumio volumio[1127]: error: ControllerMpd::pushError: TypeError: Cannot read properties of undefined (reading 'split')
Apr 14 21:35:48 volumio volumio[1127]: info: ------------------------------ 57ms
Apr 14 21:35:48 volumio volumio[1127]: info:
Apr 14 21:35:48 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:35:48 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:35:48 volumio volumio[1127]: info:
Apr 14 21:35:48 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:35:48 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:35:48 volumio volumio[1127]: info: ------------------------------ 27ms
Apr 14 21:35:48 volumio volumio[1127]: info: sendMpdCommand play took 17 milliseconds
Apr 14 21:35:48 volumio volumio[1127]: info: ------------------------------ 16ms
Apr 14 21:35:48 volumio volumio[1127]: info: ------------------------------ 14ms
Apr 14 21:35:48 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:35:48 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:48 volumio volumio[1127]: verbose: STATE SERVICE {"status":"play","service":"motherearthradio","type":"webradio","trackType":"flac","radioType":"mer","title":"Connecting...","artist":"Mother Earth Radio","album":"Instrumental · FLAC 192kHz/24bit Stereo","albumart":"/albumart?sourceicon=music_service/motherearthradio/mer-logo-cube-bold-1x 512.png","uri":"motherearthradio/instrumental/flac192","streaming":true,"disableUiControls":true,"samplerate":"192 kHz","bitdepth":"24 bit","duration":0,"seek":0}
Apr 14 21:35:48 volumio volumio[1127]: verbose: CURRENT POSITION 0
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::syncState stateService play
Apr 14 21:35:48 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus stop
Apr 14 21:35:49 volumio volumio[1127]: info:
Apr 14 21:35:49 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:35:49 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:35:49 volumio volumio[1127]: info:
Apr 14 21:35:49 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:35:49 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:35:49 volumio volumio[1127]: info:
Apr 14 21:35:49 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:35:49 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:35:49 volumio volumio[1127]: info:
Apr 14 21:35:49 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:35:49 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:35:49 volumio volumio[1127]: info:
Apr 14 21:35:49 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:35:49 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:35:49 volumio volumio[1127]: info:
Apr 14 21:35:49 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:35:49 volumio volumio[1127]: info: sendMpdCommand status took 7 milliseconds
Apr 14 21:35:49 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:35:49 volumio volumio[1127]: info: sendMpdCommand status took 6 milliseconds
Apr 14 21:35:49 volumio volumio[1127]: info: sendMpdCommand status took 6 milliseconds
Apr 14 21:35:49 volumio volumio[1127]: info: sendMpdCommand status took 4 milliseconds
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:35:49 volumio volumio[1127]: info: sendMpdCommand status took 6 milliseconds
Apr 14 21:35:49 volumio volumio[1127]: info: sendMpdCommand status took 4 milliseconds
Apr 14 21:35:49 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 3 milliseconds
Apr 14 21:35:49 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 2 milliseconds
Apr 14 21:35:49 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 2 milliseconds
Apr 14 21:35:49 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 3 milliseconds
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:35:49 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:35:49 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:35:49 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:49 volumio volumio[1127]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current motherearthradio Received mpd
Apr 14 21:35:49 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:35:49 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:35:49 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:49 volumio volumio[1127]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current motherearthradio Received mpd
Apr 14 21:35:49 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:35:49 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:35:49 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:49 volumio volumio[1127]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current motherearthradio Received mpd
Apr 14 21:35:49 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:35:49 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:35:49 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:49 volumio volumio[1127]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current motherearthradio Received mpd
Apr 14 21:35:49 volumio volumio[1127]: info: ------------------------------ 20ms
Apr 14 21:35:49 volumio volumio[1127]: info: ------------------------------ 19ms
Apr 14 21:35:49 volumio volumio[1127]: info: ------------------------------ 18ms
Apr 14 21:35:49 volumio volumio[1127]: info: ------------------------------ 17ms
Apr 14 21:35:49 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 8 milliseconds
Apr 14 21:35:49 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 9 milliseconds
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:35:49 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:35:49 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:35:49 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:35:49 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:49 volumio volumio[1127]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current motherearthradio Received mpd
Apr 14 21:35:49 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:35:49 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:35:49 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:49 volumio volumio[1127]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current motherearthradio Received mpd
Apr 14 21:35:49 volumio volumio[1127]: info: ------------------------------ 19ms
Apr 14 21:35:49 volumio volumio[1127]: info: ------------------------------ 18ms
Apr 14 21:35:50 volumio volumio[1127]: info:
Apr 14 21:35:50 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:35:50 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:35:50 volumio volumio[1127]: info:
Apr 14 21:35:50 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:35:50 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:35:50 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:35:50 volumio volumio[1127]: info:
Apr 14 21:35:50 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:35:50 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:35:50 volumio volumio[1127]: info:
Apr 14 21:35:50 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:35:50 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:35:50 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:35:50 volumio volumio[1127]: info:
Apr 14 21:35:50 volumio volumio[1127]: ---------------------------- MPD announces system playlist update
Apr 14 21:35:50 volumio volumio[1127]: info: Ignoring MPD Status Update
Apr 14 21:35:50 volumio volumio[1127]: info:
Apr 14 21:35:50 volumio volumio[1127]: ---------------------------- MPD announces state update: player
Apr 14 21:35:50 volumio volumio[1127]: info: ControllerMpd::getState
Apr 14 21:35:50 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand status
Apr 14 21:35:50 volumio volumio[1127]: info: ------------------------------ 9ms
Apr 14 21:35:50 volumio volumio[1127]: info: sendMpdCommand status took 8 milliseconds
Apr 14 21:35:50 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:35:50 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:35:50 volumio volumio[1127]: info: ------------------------------ 13ms
Apr 14 21:35:50 volumio volumio[1127]: info: sendMpdCommand status took 12 milliseconds
Apr 14 21:35:50 volumio volumio[1127]: info: ------------------------------ 10ms
Apr 14 21:35:50 volumio volumio[1127]: info: sendMpdCommand status took 8 milliseconds
Apr 14 21:35:50 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 6 milliseconds
Apr 14 21:35:50 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:35:50 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:35:50 volumio volumio[1127]: verbose: ControllerMpd::parseState
Apr 14 21:35:50 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Apr 14 21:35:50 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:35:50 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:35:50 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:35:50 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:50 volumio volumio[1127]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current motherearthradio Received mpd
Apr 14 21:35:50 volumio volumio[1127]: info: ------------------------------ 18ms
Apr 14 21:35:50 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 3 milliseconds
Apr 14 21:35:50 volumio volumio[1127]: info: sendMpdCommand playlistinfo took 3 milliseconds
Apr 14 21:35:50 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:35:50 volumio volumio[1127]: verbose: ControllerMpd::parseTrackInfo
Apr 14 21:35:50 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:35:50 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:35:50 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:50 volumio volumio[1127]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current motherearthradio Received mpd
Apr 14 21:35:50 volumio volumio[1127]: info: ControllerMpd::pushState
Apr 14 21:35:50 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:35:50 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:50 volumio volumio[1127]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current motherearthradio Received mpd
Apr 14 21:35:50 volumio volumio[1127]: info: ------------------------------ 19ms
Apr 14 21:35:50 volumio volumio[1127]: info: ------------------------------ 15ms
Apr 14 21:35:50 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:35:50 volumio volumio[1127]: info: CoreCommandRouter::volumioReplaceandPlayItems
Apr 14 21:35:50 volumio volumio[1127]: info: CoreStateMachine::ClearQueue
Apr 14 21:35:50 volumio volumio[1127]: info: CoreStateMachine::stop
Apr 14 21:35:50 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:35:50 volumio volumio[1127]: info: CoreStateMachine::stPlaybackTimer
Apr 14 21:35:50 volumio volumio[1127]: info: CoreStateMachine::updateTrackBlock
Apr 14 21:35:50 volumio volumio[1127]: info: CorePlayQueue::getTrackBlock
Apr 14 21:35:50 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:35:50 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:50 volumio volumio[1127]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Apr 14 21:35:50 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:35:50 volumio volumio[1127]: info: CoreStateMachine::serviceStop
Apr 14 21:35:50 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:50 volumio volumio[1127]: info: CoreCommandRouter::serviceStop
Apr 14 21:35:51 volumio volumio[1127]: info: CoreCommandRouter::servicePushState
Apr 14 21:35:51 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:35:51 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:51 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:35:51 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:51 volumio volumio[1127]: verbose: STATE SERVICE {"status":"stop","service":"motherearthradio"}
Apr 14 21:35:51 volumio volumio[1127]: verbose: CURRENT POSITION 0
Apr 14 21:35:51 volumio volumio[1127]: info: CoreStateMachine::syncState stateService stop
Apr 14 21:35:51 volumio volumio[1127]: info: CoreStateMachine::syncState currentStatus stop
Apr 14 21:35:51 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:35:51 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:51 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:35:51 volumio volumio[1127]: info: No code
Apr 14 21:35:51 volumio volumio[1127]: info: CoreStateMachine::pushState
Apr 14 21:35:51 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:51 volumio volumio[1127]: info: CoreCommandRouter::volumioPushState
Apr 14 21:35:51 volumio volumio[1127]: info: ControllerMpd::stop
Apr 14 21:35:51 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand stop
Apr 14 21:35:51 volumio volumio[1127]: info: CorePlayQueue::clearPlayQueue
Apr 14 21:35:51 volumio volumio[1127]: info: CorePlayQueue::saveQueue
Apr 14 21:35:51 volumio volumio[1127]: info: CoreCommandRouter::volumioPushQueue
Apr 14 21:35:51 volumio volumio[1127]: info: CoreStateMachine::addQueueItems
Apr 14 21:35:51 volumio volumio[1127]: info: CorePlayQueue::addQueueItems
Apr 14 21:35:51 volumio volumio[1127]: info: Preload queue cleared
Apr 14 21:35:51 volumio volumio[1127]: info: Adding Item to queue: motherearthradio/instrumental/flac192
Apr 14 21:35:51 volumio volumio[1127]: info: Using cached record of: motherearthradio/instrumental/flac192
Apr 14 21:35:51 volumio volumio5-onboarding[1460]: time=2026-04-14T21:35:51.008+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:35:51 volumio volumio5-onboarding[1460]: time=2026-04-14T21:35:51.011+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:35:51 volumio volumio5-onboarding[1460]: time=2026-04-14T21:35:51.012+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id=motherearthradio/instrumental/flac192 title=Instrumental
Apr 14 21:35:51 volumio volumio5-onboarding[1460]: time=2026-04-14T21:35:51.013+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:35:51 volumio volumio5-onboarding[1460]: time=2026-04-14T21:35:51.014+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id=motherearthradio/instrumental/flac192 title=Instrumental
Apr 14 21:35:51 volumio volumio5-onboarding[1460]: time=2026-04-14T21:35:51.014+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id=motherearthradio/instrumental/flac192 title=Instrumental
Apr 14 21:35:51 volumio volumio5-onboarding[1460]: time=2026-04-14T21:35:51.020+01:00 level=INFO msg="emitting player state changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" state=STATUS_STOPPED positionMs=0 volume=100
Apr 14 21:35:51 volumio volumio5-onboarding[1460]: time=2026-04-14T21:35:51.020+01:00 level=INFO msg="emitting player metadata changed event" component=server peer="192.168.1.201:56522 @ 0x250e660" id=motherearthradio/instrumental/flac192 title=Instrumental
Apr 14 21:35:51 volumio volumio[1127]: info: CoreCommandRouter::volumioPushQueue
Apr 14 21:35:51 volumio volumio[1127]: info: CorePlayQueue::saveQueue
Apr 14 21:35:51 volumio volumio[1127]: info: CoreStateMachine::updateTrackBlock
Apr 14 21:35:51 volumio volumio[1127]: info: CorePlayQueue::getTrackBlock
Apr 14 21:35:51 volumio volumio[1127]: info: CoreCommandRouter::volumioPlay
Apr 14 21:35:51 volumio volumio[1127]: info: CoreStateMachine::play index 0
Apr 14 21:35:51 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:35:51 volumio volumio[1127]: info: CoreStateMachine::stop
Apr 14 21:35:51 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:35:51 volumio volumio[1127]: info: CoreStateMachine::play index undefined
Apr 14 21:35:51 volumio volumio[1127]: info: CoreStateMachine::setConsumeUpdateService undefined
Apr 14 21:35:51 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:51 volumio volumio[1127]: info: CoreStateMachine::startPlaybackTimer
Apr 14 21:35:51 volumio volumio[1127]: info: CorePlayQueue::getTrack 0
Apr 14 21:35:51 volumio volumio[1127]: info: [MER] ▶️ Playing: https://stream.motherearthradio.de/listen/motherearth_instrumental/motherearth.instrumental
Apr 14 21:35:51 volumio volumio[1127]: info: [MER] 🔌 Starting SSE for Instrumental
Apr 14 21:35:51 volumio volumio[1127]: verbose: ControllerMpd::sendMpdCommand stop
Apr 14 21:35:51 volumio volumio[1127]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Apr 14 21:35:51 volumio volumio[1127]: Error: socket hang up
Apr 14 21:35:51 volumio volumio[1127]: at connResetException (node:internal/errors:720:14)
Apr 14 21:35:51 volumio volumio[1127]: at TLSSocket.socketCloseListener (node:_http_client:468:25)
Apr 14 21:35:51 volumio volumio[1127]: at TLSSocket.emit (node:events:526:35)
Apr 14 21:35:51 volumio volumio[1127]: at node:net:337:12
Apr 14 21:35:51 volumio volumio[1127]: at TCP.done (node:_tls_wrap:631:7) {
Apr 14 21:35:51 volumio volumio[1127]: code: 'ECONNRESET'
Apr 14 21:35:51 volumio volumio[1127]: }
Apr 14 21:35:51 volumio volumio[1127]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Apr 14 21:35:51 volumio sudo[3000]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-04-14 21:34'
Apr 14 21:35:51 volumio sudo[3000]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
PRETTY_NAME="Raspbian GNU/Linux 12 (bookworm)"
NAME="Raspbian GNU/Linux"
VERSION_ID="12"
VERSION="12 (bookworm)"
VERSION_CODENAME=bookworm
ID=raspbian
ID_LIKE=debian
HOME_URL="http://www.raspbian.org/"
SUPPORT_URL="http://www.raspbian.org/RaspbianForums"
BUG_REPORT_URL="http://www.raspbian.org/RaspbianBugs"
VOLUMIO_BUILD_VERSION="18952480e8d8c63f22208e9007a0f47a9563eae6"
VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd"
VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2"
VOLUMIO_BE_VERSION="0e58f1861fa88e02087981b8d91f7511f0e7011b"
VOLUMIO_ARCH="arm"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Tue Mar 24 17:20:52 UTC 2026"
VOLUMIO_VERSION="4.119"
VOLUMIO_HARDWARE="pi"
VOLUMIO_DEVICENAME="Raspberry Pi"
VOLUMIO_HASH="d0c2fd9dbc5e70e58c32413c12353563"