-- Logs begin at Tue 2024-09-17 23:19:36 CST, end at Sun 2025-03-16 21:06:44 CST. -- Mar 16 21:05:01 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:05:01 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::stPlaybackTimer Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:05:01 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:01 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:01 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:01 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::serviceStop Mar 16 21:05:01 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:01 volumio volumio[15234]: info: CoreCommandRouter::serviceStop Mar 16 21:05:01 volumio volumio[15234]: info: [1742130301922] ControllerWebradio::stop Mar 16 21:05:01 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:05:01 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:05:01 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:05:01 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:05:01 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:05:01 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:05:01 volumio volumio[15234]: info: Adding Item to queue: http://yp.shoutcast.com/sbin/tunein-station.m3u?id=99516295 Mar 16 21:05:01 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:05:01 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:05:01 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:05:01 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:05:01 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:01 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:05:01 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:01 volumio volumio[15234]: info: [1742130301939] ControllerWebradio::clearAddPlayTrack Mar 16 21:05:01 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:05:01 volumio volumio[15234]: info: Mar 16 21:05:01 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:01 volumio volumio[15234]: info: sendMpdCommand stop took 39 milliseconds Mar 16 21:05:01 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:01 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:01 volumio volumio[15234]: info: sendMpdCommand stop took 24 milliseconds Mar 16 21:05:01 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:05:01 volumio volumio[15234]: info: Mar 16 21:05:01 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:01 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:01 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:01 volumio volumio[15234]: info: Mar 16 21:05:01 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:01 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:01 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:01 volumio volumio[15234]: info: Mar 16 21:05:01 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:01 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:01 volumio volumio[15234]: info: sendMpdCommand status took 16 milliseconds Mar 16 21:05:01 volumio volumio[15234]: info: sendMpdCommand clear took 16 milliseconds Mar 16 21:05:01 volumio volumio[15234]: info: sendMpdCommand status took 15 milliseconds Mar 16 21:05:01 volumio volumio[15234]: info: sendMpdCommand status took 3 milliseconds Mar 16 21:05:01 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:01 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:01 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand load "http://yp.shoutcast.com/sbin/tunein-station.m3u?id=99516295" Mar 16 21:05:01 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:01 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:01 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:01 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:01 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:01 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:01 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:01 volumio volumio[15234]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Mar 16 21:05:01 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:01 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:01 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:01 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:01 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:01 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:01 volumio volumio[15234]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Mar 16 21:05:01 volumio volumio[15234]: info: ------------------------------ 34ms Mar 16 21:05:01 volumio volumio[15234]: info: ------------------------------ 33ms Mar 16 21:05:01 volumio volumio[15234]: info: Mar 16 21:05:01 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:02 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:02 volumio volumio[15234]: info: Mar 16 21:05:02 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:02 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:02 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:05:02 volumio volumio[15234]: info: ------------------------------ 28ms Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 27 milliseconds Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:02 volumio volumio[15234]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined Mar 16 21:05:02 volumio volumio[15234]: info: ------------------------------ 48ms Mar 16 21:05:02 volumio volumio[15234]: info: Mar 16 21:05:02 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:02 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand load "http://yp.shoutcast.com/sbin/tunein-station.m3u?id=99516295" took 226 milliseconds Mar 16 21:05:02 volumio volumio[15234]: info: ------------------------------ 208ms Mar 16 21:05:02 volumio volumio[15234]: info: ------------------------------ 207ms Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:05:02 volumio volumio[15234]: info: Mar 16 21:05:02 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:02 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:02 volumio volumio[15234]: info: Mar 16 21:05:02 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:02 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:02 volumio volumio[15234]: info: ------------------------------ 4ms Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand play took 3 milliseconds Mar 16 21:05:02 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:05:02 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:05:02 volumio volumio[15234]: info: Mar 16 21:05:02 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:02 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:02 volumio volumio[15234]: info: Mar 16 21:05:02 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:02 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:02 volumio volumio[15234]: info: Mar 16 21:05:02 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:02 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:02 volumio volumio[15234]: info: Mar 16 21:05:02 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand status took 5 milliseconds Mar 16 21:05:02 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand status took 5 milliseconds Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand status took 4 milliseconds Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:02 volumio volumio[15234]: info: Mar 16 21:05:02 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:02 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:02 volumio volumio[15234]: info: Mar 16 21:05:02 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:02 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand status took 5 milliseconds Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 6 milliseconds Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 5 milliseconds Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 6 milliseconds Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand status took 5 milliseconds Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand status took 4 milliseconds Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:02 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:02 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:02 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"","artist":"(#1 - 187/2048) Radio Rogla - To je ta dober obcutek","album":null,"uri":"http://193.105.67.24:8010/","trackType":"24:8010/"} Mar 16 21:05:02 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:05:02 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:02 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:02 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"","artist":"(#1 - 187/2048) Radio Rogla - To je ta dober obcutek","album":null,"uri":"http://193.105.67.24:8010/","trackType":"24:8010/"} Mar 16 21:05:02 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:02 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:02 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:02 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:02 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"","artist":"(#1 - 187/2048) Radio Rogla - To je ta dober obcutek","album":null,"uri":"http://193.105.67.24:8010/","trackType":"24:8010/"} Mar 16 21:05:02 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:02 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:02 volumio volumio[15234]: info: ------------------------------ 25ms Mar 16 21:05:02 volumio volumio[15234]: info: ------------------------------ 48ms Mar 16 21:05:02 volumio volumio[15234]: info: ------------------------------ 48ms Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 39 milliseconds Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 38 milliseconds Mar 16 21:05:02 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 38 milliseconds Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:02 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:02 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:02 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:02 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"","artist":"(#1 - 187/2048) Radio Rogla - To je ta dober obcutek","album":null,"uri":"http://193.105.67.24:8010/","trackType":"24:8010/"} Mar 16 21:05:02 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:02 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:02 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:02 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:02 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"","artist":"(#1 - 187/2048) Radio Rogla - To je ta dober obcutek","album":null,"uri":"http://193.105.67.24:8010/","trackType":"24:8010/"} Mar 16 21:05:02 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:02 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:02 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:02 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:02 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"","artist":"(#1 - 187/2048) Radio Rogla - To je ta dober obcutek","album":null,"uri":"http://193.105.67.24:8010/","trackType":"24:8010/"} Mar 16 21:05:02 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:02 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:02 volumio volumio[15234]: info: ------------------------------ 109ms Mar 16 21:05:02 volumio volumio[15234]: info: ------------------------------ 105ms Mar 16 21:05:02 volumio volumio[15234]: info: ------------------------------ 105ms Mar 16 21:05:03 volumio volumio[15234]: info: Mar 16 21:05:03 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:03 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:03 volumio volumio[15234]: info: Mar 16 21:05:03 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:03 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:03 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:03 volumio volumio[15234]: info: Mar 16 21:05:03 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:03 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:03 volumio volumio[15234]: info: Mar 16 21:05:03 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:03 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:03 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:03 volumio volumio[15234]: info: ------------------------------ 4ms Mar 16 21:05:03 volumio volumio[15234]: info: sendMpdCommand status took 3 milliseconds Mar 16 21:05:03 volumio volumio[15234]: info: ------------------------------ 4ms Mar 16 21:05:03 volumio volumio[15234]: info: sendMpdCommand status took 4 milliseconds Mar 16 21:05:03 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:03 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:03 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:03 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:03 volumio volumio[15234]: info: Mar 16 21:05:03 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:03 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:03 volumio volumio[15234]: info: Mar 16 21:05:03 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:03 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:03 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:03 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 3 milliseconds Mar 16 21:05:03 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 3 milliseconds Mar 16 21:05:03 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:05:03 volumio volumio[15234]: info: sendMpdCommand status took 2 milliseconds Mar 16 21:05:03 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:03 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:03 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:03 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:03 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:03 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:03 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:03 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":862,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"MOŽU ZA PRAZNIK-FANTJE IZPOD ROGLE","artist":"Radio Rogla - To je ta dober obcutek","album":null,"uri":"http://193.105.67.24:8010/","trackType":"24:8010/"} Mar 16 21:05:03 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:03 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:03 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:03 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:03 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:03 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:03 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:03 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:03 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:03 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:03 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:03 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:03 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:03 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":862,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"MOŽU ZA PRAZNIK-FANTJE IZPOD ROGLE","artist":"Radio Rogla - To je ta dober obcutek","album":null,"uri":"http://193.105.67.24:8010/","trackType":"24:8010/"} Mar 16 21:05:03 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:03 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:03 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:03 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:03 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:03 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:03 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:03 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:03 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:03 volumio volumio[15234]: info: ------------------------------ 74ms Mar 16 21:05:03 volumio volumio[15234]: info: ------------------------------ 73ms Mar 16 21:05:03 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 64 milliseconds Mar 16 21:05:03 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:03 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:03 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:03 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:03 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":862,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"MOŽU ZA PRAZNIK-FANTJE IZPOD ROGLE","artist":"Radio Rogla - To je ta dober obcutek","album":null,"uri":"http://193.105.67.24:8010/","trackType":"24:8010/"} Mar 16 21:05:03 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:03 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:03 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:03 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:03 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:03 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:03 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:03 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:03 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:03 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:03 volumio volumio[15234]: info: ------------------------------ 88ms Mar 16 21:05:13 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:05:13 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::stPlaybackTimer Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:05:13 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:13 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:13 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:13 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::serviceStop Mar 16 21:05:13 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:13 volumio volumio[15234]: info: CoreCommandRouter::serviceStop Mar 16 21:05:13 volumio volumio[15234]: info: [1742130313294] ControllerWebradio::stop Mar 16 21:05:13 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:05:13 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:05:13 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:05:13 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:05:13 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:05:13 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:05:13 volumio volumio[15234]: info: Adding Item to queue: http://yp.shoutcast.com/sbin/tunein-station.m3u?id=99497936 Mar 16 21:05:13 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:05:13 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:05:13 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:05:13 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:05:13 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:13 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:05:13 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:13 volumio volumio[15234]: info: [1742130313316] ControllerWebradio::clearAddPlayTrack Mar 16 21:05:13 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:05:13 volumio volumio[15234]: info: Mar 16 21:05:13 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:13 volumio volumio[15234]: info: sendMpdCommand stop took 37 milliseconds Mar 16 21:05:13 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:13 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:13 volumio volumio[15234]: info: sendMpdCommand stop took 17 milliseconds Mar 16 21:05:13 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:05:13 volumio volumio[15234]: info: Mar 16 21:05:13 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:13 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:13 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:13 volumio volumio[15234]: info: Mar 16 21:05:13 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:13 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:13 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:13 volumio volumio[15234]: info: Mar 16 21:05:13 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:13 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:13 volumio volumio[15234]: info: sendMpdCommand status took 25 milliseconds Mar 16 21:05:13 volumio volumio[15234]: info: sendMpdCommand clear took 23 milliseconds Mar 16 21:05:13 volumio volumio[15234]: info: sendMpdCommand status took 20 milliseconds Mar 16 21:05:13 volumio volumio[15234]: info: sendMpdCommand status took 17 milliseconds Mar 16 21:05:13 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:13 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:13 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand load "http://yp.shoutcast.com/sbin/tunein-station.m3u?id=99497936" Mar 16 21:05:13 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:13 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:13 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:13 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:13 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:13 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:13 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:13 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:13 volumio volumio[15234]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Mar 16 21:05:13 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:13 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:13 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:13 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:13 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:13 volumio volumio[15234]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Mar 16 21:05:13 volumio volumio[15234]: info: ------------------------------ 46ms Mar 16 21:05:13 volumio volumio[15234]: info: ------------------------------ 44ms Mar 16 21:05:13 volumio volumio[15234]: info: Mar 16 21:05:13 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:13 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:13 volumio volumio[15234]: info: Mar 16 21:05:13 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:13 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:13 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:05:13 volumio volumio[15234]: info: ------------------------------ 37ms Mar 16 21:05:13 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 35 milliseconds Mar 16 21:05:13 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:13 volumio volumio[15234]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined Mar 16 21:05:13 volumio volumio[15234]: info: ------------------------------ 66ms Mar 16 21:05:13 volumio volumio[15234]: info: sendMpdCommand load "http://yp.shoutcast.com/sbin/tunein-station.m3u?id=99497936" took 227 milliseconds Mar 16 21:05:13 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:05:13 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:05:13 volumio volumio[15234]: info: Mar 16 21:05:13 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:13 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:13 volumio volumio[15234]: info: ------------------------------ 205ms Mar 16 21:05:13 volumio volumio[15234]: info: ------------------------------ 199ms Mar 16 21:05:13 volumio volumio[15234]: info: Mar 16 21:05:13 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:13 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:13 volumio volumio[15234]: info: Mar 16 21:05:13 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:13 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:13 volumio volumio[15234]: info: sendMpdCommand play took 4 milliseconds Mar 16 21:05:13 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:05:13 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:05:13 volumio volumio[15234]: info: ------------------------------ 1ms Mar 16 21:05:15 volumio volumio[15234]: info: Mar 16 21:05:15 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:15 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:15 volumio volumio[15234]: info: Mar 16 21:05:15 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:15 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:15 volumio volumio[15234]: info: Mar 16 21:05:15 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:15 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:15 volumio volumio[15234]: info: Mar 16 21:05:15 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:15 volumio volumio[15234]: info: sendMpdCommand status took 5 milliseconds Mar 16 21:05:15 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:15 volumio volumio[15234]: info: sendMpdCommand status took 4 milliseconds Mar 16 21:05:15 volumio volumio[15234]: info: sendMpdCommand status took 2 milliseconds Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:15 volumio volumio[15234]: info: Mar 16 21:05:15 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:15 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:15 volumio volumio[15234]: info: Mar 16 21:05:15 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:15 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:15 volumio volumio[15234]: info: sendMpdCommand status took 6 milliseconds Mar 16 21:05:15 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 6 milliseconds Mar 16 21:05:15 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 5 milliseconds Mar 16 21:05:15 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 5 milliseconds Mar 16 21:05:15 volumio volumio[15234]: info: sendMpdCommand status took 4 milliseconds Mar 16 21:05:15 volumio volumio[15234]: info: sendMpdCommand status took 2 milliseconds Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:15 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:15 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:15 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"greatest-hits","artist":"(#1 - 120/500000) ANTENNE BAYERN Greatest Hits","album":null,"uri":"http://stream.antenne.de:80/greatest-hits","trackType":""} Mar 16 21:05:15 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:05:15 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:15 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:15 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"greatest-hits","artist":"(#1 - 120/500000) ANTENNE BAYERN Greatest Hits","album":null,"uri":"http://stream.antenne.de:80/greatest-hits","trackType":""} Mar 16 21:05:15 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:15 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:15 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:15 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:15 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"greatest-hits","artist":"(#1 - 120/500000) ANTENNE BAYERN Greatest Hits","album":null,"uri":"http://stream.antenne.de:80/greatest-hits","trackType":""} Mar 16 21:05:15 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:15 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:15 volumio volumio[15234]: info: ------------------------------ 44ms Mar 16 21:05:15 volumio volumio[15234]: info: ------------------------------ 65ms Mar 16 21:05:15 volumio volumio[15234]: info: ------------------------------ 65ms Mar 16 21:05:15 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 54 milliseconds Mar 16 21:05:15 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 54 milliseconds Mar 16 21:05:15 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 54 milliseconds Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:15 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:15 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:15 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:15 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"greatest-hits","artist":"(#1 - 120/500000) ANTENNE BAYERN Greatest Hits","album":null,"uri":"http://stream.antenne.de:80/greatest-hits","trackType":""} Mar 16 21:05:15 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:15 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:15 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:15 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:15 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"greatest-hits","artist":"(#1 - 120/500000) ANTENNE BAYERN Greatest Hits","album":null,"uri":"http://stream.antenne.de:80/greatest-hits","trackType":""} Mar 16 21:05:15 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:15 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:15 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:15 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:15 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"greatest-hits","artist":"(#1 - 120/500000) ANTENNE BAYERN Greatest Hits","album":null,"uri":"http://stream.antenne.de:80/greatest-hits","trackType":""} Mar 16 21:05:15 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:15 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:15 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:15 volumio volumio[15234]: info: ------------------------------ 126ms Mar 16 21:05:15 volumio volumio[15234]: info: ------------------------------ 122ms Mar 16 21:05:15 volumio volumio[15234]: info: ------------------------------ 121ms Mar 16 21:05:16 volumio volumio[15234]: info: Mar 16 21:05:16 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:16 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:16 volumio volumio[15234]: info: Mar 16 21:05:16 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:16 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:16 volumio volumio[15234]: info: Mar 16 21:05:16 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:16 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:16 volumio volumio[15234]: info: Mar 16 21:05:16 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:16 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:16 volumio volumio[15234]: info: Mar 16 21:05:16 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:16 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:16 volumio volumio[15234]: info: Mar 16 21:05:16 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:16 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:16 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:05:16 volumio volumio[15234]: info: sendMpdCommand status took 2 milliseconds Mar 16 21:05:16 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:16 volumio volumio[15234]: info: ------------------------------ 4ms Mar 16 21:05:16 volumio volumio[15234]: info: sendMpdCommand status took 3 milliseconds Mar 16 21:05:16 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:05:16 volumio volumio[15234]: info: sendMpdCommand status took 2 milliseconds Mar 16 21:05:16 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:16 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:16 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 2 milliseconds Mar 16 21:05:16 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 1 milliseconds Mar 16 21:05:16 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:16 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:16 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:16 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:16 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":862,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"Nelly Furtado - Powerless","artist":"ANTENNE BAYERN Greatest Hits","album":null,"uri":"http://stream.antenne.de:80/greatest-hits","trackType":""} Mar 16 21:05:16 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:16 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:16 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:16 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:16 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:16 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:16 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:16 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:16 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:16 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:16 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:16 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:16 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:16 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":862,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"Nelly Furtado - Powerless","artist":"ANTENNE BAYERN Greatest Hits","album":null,"uri":"http://stream.antenne.de:80/greatest-hits","trackType":""} Mar 16 21:05:16 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:16 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:16 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:16 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:16 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:16 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:16 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:16 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:16 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:16 volumio volumio[15234]: info: ------------------------------ 51ms Mar 16 21:05:16 volumio volumio[15234]: info: ------------------------------ 50ms Mar 16 21:05:16 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 48 milliseconds Mar 16 21:05:16 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:16 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:16 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:16 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:16 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":862,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"Nelly Furtado - Powerless","artist":"ANTENNE BAYERN Greatest Hits","album":null,"uri":"http://stream.antenne.de:80/greatest-hits","trackType":""} Mar 16 21:05:16 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:16 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:16 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:16 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:16 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:16 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:16 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:16 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:16 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:16 volumio volumio[15234]: info: ------------------------------ 78ms Mar 16 21:05:17 volumio volumio[15234]: info: Mar 16 21:05:17 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:17 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:17 volumio volumio[15234]: info: Mar 16 21:05:17 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:17 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:17 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:17 volumio volumio[15234]: info: Mar 16 21:05:17 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:17 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:17 volumio volumio[15234]: info: Mar 16 21:05:17 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:17 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:17 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:17 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:05:17 volumio volumio[15234]: info: sendMpdCommand status took 3 milliseconds Mar 16 21:05:17 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:05:17 volumio volumio[15234]: info: sendMpdCommand status took 1 milliseconds Mar 16 21:05:17 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:17 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:17 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:17 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:17 volumio volumio[15234]: info: Mar 16 21:05:17 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:17 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:17 volumio volumio[15234]: info: Mar 16 21:05:17 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:17 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:17 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:17 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 2 milliseconds Mar 16 21:05:17 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 2 milliseconds Mar 16 21:05:17 volumio volumio[15234]: info: ------------------------------ 1ms Mar 16 21:05:17 volumio volumio[15234]: info: sendMpdCommand status took 1 milliseconds Mar 16 21:05:17 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:17 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:17 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:17 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:17 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:17 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:17 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:17 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":2233,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"Nelly Furtado - Powerless","artist":"ANTENNE BAYERN Greatest Hits","album":null,"uri":"http://stream.antenne.de:80/greatest-hits","trackType":""} Mar 16 21:05:17 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:17 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:17 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:17 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:17 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:17 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:17 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:17 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:17 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:17 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:17 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:17 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:17 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:17 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":2233,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"Nelly Furtado - Powerless","artist":"ANTENNE BAYERN Greatest Hits","album":null,"uri":"http://stream.antenne.de:80/greatest-hits","trackType":""} Mar 16 21:05:17 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:17 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:17 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:17 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:17 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:17 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:17 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:17 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:17 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:17 volumio volumio[15234]: info: ------------------------------ 34ms Mar 16 21:05:17 volumio volumio[15234]: info: ------------------------------ 33ms Mar 16 21:05:17 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 29 milliseconds Mar 16 21:05:17 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:17 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:17 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:17 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:17 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":2233,"duration":0,"samplerate":"44.1 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"Nelly Furtado - Powerless","artist":"ANTENNE BAYERN Greatest Hits","album":null,"uri":"http://stream.antenne.de:80/greatest-hits","trackType":""} Mar 16 21:05:17 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:17 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:17 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:17 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:17 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: albumart , getAlbumArt Mar 16 21:05:17 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:17 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:17 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:17 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:17 volumio volumio[15234]: info: ------------------------------ 48ms Mar 16 21:05:22 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:05:22 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::stPlaybackTimer Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:05:22 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:22 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:22 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:22 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::serviceStop Mar 16 21:05:22 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:22 volumio volumio[15234]: info: CoreCommandRouter::serviceStop Mar 16 21:05:22 volumio volumio[15234]: info: [1742130322425] ControllerWebradio::stop Mar 16 21:05:22 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:05:22 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:05:22 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:05:22 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:05:22 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:05:22 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:05:22 volumio volumio[15234]: info: Adding Item to queue: http://yp.shoutcast.com/sbin/tunein-station.m3u?id=1862581 Mar 16 21:05:22 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:05:22 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:05:22 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:05:22 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:05:22 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:22 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:05:22 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:22 volumio volumio[15234]: info: [1742130322442] ControllerWebradio::clearAddPlayTrack Mar 16 21:05:22 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:05:22 volumio volumio[15234]: info: sendMpdCommand stop took 24 milliseconds Mar 16 21:05:22 volumio volumio[15234]: info: Mar 16 21:05:22 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:22 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:22 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:22 volumio volumio[15234]: info: sendMpdCommand stop took 8 milliseconds Mar 16 21:05:22 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:05:22 volumio volumio[15234]: info: Mar 16 21:05:22 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:22 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:22 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:22 volumio volumio[15234]: info: Mar 16 21:05:22 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:22 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:22 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:22 volumio volumio[15234]: info: Mar 16 21:05:22 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:22 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:22 volumio volumio[15234]: info: sendMpdCommand status took 7 milliseconds Mar 16 21:05:22 volumio volumio[15234]: info: sendMpdCommand clear took 7 milliseconds Mar 16 21:05:22 volumio volumio[15234]: info: sendMpdCommand status took 6 milliseconds Mar 16 21:05:22 volumio volumio[15234]: info: sendMpdCommand status took 8 milliseconds Mar 16 21:05:22 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:22 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:22 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand load "http://yp.shoutcast.com/sbin/tunein-station.m3u?id=1862581" Mar 16 21:05:22 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:22 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:22 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:22 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:22 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:22 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:22 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:22 volumio volumio[15234]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Mar 16 21:05:22 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:22 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:22 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:22 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:22 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:22 volumio volumio[15234]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Mar 16 21:05:22 volumio volumio[15234]: info: ------------------------------ 43ms Mar 16 21:05:22 volumio volumio[15234]: info: Mar 16 21:05:22 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:22 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:22 volumio volumio[15234]: info: Mar 16 21:05:22 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:22 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:22 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:05:22 volumio volumio[15234]: info: ------------------------------ 60ms Mar 16 21:05:22 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 50 milliseconds Mar 16 21:05:22 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:22 volumio volumio[15234]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined Mar 16 21:05:22 volumio volumio[15234]: info: ------------------------------ 67ms Mar 16 21:05:22 volumio volumio[15234]: info: sendMpdCommand load "http://yp.shoutcast.com/sbin/tunein-station.m3u?id=1862581" took 233 milliseconds Mar 16 21:05:22 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:05:22 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:05:22 volumio volumio[15234]: info: Mar 16 21:05:22 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:22 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:22 volumio volumio[15234]: info: ------------------------------ 207ms Mar 16 21:05:22 volumio volumio[15234]: info: ------------------------------ 191ms Mar 16 21:05:22 volumio volumio[15234]: info: Mar 16 21:05:22 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:22 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:22 volumio volumio[15234]: info: Mar 16 21:05:22 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:22 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:22 volumio volumio[15234]: info: sendMpdCommand play took 4 milliseconds Mar 16 21:05:22 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:05:22 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:05:22 volumio volumio[15234]: info: ------------------------------ 1ms Mar 16 21:05:23 volumio volumio[15234]: info: Mar 16 21:05:23 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:23 volumio volumio[15234]: info: Mar 16 21:05:23 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:23 volumio volumio[15234]: info: Mar 16 21:05:23 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:23 volumio volumio[15234]: info: Mar 16 21:05:23 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand status took 6 milliseconds Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand status took 5 milliseconds Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand status took 4 milliseconds Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:23 volumio volumio[15234]: info: Mar 16 21:05:23 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:23 volumio volumio[15234]: info: Mar 16 21:05:23 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand status took 5 milliseconds Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 5 milliseconds Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 5 milliseconds Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 5 milliseconds Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand status took 3 milliseconds Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand status took 1 milliseconds Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:23 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:23 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"stream","artist":"(#1 - 330/1000) GOLD INSTRUMENTAL","album":null,"uri":"http://199.233.234.34:25373/stream","trackType":""} Mar 16 21:05:23 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:23 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:23 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"stream","artist":"(#1 - 330/1000) GOLD INSTRUMENTAL","album":null,"uri":"http://199.233.234.34:25373/stream","trackType":""} Mar 16 21:05:23 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:23 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:23 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:23 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"stream","artist":"(#1 - 330/1000) GOLD INSTRUMENTAL","album":null,"uri":"http://199.233.234.34:25373/stream","trackType":""} Mar 16 21:05:23 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:23 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: ------------------------------ 39ms Mar 16 21:05:23 volumio volumio[15234]: info: ------------------------------ 76ms Mar 16 21:05:23 volumio volumio[15234]: info: ------------------------------ 75ms Mar 16 21:05:23 volumio volumio[15234]: info: Mar 16 21:05:23 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:23 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:23 volumio volumio[15234]: info: Mar 16 21:05:23 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 70 milliseconds Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 67 milliseconds Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 67 milliseconds Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:23 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:23 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Helmut Zacharias - La Paloma","artist":"GOLD INSTRUMENTAL","album":null,"uri":"http://199.233.234.34:25373/stream","trackType":""} Mar 16 21:05:23 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:23 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:23 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:23 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Helmut Zacharias - La Paloma","artist":"GOLD INSTRUMENTAL","album":null,"uri":"http://199.233.234.34:25373/stream","trackType":""} Mar 16 21:05:23 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:23 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:23 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:23 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Helmut Zacharias - La Paloma","artist":"GOLD INSTRUMENTAL","album":null,"uri":"http://199.233.234.34:25373/stream","trackType":""} Mar 16 21:05:23 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:23 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: ------------------------------ 124ms Mar 16 21:05:23 volumio volumio[15234]: info: ------------------------------ 121ms Mar 16 21:05:23 volumio volumio[15234]: info: ------------------------------ 121ms Mar 16 21:05:23 volumio volumio[15234]: info: Mar 16 21:05:23 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:23 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:23 volumio volumio[15234]: info: Mar 16 21:05:23 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:23 volumio volumio[15234]: info: Mar 16 21:05:23 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:23 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:23 volumio volumio[15234]: info: Mar 16 21:05:23 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:23 volumio volumio[15234]: info: ------------------------------ 66ms Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand status took 67 milliseconds Mar 16 21:05:23 volumio volumio[15234]: info: ------------------------------ 16ms Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand status took 12 milliseconds Mar 16 21:05:23 volumio volumio[15234]: info: ------------------------------ 11ms Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand status took 9 milliseconds Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 1 milliseconds Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 2 milliseconds Mar 16 21:05:23 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 2 milliseconds Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:23 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:23 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:23 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":857,"duration":0,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"33 Kbps","isStreaming":false,"title":"Helmut Zacharias - La Paloma","artist":"GOLD INSTRUMENTAL","album":null,"uri":"http://199.233.234.34:25373/stream","trackType":""} Mar 16 21:05:23 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:23 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:23 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:23 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":857,"duration":0,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"33 Kbps","isStreaming":false,"title":"Helmut Zacharias - La Paloma","artist":"GOLD INSTRUMENTAL","album":null,"uri":"http://199.233.234.34:25373/stream","trackType":""} Mar 16 21:05:23 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:23 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:23 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:23 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":857,"duration":0,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"33 Kbps","isStreaming":false,"title":"Helmut Zacharias - La Paloma","artist":"GOLD INSTRUMENTAL","album":null,"uri":"http://199.233.234.34:25373/stream","trackType":""} Mar 16 21:05:23 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:05:23 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:23 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:23 volumio volumio[15234]: info: ------------------------------ 127ms Mar 16 21:05:23 volumio volumio[15234]: info: ------------------------------ 74ms Mar 16 21:05:23 volumio volumio[15234]: info: ------------------------------ 71ms Mar 16 21:05:35 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::stPlaybackTimer Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:05:35 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:35 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::serviceStop Mar 16 21:05:35 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::serviceStop Mar 16 21:05:35 volumio volumio[15234]: info: [1742130335078] ControllerWebradio::stop Mar 16 21:05:35 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:05:35 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:05:35 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:05:35 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:05:35 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:05:35 volumio volumio[15234]: info: Adding Item to queue: http://yp.shoutcast.com/sbin/tunein-station.m3u?id=99507868 Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:05:35 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:05:35 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:35 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:05:35 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:35 volumio volumio[15234]: info: [1742130335100] ControllerWebradio::clearAddPlayTrack Mar 16 21:05:35 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:05:35 volumio volumio[15234]: info: Mar 16 21:05:35 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:35 volumio volumio[15234]: info: sendMpdCommand stop took 37 milliseconds Mar 16 21:05:35 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:35 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:35 volumio volumio[15234]: info: sendMpdCommand stop took 15 milliseconds Mar 16 21:05:35 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:05:35 volumio volumio[15234]: info: Mar 16 21:05:35 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:35 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:35 volumio volumio[15234]: info: sendMpdCommand status took 2 milliseconds Mar 16 21:05:35 volumio volumio[15234]: info: sendMpdCommand clear took 2 milliseconds Mar 16 21:05:35 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:35 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:35 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand load "http://yp.shoutcast.com/sbin/tunein-station.m3u?id=99507868" Mar 16 21:05:35 volumio volumio[15234]: info: Mar 16 21:05:35 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:35 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:35 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:35 volumio volumio[15234]: info: Mar 16 21:05:35 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:35 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:35 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:35 volumio volumio[15234]: info: Mar 16 21:05:35 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:35 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:35 volumio volumio[15234]: info: Mar 16 21:05:35 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:35 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:35 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:05:35 volumio volumio[15234]: info: Mar 16 21:05:35 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:35 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:35 volumio volumio[15234]: info: ------------------------------ 238ms Mar 16 21:05:35 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 237 milliseconds Mar 16 21:05:35 volumio volumio[15234]: info: sendMpdCommand load "http://yp.shoutcast.com/sbin/tunein-station.m3u?id=99507868" took 236 milliseconds Mar 16 21:05:35 volumio volumio[15234]: info: sendMpdCommand status took 235 milliseconds Mar 16 21:05:35 volumio volumio[15234]: info: sendMpdCommand status took 234 milliseconds Mar 16 21:05:35 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:05:35 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:05:35 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:05:35 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:05:35 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:35 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:35 volumio volumio[15234]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined Mar 16 21:05:35 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:35 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:35 volumio volumio[15234]: 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} Mar 16 21:05:35 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:35 volumio volumio[15234]: info: No code Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:35 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:35 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:35 volumio volumio[15234]: 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} Mar 16 21:05:35 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:35 volumio volumio[15234]: info: No code Mar 16 21:05:35 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:35 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:35 volumio volumio[15234]: info: ------------------------------ 253ms Mar 16 21:05:35 volumio volumio[15234]: info: ------------------------------ 292ms Mar 16 21:05:35 volumio volumio[15234]: info: ------------------------------ 291ms Mar 16 21:05:35 volumio volumio[15234]: info: Mar 16 21:05:35 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:35 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:35 volumio volumio[15234]: info: Mar 16 21:05:35 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:35 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:35 volumio volumio[15234]: info: ------------------------------ 62ms Mar 16 21:05:35 volumio volumio[15234]: info: sendMpdCommand play took 61 milliseconds Mar 16 21:05:35 volumio volumio[15234]: info: ------------------------------ 4ms Mar 16 21:05:35 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:05:46 volumio volumio[15234]: info: Mar 16 21:05:46 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:46 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:46 volumio volumio[15234]: info: Mar 16 21:05:46 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:46 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:46 volumio volumio[15234]: info: Mar 16 21:05:46 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:46 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clearerror Mar 16 21:05:46 volumio volumio[15234]: info: sendMpdCommand status took 8 milliseconds Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clearerror Mar 16 21:05:46 volumio volumio[15234]: info: sendMpdCommand status took 8 milliseconds Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clearerror Mar 16 21:05:46 volumio volumio[15234]: info: sendMpdCommand status took 7 milliseconds Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:46 volumio volumio[15234]: info: sendMpdCommand clearerror took 10 milliseconds Mar 16 21:05:46 volumio volumio[15234]: info: sendMpdCommand clearerror took 10 milliseconds Mar 16 21:05:46 volumio volumio[15234]: info: sendMpdCommand clearerror took 9 milliseconds Mar 16 21:05:46 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 3 milliseconds Mar 16 21:05:46 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 2 milliseconds Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:46 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:46 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:46 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:46 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:46 volumio volumio[15234]: 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":"","artist":"(#1 - 43/1000) SplinterWood RocknRoll Radio","album":null,"uri":"http://31.3.245.162:8000/","trackType":"162:8000/"} Mar 16 21:05:46 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:46 volumio volumio[15234]: info: No code Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:46 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:46 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:46 volumio volumio[15234]: 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":"","artist":"(#1 - 43/1000) SplinterWood RocknRoll Radio","album":null,"uri":"http://31.3.245.162:8000/","trackType":"162:8000/"} Mar 16 21:05:46 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:46 volumio volumio[15234]: info: No code Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:46 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:46 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:46 volumio volumio[15234]: 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":"","artist":"(#1 - 43/1000) SplinterWood RocknRoll Radio","album":null,"uri":"http://31.3.245.162:8000/","trackType":"162:8000/"} Mar 16 21:05:46 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:46 volumio volumio[15234]: info: No code Mar 16 21:05:46 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:46 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:46 volumio volumio[15234]: info: ------------------------------ 85ms Mar 16 21:05:46 volumio volumio[15234]: info: ------------------------------ 84ms Mar 16 21:05:46 volumio volumio[15234]: info: ------------------------------ 83ms Mar 16 21:05:52 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , handleBrowseUri Mar 16 21:05:52 volumio volumio[15234]: info: Getting BBC Radios Mar 16 21:05:53 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:05:54 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:05:54 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:05:54 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:05:54 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:05:54 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:54 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:05:54 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:05:54 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:05:54 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:05:54 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:05:54 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:05:54 volumio volumio[15234]: info: Adding Item to queue: http://as-hls-ww-live.akamaized.net/pool_23461179/live/ww/bbc_radio_three/bbc_radio_three.isml/bbc_radio_three-audio%3d128000.norewind.m3u8 Mar 16 21:05:54 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:05:54 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:05:54 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:05:54 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:05:54 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:05:54 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:05:54 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:05:54 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:54 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:05:54 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:54 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:05:54 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:54 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:54 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:05:54 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:54 volumio volumio[15234]: info: [1742130354069] ControllerWebradio::clearAddPlayTrack Mar 16 21:05:54 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:05:54 volumio volumio[15234]: info: sendMpdCommand stop took 2 milliseconds Mar 16 21:05:54 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:05:54 volumio volumio[15234]: info: Mar 16 21:05:54 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:54 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:54 volumio volumio[15234]: info: sendMpdCommand clear took 2 milliseconds Mar 16 21:05:54 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand add "http://as-hls-ww-live.akamaized.net/pool_23461179/live/ww/bbc_radio_three/bbc_radio_three.isml/bbc_radio_three-audio%3d128000.norewind.m3u8" Mar 16 21:05:54 volumio volumio[15234]: info: Mar 16 21:05:54 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:54 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:54 volumio volumio[15234]: info: Mar 16 21:05:54 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:54 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:54 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:05:54 volumio volumio[15234]: info: Mar 16 21:05:54 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:54 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:54 volumio volumio[15234]: info: ------------------------------ 5ms Mar 16 21:05:54 volumio volumio[15234]: info: sendMpdCommand add "http://as-hls-ww-live.akamaized.net/pool_23461179/live/ww/bbc_radio_three/bbc_radio_three.isml/bbc_radio_three-audio%3d128000.norewind.m3u8" took 4 milliseconds Mar 16 21:05:54 volumio volumio[15234]: info: ------------------------------ 4ms Mar 16 21:05:54 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:05:54 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:05:54 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:05:54 volumio volumio[15234]: info: Mar 16 21:05:54 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:54 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:54 volumio volumio[15234]: info: Mar 16 21:05:54 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:54 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:54 volumio volumio[15234]: info: ------------------------------ 5ms Mar 16 21:05:54 volumio volumio[15234]: info: sendMpdCommand play took 3 milliseconds Mar 16 21:05:54 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:05:54 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:05:55 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:05:55 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:05:55 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:05:55 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:05:55 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:55 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:05:55 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:05:55 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:05:55 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:05:55 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:05:55 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:05:55 volumio volumio[15234]: info: Adding Item to queue: http://lstn.lv/bbcradio.m3u8?station=bbc_radio_three%22&bitrate=320000%22 Mar 16 21:05:55 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:05:55 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:05:56 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:05:56 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:05:56 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:05:56 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:05:56 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:05:56 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:56 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:05:56 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:56 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:05:56 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:05:56 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:56 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:05:56 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:56 volumio volumio[15234]: info: [1742130356002] ControllerWebradio::clearAddPlayTrack Mar 16 21:05:56 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:05:56 volumio volumio[15234]: info: Mar 16 21:05:56 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:56 volumio volumio[15234]: info: sendMpdCommand stop took 3 milliseconds Mar 16 21:05:56 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:56 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:56 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:05:56 volumio volumio[15234]: info: Mar 16 21:05:56 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:56 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:56 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:56 volumio volumio[15234]: info: Mar 16 21:05:56 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:05:56 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:05:56 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:05:56 volumio volumio[15234]: info: Mar 16 21:05:56 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:56 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:56 volumio volumio[15234]: info: sendMpdCommand status took 3 milliseconds Mar 16 21:05:56 volumio volumio[15234]: info: sendMpdCommand clear took 3 milliseconds Mar 16 21:05:56 volumio volumio[15234]: info: sendMpdCommand status took 2 milliseconds Mar 16 21:05:56 volumio volumio[15234]: info: sendMpdCommand status took 1 milliseconds Mar 16 21:05:56 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:56 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:05:56 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand add "http://lstn.lv/bbcradio.m3u8?station=bbc_radio_three%22&bitrate=320000%22" Mar 16 21:05:56 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:56 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:05:56 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:56 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:56 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:56 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:56 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:05:56 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:56 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:56 volumio volumio[15234]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Mar 16 21:05:56 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:05:56 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:05:56 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:05:56 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:56 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:05:56 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:05:56 volumio volumio[15234]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Mar 16 21:05:56 volumio volumio[15234]: info: ------------------------------ 25ms Mar 16 21:05:56 volumio volumio[15234]: info: ------------------------------ 24ms Mar 16 21:05:56 volumio volumio[15234]: info: Mar 16 21:05:56 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:56 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:56 volumio volumio[15234]: info: Mar 16 21:05:56 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:56 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:56 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:05:56 volumio volumio[15234]: info: Mar 16 21:05:56 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:56 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:56 volumio volumio[15234]: info: ------------------------------ 27ms Mar 16 21:05:56 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 27 milliseconds Mar 16 21:05:56 volumio volumio[15234]: info: sendMpdCommand add "http://lstn.lv/bbcradio.m3u8?station=bbc_radio_three%22&bitrate=320000%22" took 27 milliseconds Mar 16 21:05:56 volumio volumio[15234]: info: ------------------------------ 4ms Mar 16 21:05:56 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:05:56 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:05:56 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:05:56 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:05:56 volumio volumio[15234]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined Mar 16 21:05:56 volumio volumio[15234]: info: ------------------------------ 36ms Mar 16 21:05:56 volumio volumio[15234]: info: Mar 16 21:05:56 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:56 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:56 volumio volumio[15234]: info: Mar 16 21:05:56 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:05:56 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:05:56 volumio volumio[15234]: info: ------------------------------ 11ms Mar 16 21:05:56 volumio volumio[15234]: info: sendMpdCommand play took 9 milliseconds Mar 16 21:05:56 volumio volumio[15234]: info: ------------------------------ 6ms Mar 16 21:05:56 volumio volumio[15234]: info: ------------------------------ 4ms Mar 16 21:06:00 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:00 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:00 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:06:00 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:00 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:06:00 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:06:00 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:00 volumio volumio[15234]: info: Adding Item to queue: http://a.files.bbci.co.uk/ms6/live/3441A116-B12E-4D2F-ACA8-C1984642FA4B/audio/simulcast/hls/nonuk/pc_hd_abr_v2/ak/bbc_radio_one.m3u8 Mar 16 21:06:00 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:06:00 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:00 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:06:00 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:06:00 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:00 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:06:00 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:00 volumio volumio[15234]: info: [1742130360043] ControllerWebradio::clearAddPlayTrack Mar 16 21:06:00 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:06:00 volumio volumio[15234]: info: Mar 16 21:06:00 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:00 volumio volumio[15234]: info: sendMpdCommand stop took 2 milliseconds Mar 16 21:06:00 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:00 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:00 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:06:00 volumio volumio[15234]: info: Mar 16 21:06:00 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:00 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:00 volumio volumio[15234]: info: sendMpdCommand status took 1 milliseconds Mar 16 21:06:00 volumio volumio[15234]: info: sendMpdCommand clear took 1 milliseconds Mar 16 21:06:00 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:00 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:00 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand add "http://a.files.bbci.co.uk/ms6/live/3441A116-B12E-4D2F-ACA8-C1984642FA4B/audio/simulcast/hls/nonuk/pc_hd_abr_v2/ak/bbc_radio_one.m3u8" Mar 16 21:06:00 volumio volumio[15234]: info: Mar 16 21:06:00 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:00 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:00 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:00 volumio volumio[15234]: info: Mar 16 21:06:00 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:00 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:00 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:00 volumio volumio[15234]: info: Mar 16 21:06:00 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:00 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:00 volumio volumio[15234]: info: Mar 16 21:06:00 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:00 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:00 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:06:00 volumio volumio[15234]: info: Mar 16 21:06:00 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:00 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:00 volumio volumio[15234]: info: ------------------------------ 9ms Mar 16 21:06:00 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 4 milliseconds Mar 16 21:06:00 volumio volumio[15234]: info: sendMpdCommand add "http://a.files.bbci.co.uk/ms6/live/3441A116-B12E-4D2F-ACA8-C1984642FA4B/audio/simulcast/hls/nonuk/pc_hd_abr_v2/ak/bbc_radio_one.m3u8" took 4 milliseconds Mar 16 21:06:00 volumio volumio[15234]: info: sendMpdCommand status took 3 milliseconds Mar 16 21:06:00 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:06:00 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:06:00 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:06:00 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:06:00 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:00 volumio volumio[15234]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined Mar 16 21:06:00 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:00 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:00 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:06:00 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:00 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:00 volumio volumio[15234]: 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} Mar 16 21:06:00 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:00 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:00 volumio volumio[15234]: info: No code Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:00 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:00 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:00 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:00 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:00 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:00 volumio volumio[15234]: 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} Mar 16 21:06:00 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:00 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:00 volumio volumio[15234]: info: No code Mar 16 21:06:00 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:00 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:00 volumio volumio[15234]: info: ------------------------------ 22ms Mar 16 21:06:00 volumio volumio[15234]: info: ------------------------------ 53ms Mar 16 21:06:00 volumio volumio[15234]: info: ------------------------------ 53ms Mar 16 21:06:00 volumio volumio[15234]: info: Mar 16 21:06:00 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:00 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:00 volumio volumio[15234]: info: Mar 16 21:06:00 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:00 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:00 volumio volumio[15234]: info: ------------------------------ 54ms Mar 16 21:06:00 volumio volumio[15234]: info: sendMpdCommand play took 54 milliseconds Mar 16 21:06:00 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:06:00 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:06:02 volumio volumio[15234]: info: Mar 16 21:06:02 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:02 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:02 volumio volumio[15234]: info: Mar 16 21:06:02 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:02 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:02 volumio volumio[15234]: info: Mar 16 21:06:02 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:02 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clearerror Mar 16 21:06:02 volumio volumio[15234]: info: sendMpdCommand status took 7 milliseconds Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clearerror Mar 16 21:06:02 volumio volumio[15234]: info: sendMpdCommand status took 7 milliseconds Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clearerror Mar 16 21:06:02 volumio volumio[15234]: info: sendMpdCommand status took 6 milliseconds Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:02 volumio volumio[15234]: info: sendMpdCommand clearerror took 10 milliseconds Mar 16 21:06:02 volumio volumio[15234]: info: sendMpdCommand clearerror took 9 milliseconds Mar 16 21:06:02 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 3 milliseconds Mar 16 21:06:02 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 2 milliseconds Mar 16 21:06:02 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 3 milliseconds Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:02 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:02 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:06:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:02 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:02 volumio volumio[15234]: 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":"bbc_radio_one.m3u8","artist":null,"album":null,"uri":"http://a.files.bbci.co.uk/ms6/live/3441A116-B12E-4D2F-ACA8-C1984642FA4B/audio/simulcast/hls/nonuk/pc_hd_abr_v2/ak/bbc_radio_one.m3u8","trackType":"m3u8"} Mar 16 21:06:02 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:02 volumio volumio[15234]: info: No code Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:02 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:02 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:02 volumio volumio[15234]: 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":"bbc_radio_one.m3u8","artist":null,"album":null,"uri":"http://a.files.bbci.co.uk/ms6/live/3441A116-B12E-4D2F-ACA8-C1984642FA4B/audio/simulcast/hls/nonuk/pc_hd_abr_v2/ak/bbc_radio_one.m3u8","trackType":"m3u8"} Mar 16 21:06:02 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:02 volumio volumio[15234]: info: No code Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:02 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:02 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:02 volumio volumio[15234]: 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":"bbc_radio_one.m3u8","artist":null,"album":null,"uri":"http://a.files.bbci.co.uk/ms6/live/3441A116-B12E-4D2F-ACA8-C1984642FA4B/audio/simulcast/hls/nonuk/pc_hd_abr_v2/ak/bbc_radio_one.m3u8","trackType":"m3u8"} Mar 16 21:06:02 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:02 volumio volumio[15234]: info: No code Mar 16 21:06:02 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:02 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:02 volumio volumio[15234]: info: ------------------------------ 77ms Mar 16 21:06:02 volumio volumio[15234]: info: ------------------------------ 77ms Mar 16 21:06:02 volumio volumio[15234]: info: ------------------------------ 76ms Mar 16 21:06:04 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:04 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:06:04 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:06:04 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:04 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:04 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:06:04 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:04 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:04 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:06:04 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:06:04 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:04 volumio volumio[15234]: info: Adding Item to queue: http://lstn.lv/bbcradio.m3u8?station=bbc_radio_two%22&bitrate=320000%22 Mar 16 21:06:04 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:06:04 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:04 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:04 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:06:04 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:06:04 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:06:04 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:06:04 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:04 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:04 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:04 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:06:04 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:04 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:04 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:06:04 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:04 volumio volumio[15234]: info: [1742130364375] ControllerWebradio::clearAddPlayTrack Mar 16 21:06:04 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:06:04 volumio volumio[15234]: info: sendMpdCommand stop took 2 milliseconds Mar 16 21:06:04 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:06:04 volumio volumio[15234]: info: Mar 16 21:06:04 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:04 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:04 volumio volumio[15234]: info: sendMpdCommand clear took 1 milliseconds Mar 16 21:06:04 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand add "http://lstn.lv/bbcradio.m3u8?station=bbc_radio_two%22&bitrate=320000%22" Mar 16 21:06:04 volumio volumio[15234]: info: Mar 16 21:06:04 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:04 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:04 volumio volumio[15234]: info: Mar 16 21:06:04 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:04 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:04 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:06:04 volumio volumio[15234]: info: Mar 16 21:06:04 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:04 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:04 volumio volumio[15234]: info: ------------------------------ 4ms Mar 16 21:06:04 volumio volumio[15234]: info: sendMpdCommand add "http://lstn.lv/bbcradio.m3u8?station=bbc_radio_two%22&bitrate=320000%22" took 4 milliseconds Mar 16 21:06:04 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:06:04 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:06:04 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:06:04 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:06:04 volumio volumio[15234]: info: Mar 16 21:06:04 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:04 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:04 volumio volumio[15234]: info: Mar 16 21:06:04 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:04 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:04 volumio volumio[15234]: info: ------------------------------ 4ms Mar 16 21:06:04 volumio volumio[15234]: info: sendMpdCommand play took 3 milliseconds Mar 16 21:06:04 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:06:04 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:06:05 volumio volumio[15234]: info: Mar 16 21:06:05 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:05 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:05 volumio volumio[15234]: info: Mar 16 21:06:05 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:05 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clearerror Mar 16 21:06:05 volumio volumio[15234]: info: sendMpdCommand status took 5 milliseconds Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:05 volumio volumio[15234]: info: Mar 16 21:06:05 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:05 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clearerror Mar 16 21:06:05 volumio volumio[15234]: info: sendMpdCommand status took 10 milliseconds Mar 16 21:06:05 volumio volumio[15234]: info: sendMpdCommand clearerror took 6 milliseconds Mar 16 21:06:05 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 5 milliseconds Mar 16 21:06:05 volumio volumio[15234]: info: sendMpdCommand status took 4 milliseconds Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:05 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:05 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:05 volumio volumio[15234]: 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":"bbcradio.m3u8?station=bbc_radio_two%22&bitrate=320000%22","artist":null,"album":null,"uri":"http://lstn.lv/bbcradio.m3u8?station=bbc_radio_two%22&bitrate=320000%22","trackType":""} Mar 16 21:06:05 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:05 volumio volumio[15234]: info: No code Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:05 volumio volumio[15234]: info: ------------------------------ 39ms Mar 16 21:06:05 volumio volumio[15234]: info: sendMpdCommand clearerror took 32 milliseconds Mar 16 21:06:05 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 31 milliseconds Mar 16 21:06:05 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 31 milliseconds Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:05 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:05 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:05 volumio volumio[15234]: 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":"bbcradio.m3u8?station=bbc_radio_two%22&bitrate=320000%22","artist":null,"album":null,"uri":"http://lstn.lv/bbcradio.m3u8?station=bbc_radio_two%22&bitrate=320000%22","trackType":""} Mar 16 21:06:05 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:05 volumio volumio[15234]: info: No code Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:05 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:05 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:05 volumio volumio[15234]: 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":"bbcradio.m3u8?station=bbc_radio_two%22&bitrate=320000%22","artist":null,"album":null,"uri":"http://lstn.lv/bbcradio.m3u8?station=bbc_radio_two%22&bitrate=320000%22","trackType":""} Mar 16 21:06:05 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:05 volumio volumio[15234]: info: No code Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:05 volumio volumio[15234]: info: ------------------------------ 91ms Mar 16 21:06:05 volumio volumio[15234]: info: ------------------------------ 87ms Mar 16 21:06:05 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:05 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:06:05 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:06:05 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:06:05 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:05 volumio volumio[15234]: info: Adding Item to queue: http://as-hls-ww-live.akamaized.net/pool_01505109/live/ww/bbc_radio_one/bbc_radio_one.isml/bbc_radio_one-audio%3d128000.norewind.m3u8 Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:05 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:06:05 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:06:05 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:05 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:06:05 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:05 volumio volumio[15234]: info: [1742130365843] ControllerWebradio::clearAddPlayTrack Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:06:05 volumio volumio[15234]: info: sendMpdCommand stop took 1 milliseconds Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:06:05 volumio volumio[15234]: info: Mar 16 21:06:05 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:05 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:05 volumio volumio[15234]: info: sendMpdCommand clear took 1 milliseconds Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand add "http://as-hls-ww-live.akamaized.net/pool_01505109/live/ww/bbc_radio_one/bbc_radio_one.isml/bbc_radio_one-audio%3d128000.norewind.m3u8" Mar 16 21:06:05 volumio volumio[15234]: info: Mar 16 21:06:05 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:05 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:05 volumio volumio[15234]: info: Mar 16 21:06:05 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:05 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:05 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:06:05 volumio volumio[15234]: info: Mar 16 21:06:05 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:05 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:05 volumio volumio[15234]: info: ------------------------------ 5ms Mar 16 21:06:05 volumio volumio[15234]: info: sendMpdCommand add "http://as-hls-ww-live.akamaized.net/pool_01505109/live/ww/bbc_radio_one/bbc_radio_one.isml/bbc_radio_one-audio%3d128000.norewind.m3u8" took 5 milliseconds Mar 16 21:06:05 volumio volumio[15234]: info: ------------------------------ 4ms Mar 16 21:06:05 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:06:05 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:06:05 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:06:05 volumio volumio[15234]: info: Mar 16 21:06:05 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:05 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:05 volumio volumio[15234]: info: Mar 16 21:06:05 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:05 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:05 volumio volumio[15234]: info: ------------------------------ 6ms Mar 16 21:06:05 volumio volumio[15234]: info: sendMpdCommand play took 4 milliseconds Mar 16 21:06:05 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:06:09 volumio volumio[15234]: info: Mar 16 21:06:09 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:09 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:09 volumio volumio[15234]: info: Mar 16 21:06:09 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:09 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:09 volumio volumio[15234]: info: Mar 16 21:06:09 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:09 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:09 volumio volumio[15234]: info: Mar 16 21:06:09 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:09 volumio volumio[15234]: info: sendMpdCommand status took 6 milliseconds Mar 16 21:06:09 volumio volumio[15234]: info: sendMpdCommand status took 5 milliseconds Mar 16 21:06:09 volumio volumio[15234]: info: sendMpdCommand status took 5 milliseconds Mar 16 21:06:09 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:09 volumio volumio[15234]: info: sendMpdCommand status took 2 milliseconds Mar 16 21:06:09 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 1 milliseconds Mar 16 21:06:09 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 1 milliseconds Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:09 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:09 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:09 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":48,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"bbc_radio_one-audio%3d128000.norewind.m3u8","artist":null,"album":null,"uri":"http://as-hls-ww-live.akamaized.net/pool_01505109/live/ww/bbc_radio_one/bbc_radio_one.isml/bbc_radio_one-audio%3d128000.norewind.m3u8","trackType":"m3u8"} Mar 16 21:06:09 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:09 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:09 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:09 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":48,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"bbc_radio_one-audio%3d128000.norewind.m3u8","artist":null,"album":null,"uri":"http://as-hls-ww-live.akamaized.net/pool_01505109/live/ww/bbc_radio_one/bbc_radio_one.isml/bbc_radio_one-audio%3d128000.norewind.m3u8","trackType":"m3u8"} Mar 16 21:06:09 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:06:09 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:09 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:09 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:09 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":48,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"bbc_radio_one-audio%3d128000.norewind.m3u8","artist":null,"album":null,"uri":"http://as-hls-ww-live.akamaized.net/pool_01505109/live/ww/bbc_radio_one/bbc_radio_one.isml/bbc_radio_one-audio%3d128000.norewind.m3u8","trackType":"m3u8"} Mar 16 21:06:09 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:06:09 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:09 volumio volumio[15234]: info: ------------------------------ 24ms Mar 16 21:06:09 volumio volumio[15234]: info: ------------------------------ 51ms Mar 16 21:06:09 volumio volumio[15234]: info: ------------------------------ 51ms Mar 16 21:06:09 volumio volumio[15234]: info: Mar 16 21:06:09 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:09 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:09 volumio volumio[15234]: info: Mar 16 21:06:09 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:09 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:09 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 47 milliseconds Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:09 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:09 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:09 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":0,"samplerate":48,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"bbc_radio_one-audio%3d128000.norewind.m3u8","artist":null,"album":null,"uri":"http://as-hls-ww-live.akamaized.net/pool_01505109/live/ww/bbc_radio_one/bbc_radio_one.isml/bbc_radio_one-audio%3d128000.norewind.m3u8","trackType":"m3u8"} Mar 16 21:06:09 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:06:09 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:09 volumio volumio[15234]: info: ------------------------------ 77ms Mar 16 21:06:09 volumio volumio[15234]: info: sendMpdCommand status took 33 milliseconds Mar 16 21:06:09 volumio volumio[15234]: info: sendMpdCommand status took 33 milliseconds Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:09 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 1 milliseconds Mar 16 21:06:09 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 1 milliseconds Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:09 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:09 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:09 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:09 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":987,"duration":0,"samplerate":48,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"bbc_radio_one-audio%3d128000.norewind.m3u8","artist":null,"album":null,"uri":"http://as-hls-ww-live.akamaized.net/pool_01505109/live/ww/bbc_radio_one/bbc_radio_one.isml/bbc_radio_one-audio%3d128000.norewind.m3u8","trackType":"m3u8"} Mar 16 21:06:09 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:06:09 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:09 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:09 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:09 volumio volumio[15234]: verbose: STATE SERVICE {"status":"play","position":0,"seek":987,"duration":0,"samplerate":48,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"bbc_radio_one-audio%3d128000.norewind.m3u8","artist":null,"album":null,"uri":"http://as-hls-ww-live.akamaized.net/pool_01505109/live/ww/bbc_radio_one/bbc_radio_one.isml/bbc_radio_one-audio%3d128000.norewind.m3u8","trackType":"m3u8"} Mar 16 21:06:09 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::syncState stateService play Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus play Mar 16 21:06:09 volumio volumio[15234]: info: Received an update from plugin. extracting info from payload Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:09 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:09 volumio volumio[15234]: info: ------------------------------ 65ms Mar 16 21:06:09 volumio volumio[15234]: info: ------------------------------ 64ms Mar 16 21:06:16 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:16 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::stPlaybackTimer Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:06:16 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:16 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:16 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:06:16 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::serviceStop Mar 16 21:06:16 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:16 volumio volumio[15234]: info: CoreCommandRouter::serviceStop Mar 16 21:06:16 volumio volumio[15234]: info: [1742130376013] ControllerWebradio::stop Mar 16 21:06:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:06:16 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:06:16 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:16 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:06:16 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:06:16 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:16 volumio volumio[15234]: info: Adding Item to queue: http://lstn.lv/bbcradio.m3u8?station=bbc_radio_five_live%22&bitrate=320000%22 Mar 16 21:06:16 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:06:16 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:16 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:06:16 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:06:16 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:16 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:06:16 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:16 volumio volumio[15234]: info: [1742130376029] ControllerWebradio::clearAddPlayTrack Mar 16 21:06:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:06:16 volumio volumio[15234]: info: Mar 16 21:06:16 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:16 volumio volumio[15234]: info: sendMpdCommand stop took 37 milliseconds Mar 16 21:06:16 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:16 volumio volumio[15234]: info: sendMpdCommand stop took 21 milliseconds Mar 16 21:06:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:06:16 volumio volumio[15234]: info: Mar 16 21:06:16 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:16 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:16 volumio volumio[15234]: info: Mar 16 21:06:16 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:16 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:16 volumio volumio[15234]: info: Mar 16 21:06:16 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:16 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:16 volumio volumio[15234]: info: sendMpdCommand status took 5 milliseconds Mar 16 21:06:16 volumio volumio[15234]: info: sendMpdCommand clear took 3 milliseconds Mar 16 21:06:16 volumio volumio[15234]: info: sendMpdCommand status took 2 milliseconds Mar 16 21:06:16 volumio volumio[15234]: info: sendMpdCommand status took 1 milliseconds Mar 16 21:06:16 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand add "http://lstn.lv/bbcradio.m3u8?station=bbc_radio_five_live%22&bitrate=320000%22" Mar 16 21:06:16 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:16 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:16 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:16 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:16 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:16 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:06:16 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:16 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:16 volumio volumio[15234]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Mar 16 21:06:16 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:16 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:16 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:16 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:16 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:16 volumio volumio[15234]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current webradio Received mpd Mar 16 21:06:16 volumio volumio[15234]: info: ------------------------------ 18ms Mar 16 21:06:16 volumio volumio[15234]: info: ------------------------------ 18ms Mar 16 21:06:16 volumio volumio[15234]: info: Mar 16 21:06:16 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:16 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:16 volumio volumio[15234]: info: Mar 16 21:06:16 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:16 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:16 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:06:16 volumio volumio[15234]: info: Mar 16 21:06:16 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:16 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:16 volumio volumio[15234]: info: ------------------------------ 21ms Mar 16 21:06:16 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 20 milliseconds Mar 16 21:06:16 volumio volumio[15234]: info: sendMpdCommand add "http://lstn.lv/bbcradio.m3u8?station=bbc_radio_five_live%22&bitrate=320000%22" took 20 milliseconds Mar 16 21:06:16 volumio volumio[15234]: info: ------------------------------ 4ms Mar 16 21:06:16 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:06:16 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:16 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:06:16 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:06:16 volumio volumio[15234]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined Mar 16 21:06:16 volumio volumio[15234]: info: ------------------------------ 29ms Mar 16 21:06:16 volumio volumio[15234]: info: Mar 16 21:06:16 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:16 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:16 volumio volumio[15234]: info: Mar 16 21:06:16 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:16 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:16 volumio volumio[15234]: info: ------------------------------ 9ms Mar 16 21:06:16 volumio volumio[15234]: info: sendMpdCommand play took 7 milliseconds Mar 16 21:06:16 volumio volumio[15234]: info: ------------------------------ 5ms Mar 16 21:06:16 volumio volumio[15234]: info: ------------------------------ 5ms Mar 16 21:06:18 volumio volumio[15234]: info: Mar 16 21:06:18 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:18 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:18 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:18 volumio volumio[15234]: info: Mar 16 21:06:18 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:18 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:18 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:18 volumio volumio[15234]: info: Mar 16 21:06:18 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:18 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:18 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:18 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clearerror Mar 16 21:06:18 volumio volumio[15234]: info: sendMpdCommand status took 9 milliseconds Mar 16 21:06:18 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clearerror Mar 16 21:06:18 volumio volumio[15234]: info: sendMpdCommand status took 9 milliseconds Mar 16 21:06:18 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clearerror Mar 16 21:06:18 volumio volumio[15234]: info: sendMpdCommand status took 8 milliseconds Mar 16 21:06:18 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:18 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:18 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:18 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:18 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:18 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:18 volumio volumio[15234]: info: sendMpdCommand clearerror took 12 milliseconds Mar 16 21:06:18 volumio volumio[15234]: info: sendMpdCommand clearerror took 11 milliseconds Mar 16 21:06:18 volumio volumio[15234]: info: sendMpdCommand clearerror took 10 milliseconds Mar 16 21:06:18 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 3 milliseconds Mar 16 21:06:18 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 2 milliseconds Mar 16 21:06:18 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:18 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:18 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:06:18 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:18 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:18 volumio volumio[15234]: 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":"bbcradio.m3u8?station=bbc_radio_five_live%22&bitrate=320000%22","artist":null,"album":null,"uri":"http://lstn.lv/bbcradio.m3u8?station=bbc_radio_five_live%22&bitrate=320000%22","trackType":""} Mar 16 21:06:18 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:18 volumio volumio[15234]: info: No code Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:18 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:18 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:18 volumio volumio[15234]: 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":"bbcradio.m3u8?station=bbc_radio_five_live%22&bitrate=320000%22","artist":null,"album":null,"uri":"http://lstn.lv/bbcradio.m3u8?station=bbc_radio_five_live%22&bitrate=320000%22","trackType":""} Mar 16 21:06:18 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:18 volumio volumio[15234]: info: No code Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:18 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:18 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:18 volumio volumio[15234]: 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":"bbcradio.m3u8?station=bbc_radio_five_live%22&bitrate=320000%22","artist":null,"album":null,"uri":"http://lstn.lv/bbcradio.m3u8?station=bbc_radio_five_live%22&bitrate=320000%22","trackType":""} Mar 16 21:06:18 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:18 volumio volumio[15234]: info: No code Mar 16 21:06:18 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:18 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:18 volumio volumio[15234]: info: ------------------------------ 85ms Mar 16 21:06:18 volumio volumio[15234]: info: ------------------------------ 83ms Mar 16 21:06:18 volumio volumio[15234]: info: ------------------------------ 83ms Mar 16 21:06:19 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:19 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:06:19 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:06:19 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:19 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:19 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:06:19 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:19 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:19 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:06:19 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:06:19 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:19 volumio volumio[15234]: info: Adding Item to queue: http://a.files.bbci.co.uk/media/live/manifesto/audio/simulcast/hls/nonuk/sbr_low/ak/bbc_arabic_radio.m3u8 Mar 16 21:06:19 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:06:19 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:19 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:06:20 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:20 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:06:20 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:20 volumio volumio[15234]: info: [1742130380001] ControllerWebradio::clearAddPlayTrack Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:06:20 volumio volumio[15234]: info: sendMpdCommand stop took 1 milliseconds Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:06:20 volumio volumio[15234]: info: Mar 16 21:06:20 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:20 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:20 volumio volumio[15234]: info: sendMpdCommand clear took 1 milliseconds Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand add "http://a.files.bbci.co.uk/media/live/manifesto/audio/simulcast/hls/nonuk/sbr_low/ak/bbc_arabic_radio.m3u8" Mar 16 21:06:20 volumio volumio[15234]: info: Mar 16 21:06:20 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:20 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:20 volumio volumio[15234]: info: Mar 16 21:06:20 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:20 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:20 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:06:20 volumio volumio[15234]: info: Mar 16 21:06:20 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:20 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:20 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:06:20 volumio volumio[15234]: info: sendMpdCommand add "http://a.files.bbci.co.uk/media/live/manifesto/audio/simulcast/hls/nonuk/sbr_low/ak/bbc_arabic_radio.m3u8" took 2 milliseconds Mar 16 21:06:20 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:06:20 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:06:20 volumio volumio[15234]: info: Mar 16 21:06:20 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:20 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:20 volumio volumio[15234]: info: Mar 16 21:06:20 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:20 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:20 volumio volumio[15234]: info: ------------------------------ 4ms Mar 16 21:06:20 volumio volumio[15234]: info: sendMpdCommand play took 3 milliseconds Mar 16 21:06:20 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:06:20 volumio volumio[15234]: info: ------------------------------ 1ms Mar 16 21:06:20 volumio volumio[15234]: info: Mar 16 21:06:20 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:20 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:20 volumio volumio[15234]: info: Mar 16 21:06:20 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:20 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clearerror Mar 16 21:06:20 volumio volumio[15234]: info: sendMpdCommand status took 7 milliseconds Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:20 volumio volumio[15234]: info: Mar 16 21:06:20 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:20 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clearerror Mar 16 21:06:20 volumio volumio[15234]: info: sendMpdCommand status took 12 milliseconds Mar 16 21:06:20 volumio volumio[15234]: info: sendMpdCommand clearerror took 6 milliseconds Mar 16 21:06:20 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 5 milliseconds Mar 16 21:06:20 volumio volumio[15234]: info: sendMpdCommand status took 5 milliseconds Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand playlistinfo Mar 16 21:06:20 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:20 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:20 volumio volumio[15234]: 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":"bbc_arabic_radio.m3u8","artist":null,"album":null,"uri":"http://a.files.bbci.co.uk/media/live/manifesto/audio/simulcast/hls/nonuk/sbr_low/ak/bbc_arabic_radio.m3u8","trackType":"m3u8"} Mar 16 21:06:20 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:20 volumio volumio[15234]: info: No code Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:20 volumio volumio[15234]: info: ------------------------------ 42ms Mar 16 21:06:20 volumio volumio[15234]: info: sendMpdCommand clearerror took 33 milliseconds Mar 16 21:06:20 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 32 milliseconds Mar 16 21:06:20 volumio volumio[15234]: info: sendMpdCommand playlistinfo took 31 milliseconds Mar 16 21:06:20 volumio volumio[15234]: verbose: ControllerMpd::parseTrackInfo Mar 16 21:06:20 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:20 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:20 volumio volumio[15234]: 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":"bbc_arabic_radio.m3u8","artist":null,"album":null,"uri":"http://a.files.bbci.co.uk/media/live/manifesto/audio/simulcast/hls/nonuk/sbr_low/ak/bbc_arabic_radio.m3u8","trackType":"m3u8"} Mar 16 21:06:20 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:20 volumio volumio[15234]: info: No code Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:20 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:20 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:20 volumio volumio[15234]: 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":"bbc_arabic_radio.m3u8","artist":null,"album":null,"uri":"http://a.files.bbci.co.uk/media/live/manifesto/audio/simulcast/hls/nonuk/sbr_low/ak/bbc_arabic_radio.m3u8","trackType":"m3u8"} Mar 16 21:06:20 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:20 volumio volumio[15234]: info: No code Mar 16 21:06:20 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:20 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:20 volumio volumio[15234]: info: ------------------------------ 89ms Mar 16 21:06:20 volumio volumio[15234]: info: ------------------------------ 83ms Mar 16 21:06:22 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:22 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:06:22 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:06:22 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:22 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:22 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:06:22 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:22 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:22 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:06:22 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:06:22 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:22 volumio volumio[15234]: info: Adding Item to queue: https://stream.live.vc.bbcmedia.co.uk/bbc_world_service_australasia Mar 16 21:06:22 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:06:22 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:22 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:22 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:06:22 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:06:22 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:06:22 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:06:22 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:22 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:22 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:22 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:06:22 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:22 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:22 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:06:22 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:22 volumio volumio[15234]: info: [1742130382364] ControllerWebradio::clearAddPlayTrack Mar 16 21:06:22 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:06:22 volumio volumio[15234]: info: sendMpdCommand stop took 2 milliseconds Mar 16 21:06:22 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:06:22 volumio volumio[15234]: info: Mar 16 21:06:22 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:22 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:22 volumio volumio[15234]: info: sendMpdCommand clear took 1 milliseconds Mar 16 21:06:22 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand load "https://stream.live.vc.bbcmedia.co.uk/bbc_world_service_australasia" Mar 16 21:06:22 volumio volumio[15234]: info: Mar 16 21:06:22 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:22 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:22 volumio volumio[15234]: info: Mar 16 21:06:22 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:22 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:22 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:06:22 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:06:25 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:25 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:06:25 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:06:25 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:25 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:25 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:06:25 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:25 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:25 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:06:25 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:06:25 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:25 volumio volumio[15234]: info: Adding Item to queue: https://cdn4.skygo.mn/live/disk1/BBC_News/HLSv3-FTA/BBC_News.m3u8 Mar 16 21:06:25 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:06:25 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:25 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:25 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:06:25 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:06:25 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:06:25 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:06:25 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:25 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:25 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:25 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:06:25 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:25 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:25 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:06:25 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:25 volumio volumio[15234]: info: [1742130385427] ControllerWebradio::clearAddPlayTrack Mar 16 21:06:25 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:06:27 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:06:27 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:06:27 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand add "https://stream.live.vc.bbcmedia.co.uk/bbc_world_service_australasia" Mar 16 21:06:27 volumio volumio[15234]: info: ------------------------------ 4678ms Mar 16 21:06:27 volumio volumio[15234]: info: ------------------------------ 4677ms Mar 16 21:06:27 volumio volumio[15234]: info: sendMpdCommand stop took 1619 milliseconds Mar 16 21:06:27 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:06:27 volumio volumio[15234]: info: Mar 16 21:06:27 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:27 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:27 volumio volumio[15234]: info: sendMpdCommand add "https://stream.live.vc.bbcmedia.co.uk/bbc_world_service_australasia" took 2 milliseconds Mar 16 21:06:27 volumio volumio[15234]: info: sendMpdCommand clear took 1 milliseconds Mar 16 21:06:27 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:06:27 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:06:27 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand add "https://cdn4.skygo.mn/live/disk1/BBC_News/HLSv3-FTA/BBC_News.m3u8" Mar 16 21:06:27 volumio volumio[15234]: info: Mar 16 21:06:27 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:27 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:27 volumio volumio[15234]: info: Mar 16 21:06:27 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:27 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:27 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:06:27 volumio volumio[15234]: info: Mar 16 21:06:27 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:27 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:27 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:06:27 volumio volumio[15234]: info: sendMpdCommand play took 2 milliseconds Mar 16 21:06:27 volumio volumio[15234]: info: sendMpdCommand add "https://cdn4.skygo.mn/live/disk1/BBC_News/HLSv3-FTA/BBC_News.m3u8" took 2 milliseconds Mar 16 21:06:27 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:06:27 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:06:27 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:06:27 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:06:27 volumio volumio[15234]: info: Mar 16 21:06:27 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:27 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:27 volumio volumio[15234]: info: Mar 16 21:06:27 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:27 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:27 volumio volumio[15234]: info: ------------------------------ 3ms Mar 16 21:06:27 volumio volumio[15234]: info: sendMpdCommand play took 2 milliseconds Mar 16 21:06:27 volumio volumio[15234]: info: ------------------------------ 2ms Mar 16 21:06:27 volumio volumio[15234]: info: ------------------------------ 1ms Mar 16 21:06:33 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:33 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:06:33 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:06:33 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:33 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:33 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:06:33 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:33 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:33 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:06:33 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:06:33 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:33 volumio volumio[15234]: info: Adding Item to queue: https://cdn4.skygo.mn/live/disk1/BBC_News/HLSv3-FTA/BBC_News.m3u8 Mar 16 21:06:33 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:06:33 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:33 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:33 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:06:33 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:06:33 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:06:33 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:06:33 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:33 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:33 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:33 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:06:33 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:33 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:33 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:06:33 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:33 volumio volumio[15234]: info: [1742130393354] ControllerWebradio::clearAddPlayTrack Mar 16 21:06:33 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:06:35 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:35 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:06:35 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:06:35 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:35 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:35 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:06:35 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:35 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:35 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:06:35 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:06:35 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:35 volumio volumio[15234]: info: Adding Item to queue: https://a.files.bbci.co.uk/ms6/live/3441A116-B12E-4D2F-ACA8-C1984642FA4B/audio/simulcast/hls/nonuk/audio_syndication_low_sbr_v1/aks/bbc_radio_one.m3u8 Mar 16 21:06:35 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:06:35 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:35 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:35 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:06:35 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:06:35 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:06:35 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:06:35 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:35 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:35 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:35 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:06:35 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:35 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:35 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:06:35 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:35 volumio volumio[15234]: info: [1742130395977] ControllerWebradio::clearAddPlayTrack Mar 16 21:06:35 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:06:36 volumio volumio[15234]: info: sendMpdCommand stop took 3519 milliseconds Mar 16 21:06:36 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:06:36 volumio volumio[15234]: info: Mar 16 21:06:36 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:36 volumio volumio[15234]: info: Mar 16 21:06:36 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:36 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:36 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:36 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:36 volumio volumio[15234]: info: sendMpdCommand stop took 899 milliseconds Mar 16 21:06:36 volumio volumio[15234]: info: sendMpdCommand clear took 2 milliseconds Mar 16 21:06:36 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand clear Mar 16 21:06:36 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand add "https://cdn4.skygo.mn/live/disk1/BBC_News/HLSv3-FTA/BBC_News.m3u8" Mar 16 21:06:36 volumio volumio[15234]: info: Mar 16 21:06:36 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:36 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:36 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:36 volumio volumio[15234]: info: Mar 16 21:06:36 volumio volumio[15234]: ---------------------------- MPD announces state update: player Mar 16 21:06:36 volumio volumio[15234]: info: ControllerMpd::getState Mar 16 21:06:36 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand status Mar 16 21:06:36 volumio volumio[15234]: error: updateQueue error: null Mar 16 21:06:36 volumio volumio[15234]: info: Mar 16 21:06:36 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:36 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:36 volumio volumio[15234]: info: Mar 16 21:06:36 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:36 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:36 volumio volumio[15234]: info: sendMpdCommand status took 7 milliseconds Mar 16 21:06:36 volumio volumio[15234]: info: ------------------------------ 8ms Mar 16 21:06:36 volumio volumio[15234]: info: sendMpdCommand clear took 6 milliseconds Mar 16 21:06:36 volumio volumio[15234]: info: sendMpdCommand add "https://cdn4.skygo.mn/live/disk1/BBC_News/HLSv3-FTA/BBC_News.m3u8" took 6 milliseconds Mar 16 21:06:36 volumio volumio[15234]: info: sendMpdCommand status took 5 milliseconds Mar 16 21:06:36 volumio volumio[15234]: info: sendMpdCommand status took 4 milliseconds Mar 16 21:06:36 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:36 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand add "https://a.files.bbci.co.uk/ms6/live/3441A116-B12E-4D2F-ACA8-C1984642FA4B/audio/simulcast/hls/nonuk/audio_syndication_low_sbr_v1/aks/bbc_radio_one.m3u8" Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:06:36 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:06:36 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:36 volumio volumio[15234]: verbose: ControllerMpd::parseState Mar 16 21:06:36 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Mar 16 21:06:36 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:36 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:36 volumio volumio[15234]: 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} Mar 16 21:06:36 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:36 volumio volumio[15234]: info: No code Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:36 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:36 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:36 volumio volumio[15234]: 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} Mar 16 21:06:36 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:36 volumio volumio[15234]: info: No code Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:36 volumio volumio[15234]: info: ControllerMpd::pushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreCommandRouter::servicePushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:36 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:36 volumio volumio[15234]: 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} Mar 16 21:06:36 volumio volumio[15234]: verbose: CURRENT POSITION 0 Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::syncState stateService stop Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::syncState currentStatus stop Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:36 volumio volumio[15234]: info: No code Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::pushState Mar 16 21:06:36 volumio volumio[15234]: info: CoreCommandRouter::volumioPushState Mar 16 21:06:36 volumio volumio[15234]: info: ------------------------------ 83ms Mar 16 21:06:36 volumio volumio[15234]: info: ------------------------------ 81ms Mar 16 21:06:36 volumio volumio[15234]: info: ------------------------------ 81ms Mar 16 21:06:36 volumio volumio[15234]: info: Mar 16 21:06:36 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:36 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:36 volumio volumio[15234]: info: Mar 16 21:06:36 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:36 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:36 volumio volumio[15234]: info: Mar 16 21:06:36 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:36 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:36 volumio volumio[15234]: info: ------------------------------ 86ms Mar 16 21:06:36 volumio volumio[15234]: info: ------------------------------ 86ms Mar 16 21:06:36 volumio volumio[15234]: info: sendMpdCommand add "https://a.files.bbci.co.uk/ms6/live/3441A116-B12E-4D2F-ACA8-C1984642FA4B/audio/simulcast/hls/nonuk/audio_syndication_low_sbr_v1/aks/bbc_radio_one.m3u8" took 80 milliseconds Mar 16 21:06:36 volumio volumio[15234]: info: sendMpdCommand play took 81 milliseconds Mar 16 21:06:36 volumio volumio[15234]: info: ------------------------------ 8ms Mar 16 21:06:36 volumio volumio[15234]: info: ------------------------------ 6ms Mar 16 21:06:36 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService mpd Mar 16 21:06:36 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand play Mar 16 21:06:36 volumio volumio[15234]: info: Mar 16 21:06:36 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:36 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:36 volumio volumio[15234]: info: Mar 16 21:06:36 volumio volumio[15234]: ---------------------------- MPD announces system playlist update Mar 16 21:06:36 volumio volumio[15234]: info: Ignoring MPD Status Update Mar 16 21:06:36 volumio volumio[15234]: info: ------------------------------ 15ms Mar 16 21:06:36 volumio volumio[15234]: info: sendMpdCommand play took 11 milliseconds Mar 16 21:06:36 volumio volumio[15234]: info: ------------------------------ 10ms Mar 16 21:06:36 volumio volumio[15234]: info: ------------------------------ 8ms Mar 16 21:06:40 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:40 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:06:40 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:06:40 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:40 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:40 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:06:40 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:40 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:40 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:06:40 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:06:40 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:40 volumio volumio[15234]: info: Adding Item to queue: http://stream.live.vc.bbcmedia.co.uk/bbc_world_service Mar 16 21:06:40 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:06:40 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:40 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:40 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:06:40 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:06:40 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:06:40 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:06:40 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:40 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:40 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:40 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:06:40 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:40 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:40 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:06:40 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:40 volumio volumio[15234]: info: [1742130400318] ControllerWebradio::clearAddPlayTrack Mar 16 21:06:40 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:06:42 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:42 volumio volumio[15234]: info: CoreCommandRouter::volumioReplaceandPlayItems Mar 16 21:06:42 volumio volumio[15234]: info: CoreStateMachine::ClearQueue Mar 16 21:06:42 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:42 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:42 volumio volumio[15234]: info: CorePlayQueue::clearPlayQueue Mar 16 21:06:42 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:42 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:42 volumio volumio[15234]: info: CoreStateMachine::addQueueItems Mar 16 21:06:42 volumio volumio[15234]: info: CorePlayQueue::addQueueItems Mar 16 21:06:42 volumio volumio[15234]: info: Preload queue cleared Mar 16 21:06:42 volumio volumio[15234]: info: Adding Item to queue: https://vs-hls-push-ww-live.akamaized.net/x=4/i=urn:bbc:pips:service:bbc_news_channel_hd/t=3840/v=pv14/b=5070016/main.m3u8 Mar 16 21:06:42 volumio volumio[15234]: info: CoreCommandRouter::executeOnPlugin: webradio , explodeUri Mar 16 21:06:42 volumio volumio[15234]: info: CoreCommandRouter::volumioPushQueue Mar 16 21:06:42 volumio volumio[15234]: info: CorePlayQueue::saveQueue Mar 16 21:06:42 volumio volumio[15234]: info: CoreStateMachine::updateTrackBlock Mar 16 21:06:42 volumio volumio[15234]: info: CorePlayQueue::getTrackBlock Mar 16 21:06:42 volumio volumio[15234]: info: CoreCommandRouter::volumioPlay Mar 16 21:06:42 volumio volumio[15234]: info: CoreStateMachine::play index 0 Mar 16 21:06:42 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:42 volumio volumio[15234]: info: CoreStateMachine::stop Mar 16 21:06:42 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:42 volumio volumio[15234]: info: CoreStateMachine::play index undefined Mar 16 21:06:42 volumio volumio[15234]: info: CoreStateMachine::setConsumeUpdateService undefined Mar 16 21:06:42 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:42 volumio volumio[15234]: info: CoreStateMachine::startPlaybackTimer Mar 16 21:06:42 volumio volumio[15234]: info: CorePlayQueue::getTrack 0 Mar 16 21:06:42 volumio volumio[15234]: info: [1742130402290] ControllerWebradio::clearAddPlayTrack Mar 16 21:06:42 volumio volumio[15234]: verbose: ControllerMpd::sendMpdCommand stop Mar 16 21:06:44 volumio volumio[15234]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Mar 16 21:06:44 volumio volumio[15234]: Error: connect ETIMEDOUT 192.133.77.189:80 Mar 16 21:06:44 volumio volumio[15234]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1159:16) { Mar 16 21:06:44 volumio volumio[15234]: errno: -110, Mar 16 21:06:44 volumio volumio[15234]: code: 'ETIMEDOUT', Mar 16 21:06:44 volumio volumio[15234]: syscall: 'connect', Mar 16 21:06:44 volumio volumio[15234]: address: '192.133.77.189', Mar 16 21:06:44 volumio volumio[15234]: port: 80 Mar 16 21:06:44 volumio volumio[15234]: } Mar 16 21:06:44 volumio volumio[15234]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Mar 16 21:06:44 volumio sudo[15921]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-03-16 21:05 Mar 16 21:06:44 volumio sudo[15921]: 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="bba9e3185e150dd0995f9a49355b34fc6218d5a2" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="8aa57e3ae5b742ea1069404608336a9884ccfb4e" VOLUMIO_ARCH="armv7" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 17 Sep 2024 05:19:36 PM CEST" VOLUMIO_VERSION="3.757" VOLUMIO_HARDWARE="tinkerboard" VOLUMIO_DEVICENAME="Asus Tinkerboard" VOLUMIO_HASH="43b87fbef9c19ede18711bdf23c439c5"