-- Logs begin at Sat 2025-05-03 17:20:29 CST, end at Sat 2025-05-03 17:35:54 CST. -- May 03 17:34:02 volumio volumio[1117]: info: Preload queue cleared May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioReplaceandPlayItems May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::ClearQueue May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::stop May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::setConsumeUpdateService undefined May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::stPlaybackTimer May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::updateTrackBlock May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrackBlock May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::serviceStop May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::serviceStop May 03 17:34:02 volumio volumio[1117]: info: [1746264842099] ControllerUPNPBrowser::stop May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand stop May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::clearPlayQueue May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::saveQueue May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushQueue May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::addQueueItems May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::addQueueItems May 03 17:34:02 volumio volumio[1117]: info: Preload queue cleared May 03 17:34:02 volumio volumio[1117]: info: Adding Item to queue: upnp/folder/http://192.168.1.185:50001/ContentDirectory/control@26$94786$94786 May 03 17:34:02 volumio volumio[1117]: info: Exploding uri upnp/folder/http://192.168.1.185:50001/ContentDirectory/control@26$94786$94786 in service upnp_browser May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand stop took 7 milliseconds May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces state update: player May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::getState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand status May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces state update: player May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::getState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand status May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces state update: player May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::getState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand status May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand status took 1 milliseconds May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand status took 1 milliseconds May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand status took 1 milliseconds May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand playlistinfo took 1 milliseconds May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand playlistinfo took 1 milliseconds May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand playlistinfo took 0 milliseconds May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseTrackInfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseTrackInfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseTrackInfo May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::servicePushState May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: verbose: STATE SERVICE {"status":"stop","position":0,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"93027.ape","artist":null,"album":null,"uri":"http://192.168.1.185:50002/m/NDLNA/93027.ape","trackType":"ape"} May 03 17:34:02 volumio volumio[1117]: verbose: CURRENT POSITION 0 May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState stateService stop May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState currentStatus stop May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: No code May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::servicePushState May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: verbose: STATE SERVICE {"status":"stop","position":0,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"93027.ape","artist":null,"album":null,"uri":"http://192.168.1.185:50002/m/NDLNA/93027.ape","trackType":"ape"} May 03 17:34:02 volumio volumio[1117]: verbose: CURRENT POSITION 0 May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState stateService stop May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState currentStatus stop May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: No code May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::servicePushState May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: verbose: STATE SERVICE {"status":"stop","position":0,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"93027.ape","artist":null,"album":null,"uri":"http://192.168.1.185:50002/m/NDLNA/93027.ape","trackType":"ape"} May 03 17:34:02 volumio volumio[1117]: verbose: CURRENT POSITION 0 May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState stateService stop May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState currentStatus stop May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: No code May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 39ms May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 38ms May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 39ms May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushQueue May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::saveQueue May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::updateTrackBlock May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrackBlock May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPlay May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::play index 0 May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::setConsumeUpdateService undefined May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::stop May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::setConsumeUpdateService undefined May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::play index undefined May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::setConsumeUpdateService undefined May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::startPlaybackTimer May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: info: [1746264842169] ControllerUPNPBrowser::clearAddPlayTrack May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand stop May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand stop took 4 milliseconds May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand clear May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces system playlist update May 03 17:34:02 volumio volumio[1117]: info: Ignoring MPD Status Update May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand clear took 2 milliseconds May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand load "http://192.168.1.185:50002/m/NDLNA/94786.flac" May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces system playlist update May 03 17:34:02 volumio volumio[1117]: info: Ignoring MPD Status Update May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces system playlist update May 03 17:34:02 volumio volumio[1117]: info: Ignoring MPD Status Update May 03 17:34:02 volumio volumio[1117]: error: updateQueue error: null May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 64ms May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand add "http://192.168.1.185:50002/m/NDLNA/94786.flac" May 03 17:34:02 volumio volumio[1117]: error: updateQueue error: null May 03 17:34:02 volumio volumio[1117]: error: updateQueue error: null May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces system playlist update May 03 17:34:02 volumio volumio[1117]: info: Ignoring MPD Status Update May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 63ms May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 63ms May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand add "http://192.168.1.185:50002/m/NDLNA/94786.flac" took 1 milliseconds May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::setConsumeUpdateService mpd May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand play May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces system playlist update May 03 17:34:02 volumio volumio[1117]: info: Ignoring MPD Status Update May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces system playlist update May 03 17:34:02 volumio volumio[1117]: info: Ignoring MPD Status Update May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 2ms May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand play took 1 milliseconds May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 1ms May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 1ms May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces state update: player May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::getState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand status May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces state update: player May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::getState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand status May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces state update: player May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::getState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand status May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand status took 7 milliseconds May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces state update: player May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::getState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand status May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand status took 7 milliseconds May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand status took 7 milliseconds May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand playlistinfo took 1 milliseconds May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseTrackInfo May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::servicePushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":216,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"94786.flac","artist":null,"album":null,"uri":"http://192.168.1.185:50002/m/NDLNA/94786.flac","trackType":"flac"} May 03 17:34:02 volumio volumio[1117]: verbose: CURRENT POSITION 0 May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState stateService play May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState currentStatus stop May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 11ms May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces state update: player May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::getState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand status May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces state update: player May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::getState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand status May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces system playlist update May 03 17:34:02 volumio volumio[1117]: info: Ignoring MPD Status Update May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces state update: player May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand status took 6 milliseconds May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::getState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand status May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand playlistinfo took 4 milliseconds May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand playlistinfo took 4 milliseconds May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand status took 2 milliseconds May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand status took 2 milliseconds May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseTrackInfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseTrackInfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::servicePushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":216,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Do What I Do","artist":"Lady & Bird","album":"Lady & Bird","uri":"http://192.168.1.185:50002/m/NDLNA/94786.flac","trackType":"flac"} May 03 17:34:02 volumio volumio[1117]: verbose: CURRENT POSITION 0 May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState stateService play May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState currentStatus play May 03 17:34:02 volumio volumio[1117]: info: Received an update from plugin. extracting info from payload May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::servicePushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":216,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Do What I Do","artist":"Lady & Bird","album":"Lady & Bird","uri":"http://192.168.1.185:50002/m/NDLNA/94786.flac","trackType":"flac"} May 03 17:34:02 volumio volumio[1117]: verbose: CURRENT POSITION 0 May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState stateService play May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState currentStatus play May 03 17:34:02 volumio volumio[1117]: info: Received an update from plugin. extracting info from payload May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 28ms May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 28ms May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces system playlist update May 03 17:34:02 volumio volumio[1117]: info: Ignoring MPD Status Update May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces state update: player May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::getState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand status May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces system playlist update May 03 17:34:02 volumio volumio[1117]: info: Ignoring MPD Status Update May 03 17:34:02 volumio volumio[1117]: info: May 03 17:34:02 volumio volumio[1117]: ---------------------------- MPD announces state update: player May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::getState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand status May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 18ms May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand status took 18 milliseconds May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand playlistinfo took 17 milliseconds May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand playlistinfo took 17 milliseconds May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand playlistinfo took 17 milliseconds May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 2ms May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand status took 3 milliseconds May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 2ms May 03 17:34:02 volumio volumio[1117]: info: sendMpdCommand status took 2 milliseconds May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseTrackInfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseTrackInfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseTrackInfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::parseState May 03 17:34:02 volumio volumio[1117]: verbose: ControllerMpd::sendMpdCommand playlistinfo May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::servicePushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":216,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Do What I Do","artist":"Lady & Bird","album":"Lady & Bird","uri":"http://192.168.1.185:50002/m/NDLNA/94786.flac","trackType":"flac"} May 03 17:34:02 volumio volumio[1117]: verbose: CURRENT POSITION 0 May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState stateService play May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState currentStatus play May 03 17:34:02 volumio volumio[1117]: info: Received an update from plugin. extracting info from payload May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::servicePushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: verbose: STATE SERVICE {"status":"play","position":0,"seek":842,"duration":216,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"562 Kbps","isStreaming":false,"title":"Do What I Do","artist":"Lady & Bird","album":"Lady & Bird","uri":"http://192.168.1.185:50002/m/NDLNA/94786.flac","trackType":"flac"} May 03 17:34:02 volumio volumio[1117]: verbose: CURRENT POSITION 0 May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState stateService play May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState currentStatus play May 03 17:34:02 volumio volumio[1117]: info: Received an update from plugin. extracting info from payload May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: ControllerMpd::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::servicePushState May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:02 volumio volumio[1117]: verbose: STATE SERVICE {"status":"play","position":0,"seek":842,"duration":216,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"526 Kbps","isStreaming":false,"title":"Do What I Do","artist":"Lady & Bird","album":"Lady & Bird","uri":"http://192.168.1.185:50002/m/NDLNA/94786.flac","trackType":"flac"} May 03 17:34:02 volumio volumio[1117]: verbose: CURRENT POSITION 0 May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState stateService play May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::syncState currentStatus play May 03 17:34:02 volumio volumio[1117]: info: Received an update from plugin. extracting info from payload May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 50ms May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 46ms May 03 17:34:02 volumio volumio[1117]: info: ------------------------------ 47ms May 03 17:34:02 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:02 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:02 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: sendMpdCommand playlistinfo took 1093 milliseconds May 03 17:34:03 volumio volumio[1117]: info: sendMpdCommand playlistinfo took 1093 milliseconds May 03 17:34:03 volumio volumio[1117]: info: sendMpdCommand playlistinfo took 1092 milliseconds May 03 17:34:03 volumio volumio[1117]: verbose: ControllerMpd::parseTrackInfo May 03 17:34:03 volumio volumio[1117]: verbose: ControllerMpd::parseTrackInfo May 03 17:34:03 volumio volumio[1117]: verbose: ControllerMpd::parseTrackInfo May 03 17:34:03 volumio volumio[1117]: info: ControllerMpd::pushState May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::servicePushState May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:03 volumio volumio[1117]: verbose: STATE SERVICE {"status":"play","position":0,"seek":842,"duration":216,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"526 Kbps","isStreaming":false,"title":"Do What I Do","artist":"Lady & Bird","album":"Lady & Bird","uri":"http://192.168.1.185:50002/m/NDLNA/94786.flac","trackType":"flac"} May 03 17:34:03 volumio volumio[1117]: verbose: CURRENT POSITION 0 May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::syncState stateService play May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::syncState currentStatus play May 03 17:34:03 volumio volumio[1117]: info: Received an update from plugin. extracting info from payload May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:03 volumio volumio[1117]: info: ControllerMpd::pushState May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::servicePushState May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:03 volumio volumio[1117]: verbose: STATE SERVICE {"status":"play","position":0,"seek":842,"duration":216,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"655 Kbps","isStreaming":false,"title":"Do What I Do","artist":"Lady & Bird","album":"Lady & Bird","uri":"http://192.168.1.185:50002/m/NDLNA/94786.flac","trackType":"flac"} May 03 17:34:03 volumio volumio[1117]: verbose: CURRENT POSITION 0 May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::syncState stateService play May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::syncState currentStatus play May 03 17:34:03 volumio volumio[1117]: info: Received an update from plugin. extracting info from payload May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:03 volumio volumio[1117]: info: ControllerMpd::pushState May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::servicePushState May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getTrack 0 May 03 17:34:03 volumio volumio[1117]: verbose: STATE SERVICE {"status":"play","position":0,"seek":842,"duration":216,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"655 Kbps","isStreaming":false,"title":"Do What I Do","artist":"Lady & Bird","album":"Lady & Bird","uri":"http://192.168.1.185:50002/m/NDLNA/94786.flac","trackType":"flac"} May 03 17:34:03 volumio volumio[1117]: verbose: CURRENT POSITION 0 May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::syncState stateService play May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::syncState currentStatus play May 03 17:34:03 volumio volumio[1117]: info: Received an update from plugin. extracting info from payload May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::pushState May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioPushState May 03 17:34:03 volumio volumio[1117]: info: ------------------------------ 1129ms May 03 17:34:03 volumio volumio[1117]: info: ------------------------------ 1113ms May 03 17:34:03 volumio volumio[1117]: info: ------------------------------ 1112ms May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:03 volumio volumio[1117]: info: CoreCommandRouter::volumioGetQueue May 03 17:34:03 volumio volumio[1117]: info: CoreStateMachine::getQueue May 03 17:34:03 volumio volumio[1117]: info: CorePlayQueue::getQueue May 03 17:34:09 volumio volumio[1117]: Upnp client error: Error: This socket has been ended by the other party May 03 17:34:09 volumio volumio[1117]: Upnp client error: Error: This socket has been ended by the other party May 03 17:34:09 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 03 17:34:09 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 03 17:34:09 volumio volumio[1117]: info: Discovery: Getting this device information May 03 17:34:09 volumio volumio[1117]: info: CoreCommandRouter::volumioGetState May 03 17:34:09 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 03 17:34:36 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 03 17:34:36 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 03 17:34:36 volumio volumio[1117]: info: Discovery: Getting this device information May 03 17:34:36 volumio volumio[1117]: info: CoreCommandRouter::volumioGetState May 03 17:34:36 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 03 17:34:51 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri May 03 17:34:51 volumio volumio[1117]: info: CURURI: artists:// May 03 17:34:51 volumio volumio[1117]: info: Preload queue cleared May 03 17:34:54 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri May 03 17:34:54 volumio volumio[1117]: info: CURURI: artists://Emi%20Fujita May 03 17:34:54 volumio volumio[1117]: info: Preload queue cleared May 03 17:34:54 volumio volumio[1117]: info: Preload queue cleared May 03 17:34:54 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/01 - Emi Fujita - Imagine.dsf May 03 17:34:54 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/02 - Emi Fujita - Your Song.dsf May 03 17:34:54 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/03 - Emi Fujita - Eternal Flame.dsf May 03 17:34:54 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/04 - Emi Fujita - Streets of London.dsf May 03 17:34:54 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/05 - Emi Fujita - Both Sides Now.dsf May 03 17:34:54 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/06 - Emi Fujita - I Honestly Love You.dsf May 03 17:34:54 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/07 - Emi Fujita - I Believe.dsf May 03 17:34:54 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/08 - Emi Fujita - Laughter in the Rain.dsf May 03 17:34:54 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/09 - Emi Fujita - Smile.dsf May 03 17:34:54 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/10 - Emi Fujita - Blue Moon.dsf May 03 17:34:54 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/11 - Emi Fujita - The Perfect Moment.dsf May 03 17:34:54 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/12 - Emi Fujita - From a Distance.dsf May 03 17:34:54 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/13 - Emi Fujita - Danny Boy.dsf May 03 17:34:54 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/01 - Emi Fujita - Imagine.dsf in service mpd May 03 17:34:55 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/Emi Fujita - camomile smile [DSF 128]/01 - Emi Fujita - Imagine.dsf' May 03 17:34:55 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/05 - Emi Fujita - Both Sides Now.dsf in service mpd May 03 17:34:55 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/Emi Fujita - camomile smile [DSF 128]/05 - Emi Fujita - Both Sides Now.dsf' May 03 17:34:55 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/02 - Emi Fujita - Your Song.dsf in service mpd May 03 17:34:55 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/Emi Fujita - camomile smile [DSF 128]/02 - Emi Fujita - Your Song.dsf' May 03 17:34:55 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/03 - Emi Fujita - Eternal Flame.dsf in service mpd May 03 17:34:55 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/Emi Fujita - camomile smile [DSF 128]/03 - Emi Fujita - Eternal Flame.dsf' May 03 17:34:55 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/04 - Emi Fujita - Streets of London.dsf in service mpd May 03 17:34:55 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/Emi Fujita - camomile smile [DSF 128]/04 - Emi Fujita - Streets of London.dsf' May 03 17:34:55 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/06 - Emi Fujita - I Honestly Love You.dsf in service mpd May 03 17:34:55 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/Emi Fujita - camomile smile [DSF 128]/06 - Emi Fujita - I Honestly Love You.dsf' May 03 17:34:55 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/07 - Emi Fujita - I Believe.dsf in service mpd May 03 17:34:55 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/Emi Fujita - camomile smile [DSF 128]/07 - Emi Fujita - I Believe.dsf' May 03 17:34:55 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/08 - Emi Fujita - Laughter in the Rain.dsf in service mpd May 03 17:34:55 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/Emi Fujita - camomile smile [DSF 128]/08 - Emi Fujita - Laughter in the Rain.dsf' May 03 17:34:55 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/09 - Emi Fujita - Smile.dsf in service mpd May 03 17:34:55 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/Emi Fujita - camomile smile [DSF 128]/09 - Emi Fujita - Smile.dsf' May 03 17:34:55 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/10 - Emi Fujita - Blue Moon.dsf in service mpd May 03 17:34:55 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/Emi Fujita - camomile smile [DSF 128]/10 - Emi Fujita - Blue Moon.dsf' May 03 17:34:55 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/11 - Emi Fujita - The Perfect Moment.dsf in service mpd May 03 17:34:55 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/Emi Fujita - camomile smile [DSF 128]/11 - Emi Fujita - The Perfect Moment.dsf' May 03 17:34:55 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/12 - Emi Fujita - From a Distance.dsf in service mpd May 03 17:34:55 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/Emi Fujita - camomile smile [DSF 128]/12 - Emi Fujita - From a Distance.dsf' May 03 17:34:55 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/Emi Fujita - camomile smile [DSF 128]/13 - Emi Fujita - Danny Boy.dsf in service mpd May 03 17:34:55 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/Emi Fujita - camomile smile [DSF 128]/13 - Emi Fujita - Danny Boy.dsf' May 03 17:35:06 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 03 17:35:06 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 03 17:35:06 volumio volumio[1117]: info: Discovery: Getting this device information May 03 17:35:06 volumio volumio[1117]: info: CoreCommandRouter::volumioGetState May 03 17:35:06 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 03 17:35:14 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri May 03 17:35:14 volumio volumio[1117]: info: CURURI: artists://%3F%DC%B8%3F May 03 17:35:15 volumio volumio[1117]: info: Preload queue cleared May 03 17:35:15 volumio volumio[1117]: info: Preload queue cleared May 03 17:35:15 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/01. 冠军.wav May 03 17:35:15 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/02. 彩虹ABC.wav May 03 17:35:15 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/03. 美丽人生.wav May 03 17:35:15 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/04. 你愿不愿意.wav May 03 17:35:15 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/05. 我的家.wav May 03 17:35:15 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/06. 面具.wav May 03 17:35:15 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/07. 我们是朋友.wav May 03 17:35:15 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/08. Me My911.wav May 03 17:35:15 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/09. 农明星.wav May 03 17:35:15 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/10. 往前跑.wav May 03 17:35:15 volumio volumio[1117]: info: Preloading song: music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/11. 小小.wav May 03 17:35:15 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/01. 冠军.wav in service mpd May 03 17:35:15 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/01. 冠军.wav' May 03 17:35:15 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/02. 彩虹ABC.wav in service mpd May 03 17:35:15 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/02. 彩虹ABC.wav' May 03 17:35:15 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/03. 美丽人生.wav in service mpd May 03 17:35:15 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/03. 美丽人生.wav' May 03 17:35:15 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/04. 你愿不愿意.wav in service mpd May 03 17:35:15 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/04. 你愿不愿意.wav' May 03 17:35:15 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/05. 我的家.wav in service mpd May 03 17:35:15 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/05. 我的家.wav' May 03 17:35:15 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/06. 面具.wav in service mpd May 03 17:35:15 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/06. 面具.wav' May 03 17:35:15 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/07. 我们是朋友.wav in service mpd May 03 17:35:15 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/07. 我们是朋友.wav' May 03 17:35:15 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/08. Me My911.wav in service mpd May 03 17:35:15 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/08. Me My911.wav' May 03 17:35:15 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/09. 农明星.wav in service mpd May 03 17:35:15 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/09. 农明星.wav' May 03 17:35:15 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/10. 往前跑.wav in service mpd May 03 17:35:15 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/10. 往前跑.wav' May 03 17:35:15 volumio volumio[1117]: info: Exploding uri music-library/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/11. 小小.wav in service mpd May 03 17:35:15 volumio volumio[1117]: error: scanFolder - failure to stat '/mnt/USB/DSD/【Hi-Res】华语 ^24-44^/曹格.2016 -《我们是朋友》【滚石】【WAV】（24Bit）/11. 小小.wav' May 03 17:35:22 volumio systemd[1]: Starting Cleanup of Temporary Directories... May 03 17:35:22 volumio systemd[1]: systemd-tmpfiles-clean.service: Succeeded. May 03 17:35:22 volumio systemd[1]: Started Cleanup of Temporary Directories. May 03 17:35:25 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri May 03 17:35:25 volumio volumio[1117]: info: CURURI: artists:// May 03 17:35:25 volumio volumio[1117]: info: Preload queue cleared May 03 17:35:31 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri May 03 17:35:31 volumio volumio[1117]: info: Preload queue cleared May 03 17:35:33 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri May 03 17:35:33 volumio volumio[1117]: info: Preload queue cleared May 03 17:35:35 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri May 03 17:35:35 volumio volumio[1117]: info: Preload queue cleared May 03 17:35:36 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo May 03 17:35:36 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice May 03 17:35:36 volumio volumio[1117]: info: Discovery: Getting this device information May 03 17:35:36 volumio volumio[1117]: info: CoreCommandRouter::volumioGetState May 03 17:35:36 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses May 03 17:35:44 volumio volumio[1117]: info: CoreCommandRouter::executeOnPlugin: upnp_browser , handleBrowseUri May 03 17:35:44 volumio volumio[1117]: Cannot compose Albumart path May 03 17:35:44 volumio volumio[1117]: info: Preload queue cleared May 03 17:35:54 volumio volumio[1117]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 03 17:35:54 volumio volumio[1117]: Error: connect ETIMEDOUT 173.252.108.21:80 May 03 17:35:54 volumio volumio[1117]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1159:16) { May 03 17:35:54 volumio volumio[1117]: errno: -110, May 03 17:35:54 volumio volumio[1117]: code: 'ETIMEDOUT', May 03 17:35:54 volumio volumio[1117]: syscall: 'connect', May 03 17:35:54 volumio volumio[1117]: address: '173.252.108.21', May 03 17:35:54 volumio volumio[1117]: port: 80 May 03 17:35:54 volumio volumio[1117]: } May 03 17:35:54 volumio volumio[1117]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| May 03 17:35:54 volumio sudo[5477]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-05-03 17:34 May 03 17:35:54 volumio sudo[5477]: 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"