-- Logs begin at Sat 2025-05-10 23:40:12 +07, end at Sun 2025-05-11 00:03:42 +07. -- May 11 00:02:09 volumio ntpd[1078]: Soliciting pool server 2400:e920:0:5::14 May 11 00:02:12 volumio ntpd[1078]: Soliciting pool server 103.70.115.65 May 11 00:02:22 volumio ntpd[1078]: Soliciting pool server 103.70.115.65 May 11 00:02:25 volumio ntpd[1078]: Soliciting pool server 103.70.115.65 May 11 00:02:36 volumio volumio[1090]: info: Preload queue cleared May 11 00:02:36 volumio volumio[1090]: info: CoreCommandRouter::volumioReplaceandPlayItems May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::ClearQueue May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::stop May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::setConsumeUpdateService undefined May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::stPlaybackTimer May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::updateTrackBlock May 11 00:02:36 volumio volumio[1090]: info: CorePlayQueue::getTrackBlock May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::pushState May 11 00:02:36 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:36 volumio volumio[1090]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 11 00:02:36 volumio volumio[1090]: info: CoreCommandRouter::volumioPushState May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::serviceStop May 11 00:02:36 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:36 volumio volumio[1090]: info: CoreCommandRouter::serviceStop May 11 00:02:36 volumio volumio[1090]: info: ControllerMpd::stop May 11 00:02:36 volumio volumio[1090]: verbose: ControllerMpd::sendMpdCommand stop May 11 00:02:36 volumio volumio[1090]: info: CorePlayQueue::clearPlayQueue May 11 00:02:36 volumio volumio[1090]: info: CorePlayQueue::saveQueue May 11 00:02:36 volumio volumio[1090]: info: CoreCommandRouter::volumioPushQueue May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::addQueueItems May 11 00:02:36 volumio volumio[1090]: info: CorePlayQueue::addQueueItems May 11 00:02:36 volumio volumio[1090]: info: Preload queue cleared May 11 00:02:36 volumio volumio[1090]: info: Adding Item to queue: music-library/USB/DAT_MUA/24 Bits/Golden Memories - Vol1 May 11 00:02:36 volumio volumio[1090]: info: Exploding uri music-library/USB/DAT_MUA/24 Bits/Golden Memories - Vol1 in service mpd May 11 00:02:36 volumio volumio[1090]: SPOTIFY: RECEIVED VOLUMIO VOLUME 100 May 11 00:02:36 volumio volumio[1090]: info: May 11 00:02:36 volumio volumio[1090]: ---------------------------- MPD announces state update: player May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F01.%20How%20Can%20I%20Tell%20Her.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/01. How Can I Tell Her.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F02.%20Angel%20Queen.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/02. Angel Queen.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F03.%20Sealed%20With%20A%20Kiss.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/03. Sealed With A Kiss.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F04.%20Soley%20Soley.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/04. Soley Soley.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F05.%20Autumn%20Leaves.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/05. Autumn Leaves.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F06.%20Sayonara.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/06. Sayonara.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F07.%20Let%20It%20Be%20Me.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/07. Let It Be Me.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F08.%20Beautiful%20Sunday.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/08. Beautiful Sunday.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F09.%20You%20Were%20On%20My%20Mind.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/09. You Were On My Mind.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F10.%20I%20Will%20Follow%20Him.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/10. I Will Follow Him.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F11.%20You%20Make%20Me%20Feel%20Like%20Dancing.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/11. You Make Me Feel Like Dancing.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F12.%20Runaway.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/12. Runaway.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F13.%20Shanghai%20Memories%20of%201945.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/13. Shanghai Memories of 1945.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F14.%20Don't%20Expect%20Me%20To%20Be%20Your%20Friend.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/14. Don't Expect Me To Be Your Friend.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F15.%20King%20Of%20The%20Road.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/15. King Of The Road.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F16.%20Only%20The%20Lonely.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/16. Only The Lonely.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F17.%20Will%20You%20Love%20Me%20Tomorrow.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/17. Will You Love Me Tomorrow.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F18.%20Why.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/18. Why.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F19.%20Spanish%20Harlem.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/19. Spanish Harlem.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F20.%20Billy%20Don't%20Be%20A%20Hero.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/20. Billy Don't Be A Hero.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Various/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F21.%20Do%20You%20Wanna%20Make%20Love.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/21. Do You Wanna Make Love.wav May 11 00:02:36 volumio volumio[1090]: info: ALBUMART /albumart?cacheid=376&web=Pinball%20Wizard/Golden%20Memories%20%20-%20Vol%201/extralarge&path=%2Fmnt%2FUSB%2FDAT_MUA%2F24%20Bits%2FGolden%20Memories%20-%20Vol1%2F22.%20See%20Me%2C%20Feel%20Me.wav&metadata=false May 11 00:02:36 volumio volumio[1090]: info: URI /mnt/USB/DAT_MUA/24 Bits/Golden Memories - Vol1/22. See Me, Feel Me.wav May 11 00:02:36 volumio volumio[1090]: info: sendMpdCommand stop took 154 milliseconds May 11 00:02:36 volumio volumio[1090]: info: ControllerMpd::getState May 11 00:02:36 volumio volumio[1090]: verbose: ControllerMpd::sendMpdCommand status May 11 00:02:36 volumio volumio[1090]: info: CoreCommandRouter::volumioPushQueue May 11 00:02:36 volumio volumio[1090]: info: CorePlayQueue::saveQueue May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::updateTrackBlock May 11 00:02:36 volumio volumio[1090]: info: CorePlayQueue::getTrackBlock May 11 00:02:36 volumio volumio[1090]: info: CoreCommandRouter::volumioPlay May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::play index 0 May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::setConsumeUpdateService undefined May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::stop May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::setConsumeUpdateService undefined May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::play index undefined May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::setConsumeUpdateService undefined May 11 00:02:36 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:36 volumio volumio[1090]: info: CoreStateMachine::startPlaybackTimer May 11 00:02:36 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:36 volumio volumio[1090]: verbose: ControllerMpd::clearAddPlayTracks USB/DAT_MUA/24 Bits/Golden Memories - Vol1/01. How Can I Tell Her.wav May 11 00:02:36 volumio volumio[1090]: verbose: ControllerMpd::sendMpdCommand stop May 11 00:02:36 volumio volumio[1090]: error: error May 11 00:02:36 volumio volumio[1090]: info: sendMpdCommand status took 84 milliseconds May 11 00:02:36 volumio volumio[1090]: info: sendMpdCommand stop took 16 milliseconds May 11 00:02:36 volumio volumio[1090]: verbose: ControllerMpd::parseState May 11 00:02:36 volumio volumio[1090]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 11 00:02:36 volumio volumio[1090]: verbose: ControllerMpd::sendMpdCommand clear May 11 00:02:37 volumio volumio[1090]: info: May 11 00:02:37 volumio volumio[1090]: ---------------------------- MPD announces system playlist update May 11 00:02:37 volumio volumio[1090]: info: Ignoring MPD Status Update May 11 00:02:37 volumio volumio[1090]: info: sendMpdCommand playlistinfo took 226 milliseconds May 11 00:02:37 volumio volumio[1090]: info: sendMpdCommand clear took 226 milliseconds May 11 00:02:37 volumio volumio[1090]: verbose: ControllerMpd::parseTrackInfo May 11 00:02:37 volumio volumio[1090]: verbose: ControllerMpd::sendMpdCommand add "USB/DAT_MUA/24 Bits/Golden Memories - Vol1/01. How Can I Tell Her.wav" May 11 00:02:37 volumio volumio[1090]: info: ControllerMpd::pushState May 11 00:02:37 volumio volumio[1090]: info: CoreCommandRouter::servicePushState May 11 00:02:37 volumio volumio[1090]: info: CoreStateMachine::pushState May 11 00:02:37 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:37 volumio volumio[1090]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 11 00:02:37 volumio volumio[1090]: info: CoreCommandRouter::volumioPushState May 11 00:02:37 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:37 volumio volumio[1090]: verbose: STATE SERVICE {"status":"stop","position":0,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":true,"repeat":false,"bitrate":null,"isStreaming":false,"title":"You Should Be Dancing","artist":"Bee Gees","album":"One Night Only","uri":"USB/DAT_MUA/24 Bits/Bee Gees - One Night Only (2013) [96-24]/01 - You Should Be Dancing.flac","trackType":"flac"} May 11 00:02:37 volumio volumio[1090]: verbose: CURRENT POSITION 0 May 11 00:02:37 volumio volumio[1090]: info: CoreStateMachine::syncState stateService stop May 11 00:02:37 volumio volumio[1090]: info: CoreStateMachine::syncState currentStatus stop May 11 00:02:37 volumio volumio[1090]: info: CoreStateMachine::pushState May 11 00:02:37 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:37 volumio volumio[1090]: info: CoreCommandRouter::volumioPushState May 11 00:02:37 volumio volumio[1090]: info: No code May 11 00:02:37 volumio volumio[1090]: info: CoreStateMachine::pushState May 11 00:02:37 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:37 volumio volumio[1090]: info: CoreCommandRouter::volumioPushState May 11 00:02:37 volumio volumio[1090]: info: ------------------------------ 533ms May 11 00:02:37 volumio volumio[1090]: error: updateQueue error: null May 11 00:02:37 volumio volumio[1090]: info: May 11 00:02:37 volumio volumio[1090]: ---------------------------- MPD announces system playlist update May 11 00:02:37 volumio volumio[1090]: info: Ignoring MPD Status Update May 11 00:02:37 volumio volumio[1090]: info: ------------------------------ 167ms May 11 00:02:37 volumio volumio[1090]: info: sendMpdCommand add "USB/DAT_MUA/24 Bits/Golden Memories - Vol1/01. How Can I Tell Her.wav" took 160 milliseconds May 11 00:02:37 volumio volumio[1090]: verbose: ControllerMpd::sendMpdCommand play May 11 00:02:37 volumio volumio[1090]: SPOTIFY: RECEIVED VOLUMIO VOLUME 100 May 11 00:02:37 volumio volumio[1090]: SPOTIFY: RECEIVED VOLUMIO VOLUME 100 May 11 00:02:37 volumio volumio[1090]: SPOTIFY: RECEIVED VOLUMIO VOLUME 100 May 11 00:02:37 volumio volumio[1090]: info: May 11 00:02:37 volumio volumio[1090]: ---------------------------- MPD announces state update: player May 11 00:02:37 volumio volumio[1090]: info: ------------------------------ 49ms May 11 00:02:37 volumio volumio[1090]: info: sendMpdCommand play took 43 milliseconds May 11 00:02:37 volumio volumio[1090]: info: ControllerMpd::getState May 11 00:02:37 volumio volumio[1090]: verbose: ControllerMpd::sendMpdCommand status May 11 00:02:37 volumio volumio[1090]: info: May 11 00:02:37 volumio volumio[1090]: ---------------------------- MPD announces state update: player May 11 00:02:37 volumio volumio[1090]: info: ControllerMpd::getState May 11 00:02:37 volumio volumio[1090]: verbose: ControllerMpd::sendMpdCommand status May 11 00:02:37 volumio volumio[1090]: info: sendMpdCommand status took 167 milliseconds May 11 00:02:37 volumio volumio[1090]: verbose: ControllerMpd::parseState May 11 00:02:37 volumio volumio[1090]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 11 00:02:37 volumio volumio[1090]: info: sendMpdCommand status took 5 milliseconds May 11 00:02:37 volumio volumio[1090]: info: sendMpdCommand playlistinfo took 5 milliseconds May 11 00:02:37 volumio volumio[1090]: verbose: ControllerMpd::parseState May 11 00:02:37 volumio volumio[1090]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 11 00:02:37 volumio volumio[1090]: verbose: ControllerMpd::parseTrackInfo May 11 00:02:37 volumio volumio[1090]: info: ControllerMpd::pushState May 11 00:02:37 volumio volumio[1090]: info: CoreCommandRouter::servicePushState May 11 00:02:37 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:37 volumio volumio[1090]: verbose: STATE SERVICE {"status":"play","position":0,"seek":853,"duration":274,"samplerate":"44.1 kHz","bitdepth":"32 bit","channels":2,"random":false,"updatedb":true,"repeat":false,"bitrate":null,"isStreaming":false,"title":"How Can I Tell Her","artist":"Various","album":"Golden Memories - Vol 1","uri":"USB/DAT_MUA/24 Bits/Golden Memories - Vol1/01. How Can I Tell Her.wav","trackType":"wav"} May 11 00:02:37 volumio volumio[1090]: verbose: CURRENT POSITION 0 May 11 00:02:37 volumio volumio[1090]: info: CoreStateMachine::syncState stateService play May 11 00:02:37 volumio volumio[1090]: info: CoreStateMachine::syncState currentStatus stop May 11 00:02:37 volumio volumio[1090]: info: ------------------------------ 177ms May 11 00:02:37 volumio volumio[1090]: info: sendMpdCommand playlistinfo took 4 milliseconds May 11 00:02:37 volumio volumio[1090]: verbose: ControllerMpd::parseTrackInfo May 11 00:02:37 volumio volumio[1090]: info: ControllerMpd::pushState May 11 00:02:37 volumio volumio[1090]: info: CoreCommandRouter::servicePushState May 11 00:02:37 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:37 volumio volumio[1090]: verbose: STATE SERVICE {"status":"play","position":0,"seek":1104,"duration":274,"samplerate":"44.1 kHz","bitdepth":"32 bit","channels":2,"random":false,"updatedb":true,"repeat":false,"bitrate":null,"isStreaming":false,"title":"How Can I Tell Her","artist":"Various","album":"Golden Memories - Vol 1","uri":"USB/DAT_MUA/24 Bits/Golden Memories - Vol1/01. How Can I Tell Her.wav","trackType":"wav"} May 11 00:02:37 volumio volumio[1090]: verbose: CURRENT POSITION 0 May 11 00:02:37 volumio volumio[1090]: info: CoreStateMachine::syncState stateService play May 11 00:02:37 volumio volumio[1090]: info: CoreStateMachine::syncState currentStatus play May 11 00:02:37 volumio volumio[1090]: info: Received an update from plugin. extracting info from payload May 11 00:02:37 volumio volumio[1090]: info: CoreStateMachine::pushState May 11 00:02:37 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:37 volumio volumio[1090]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 11 00:02:37 volumio volumio[1090]: info: CoreCommandRouter::volumioPushState May 11 00:02:37 volumio volumio[1090]: info: CoreStateMachine::pushState May 11 00:02:37 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:37 volumio volumio[1090]: info: CoreCommandRouter::volumioPushState May 11 00:02:37 volumio volumio[1090]: info: ------------------------------ 38ms May 11 00:02:37 volumio volumio[1090]: SPOTIFY: RECEIVED VOLUMIO VOLUME 100 May 11 00:02:40 volumio volumio[1090]: verbose: ControllerMpd::sendMpdCommand status May 11 00:02:40 volumio volumio[1090]: info: May 11 00:02:40 volumio volumio[1090]: ---------------------------- MPD announces state update: update May 11 00:02:40 volumio volumio[1090]: info: ControllerMpd::getState May 11 00:02:40 volumio volumio[1090]: verbose: ControllerMpd::sendMpdCommand status May 11 00:02:40 volumio volumio[1090]: info: sendMpdCommand status took 10 milliseconds May 11 00:02:40 volumio volumio[1090]: info: sendMpdCommand status took 7 milliseconds May 11 00:02:40 volumio volumio[1090]: verbose: ControllerMpd::parseState May 11 00:02:41 volumio volumio[1090]: info: Command Router : Notfying DB Updatetrue May 11 00:02:41 volumio volumio[1090]: info: CoreCommandRouter::Close All Modals sent May 11 00:02:41 volumio volumio[1090]: verbose: ControllerMpd::parseState May 11 00:02:41 volumio volumio[1090]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 11 00:02:41 volumio volumio[1090]: info: sendMpdCommand playlistinfo took 14 milliseconds May 11 00:02:41 volumio volumio[1090]: verbose: ControllerMpd::parseTrackInfo May 11 00:02:41 volumio volumio[1090]: info: ControllerMpd::pushState May 11 00:02:41 volumio volumio[1090]: info: CoreCommandRouter::servicePushState May 11 00:02:41 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:41 volumio volumio[1090]: verbose: STATE SERVICE {"status":"play","position":0,"seek":4484,"duration":274,"samplerate":"44.1 kHz","bitdepth":"32 bit","channels":2,"random":false,"updatedb":true,"repeat":false,"bitrate":null,"isStreaming":false,"title":"How Can I Tell Her","artist":"Various","album":"Golden Memories - Vol 1","uri":"USB/DAT_MUA/24 Bits/Golden Memories - Vol1/01. How Can I Tell Her.wav","trackType":"wav"} May 11 00:02:41 volumio volumio[1090]: verbose: CURRENT POSITION 0 May 11 00:02:41 volumio volumio[1090]: info: CoreStateMachine::syncState stateService play May 11 00:02:41 volumio volumio[1090]: info: CoreStateMachine::syncState currentStatus play May 11 00:02:41 volumio volumio[1090]: info: Received an update from plugin. extracting info from payload May 11 00:02:41 volumio volumio[1090]: info: CoreStateMachine::pushState May 11 00:02:41 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:41 volumio volumio[1090]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 11 00:02:41 volumio volumio[1090]: info: CoreCommandRouter::volumioPushState May 11 00:02:41 volumio volumio[1090]: info: CoreStateMachine::pushState May 11 00:02:41 volumio volumio[1090]: info: CorePlayQueue::getTrack 0 May 11 00:02:41 volumio volumio[1090]: info: CoreCommandRouter::volumioPushState May 11 00:02:41 volumio volumio[1090]: info: ------------------------------ 512ms May 11 00:02:41 volumio volumio[1090]: SPOTIFY: RECEIVED VOLUMIO VOLUME 100 May 11 00:02:41 volumio volumio[1090]: SPOTIFY: RECEIVED VOLUMIO VOLUME 100 May 11 00:03:16 volumio ntpd[1078]: Soliciting pool server 2401:5b60:0:1::52 May 11 00:03:17 volumio ntpd[1078]: Soliciting pool server 115.165.161.155 May 11 00:03:27 volumio volumio[1090]: error: error May 11 00:03:28 volumio ntpd[1078]: Soliciting pool server 27.71.27.209 May 11 00:03:30 volumio ntpd[1078]: Soliciting pool server 27.71.27.209 May 11 00:03:41 volumio volumio[1090]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 11 00:03:41 volumio volumio[1090]: Error: connect ETIMEDOUT 151.101.78.79:443 May 11 00:03:41 volumio volumio[1090]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1159:16) { May 11 00:03:41 volumio volumio[1090]: errno: -110, May 11 00:03:41 volumio volumio[1090]: code: 'ETIMEDOUT', May 11 00:03:41 volumio volumio[1090]: syscall: 'connect', May 11 00:03:41 volumio volumio[1090]: address: '151.101.78.79', May 11 00:03:41 volumio volumio[1090]: port: 443 May 11 00:03:41 volumio volumio[1090]: } May 11 00:03:41 volumio volumio[1090]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 11 00:03:42 volumio sudo[5523]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-05-11 00:02 May 11 00:03:42 volumio sudo[5523]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Debian GNU/Linux 10 (buster)" NAME="Debian GNU/Linux" VERSION_ID="10" VERSION="10 (buster)" VERSION_CODENAME=buster ID=debian HOME_URL="https://www.debian.org/" SUPPORT_URL="https://www.debian.org/support" BUG_REPORT_URL="https://bugs.debian.org/" VOLUMIO_BUILD_VERSION="147953990fca4aa103a8f90538ef56fb0454638c" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="9ab87de061b3649c303da550e73c92d340b0f989" VOLUMIO_ARCH="x64" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Thu 24 Apr 2025 10:07:11 AM CEST" VOLUMIO_VERSION="3.804" VOLUMIO_HARDWARE="x86_amd64" VOLUMIO_DEVICENAME="x86_64" VOLUMIO_HASH="dc77d77f02ef88ea816c3d31de871e8f"