-- Logs begin at Sat 2025-06-21 17:50:57 CST, end at Sat 2025-06-21 18:10:58 CST. -- Jun 21 18:09:13 volumio volumio[900]: info: CALLMETHOD: audio_interface fusiondsp choosedsp [object Object] Jun 21 18:09:13 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: fusiondsp , choosedsp Jun 21 18:09:13 volumio volumio[900]: info: FusionDsp - If filter freq >samplerate/2 then disable it Jun 21 18:09:13 volumio volumio[900]: error: FusionDsp - WebSocket error: [object Object] Jun 21 18:09:13 volumio volumio[900]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 21 18:09:13 volumio volumio[900]: info: CoreCommandRouter::Close All Modals sent Jun 21 18:09:13 volumio volumio[900]: info: FusionDsp - Jun 21 18:09:14 volumio volumio[900]: info: FusionDsp - undefined Jun 21 18:09:14 volumio volumio[900]: info: CALLMETHOD: audio_interface fusiondsp choosedsp [object Object] Jun 21 18:09:14 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: fusiondsp , choosedsp Jun 21 18:09:15 volumio volumio[900]: info: FusionDsp - If filter freq >samplerate/2 then disable it Jun 21 18:09:15 volumio volumio[900]: error: FusionDsp - WebSocket error: [object Object] Jun 21 18:09:15 volumio volumio[900]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 21 18:09:15 volumio volumio[900]: info: CoreCommandRouter::Close All Modals sent Jun 21 18:09:15 volumio volumio[900]: info: FusionDsp - Jun 21 18:09:15 volumio volumio[900]: info: FusionDsp - undefined Jun 21 18:09:27 volumio volumio[900]: info: CALLMETHOD: audio_interface fusiondsp saveparameq [object Object] Jun 21 18:09:27 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: fusiondsp , saveparameq Jun 21 18:09:28 volumio volumio[900]: info: FusionDsp - If filter freq >samplerate/2 then disable it Jun 21 18:09:28 volumio volumio[900]: error: FusionDsp - WebSocket error: [object Object] Jun 21 18:09:28 volumio volumio[900]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 21 18:09:28 volumio volumio[900]: info: CoreCommandRouter::Close All Modals sent Jun 21 18:09:28 volumio volumio[900]: info: FusionDsp - no preset used Jun 21 18:09:28 volumio volumio[900]: info: FusionDsp - undefined Jun 21 18:09:30 volumio ntpd[1622]: 118.163.74.161 local addr 10.0.2.15 -> Jun 21 18:09:31 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Jun 21 18:09:31 volumio volumio[900]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 21 18:09:31 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken Jun 21 18:09:31 volumio volumio[900]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 21 18:09:31 volumio volumio[900]: info: FusionDsp - no preset used Jun 21 18:09:31 volumio volumio[900]: info: FusionDsp - undefined Jun 21 18:09:31 volumio volumio[900]: info: FusionDsp - no preset used Jun 21 18:09:31 volumio volumio[900]: info: FusionDsp - undefined Jun 21 18:09:48 volumio volumio[900]: info: CoreCommandRouter::volumioGetState Jun 21 18:09:48 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:09:50 volumio volumio[900]: info: CoreCommandRouter::volumioPlay Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::play index undefined Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::setConsumeUpdateService undefined Jun 21 18:09:50 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::startPlaybackTimer Jun 21 18:09:50 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::clearAddPlayTracks USB/E491-C8EC/MP3/As I Moved On (NFXxls5XfOU).mp4 Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand stop Jun 21 18:09:50 volumio volumio[900]: info: sendMpdCommand stop took 0 milliseconds Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand clear Jun 21 18:09:50 volumio volumio[900]: info: Jun 21 18:09:50 volumio volumio[900]: ---------------------------- MPD announces system playlist update Jun 21 18:09:50 volumio volumio[900]: info: Ignoring MPD Status Update Jun 21 18:09:50 volumio volumio[900]: info: sendMpdCommand clear took 0 milliseconds Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand add "USB/E491-C8EC/MP3/As I Moved On (NFXxls5XfOU).mp4" Jun 21 18:09:50 volumio volumio[900]: error: updateQueue error: null Jun 21 18:09:50 volumio volumio[900]: info: Jun 21 18:09:50 volumio volumio[900]: ---------------------------- MPD announces system playlist update Jun 21 18:09:50 volumio volumio[900]: info: Ignoring MPD Status Update Jun 21 18:09:50 volumio volumio[900]: info: ------------------------------ 0ms Jun 21 18:09:50 volumio volumio[900]: info: sendMpdCommand add "USB/E491-C8EC/MP3/As I Moved On (NFXxls5XfOU).mp4" took 1 milliseconds Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand play Jun 21 18:09:50 volumio volumio[900]: info: Jun 21 18:09:50 volumio volumio[900]: ---------------------------- MPD announces system playlist update Jun 21 18:09:50 volumio volumio[900]: info: Ignoring MPD Status Update Jun 21 18:09:50 volumio volumio[900]: info: ------------------------------ 1ms Jun 21 18:09:50 volumio volumio[900]: info: sendMpdCommand play took 0 milliseconds Jun 21 18:09:50 volumio volumio[900]: info: ------------------------------ 0ms Jun 21 18:09:50 volumio volumio[900]: info: Jun 21 18:09:50 volumio volumio[900]: ---------------------------- MPD announces system playlist update Jun 21 18:09:50 volumio volumio[900]: info: Ignoring MPD Status Update Jun 21 18:09:50 volumio volumio[900]: info: ------------------------------ 0ms Jun 21 18:09:50 volumio volumio[900]: info: Jun 21 18:09:50 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:09:50 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:09:50 volumio volumio[900]: info: Jun 21 18:09:50 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:09:50 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:09:50 volumio volumio[900]: info: FusionDsp - ---- read samplerate, raw: 44100,S32_LE,2,32 Jun 21 18:09:50 volumio volumio[900]: info: FusionDsp - ---- read samplerate from file: 44100 Jun 21 18:09:50 volumio volumio[900]: error: FusionDsp - TypeError: Cannot read property 'stop' of null Jun 21 18:09:50 volumio volumio[900]: info: Jun 21 18:09:50 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:09:50 volumio volumio[900]: info: sendMpdCommand status took 7 milliseconds Jun 21 18:09:50 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:09:50 volumio volumio[900]: info: sendMpdCommand status took 7 milliseconds Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:09:50 volumio volumio[900]: info: Jun 21 18:09:50 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:09:50 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:09:50 volumio volumio[900]: info: sendMpdCommand status took 1 milliseconds Jun 21 18:09:50 volumio volumio[900]: info: sendMpdCommand playlistinfo took 1 milliseconds Jun 21 18:09:50 volumio volumio[900]: info: sendMpdCommand playlistinfo took 1 milliseconds Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:09:50 volumio volumio[900]: info: ControllerMpd::pushState Jun 21 18:09:50 volumio volumio[900]: info: CoreCommandRouter::servicePushState Jun 21 18:09:50 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:09:50 volumio volumio[900]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":220,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"As I Moved On (NFXxls5XfOU).mp4","artist":null,"album":null,"uri":"USB/E491-C8EC/MP3/As I Moved On (NFXxls5XfOU).mp4","trackType":"mp4"} Jun 21 18:09:50 volumio volumio[900]: verbose: CURRENT POSITION 4 Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::syncState stateService play Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::syncState currentStatus stop Jun 21 18:09:50 volumio volumio[900]: info: ControllerMpd::pushState Jun 21 18:09:50 volumio volumio[900]: info: CoreCommandRouter::servicePushState Jun 21 18:09:50 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:09:50 volumio volumio[900]: verbose: STATE SERVICE {"status":"play","position":0,"seek":478,"duration":220,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"As I Moved On (NFXxls5XfOU).mp4","artist":null,"album":null,"uri":"USB/E491-C8EC/MP3/As I Moved On (NFXxls5XfOU).mp4","trackType":"mp4"} Jun 21 18:09:50 volumio volumio[900]: verbose: CURRENT POSITION 4 Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::syncState stateService play Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::syncState currentStatus play Jun 21 18:09:50 volumio volumio[900]: info: Received an update from plugin. extracting info from payload Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:09:50 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:09:50 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:09:50 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:09:50 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:09:50 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:09:50 volumio volumio[900]: info: ------------------------------ 11ms Jun 21 18:09:50 volumio volumio[900]: info: ------------------------------ 12ms Jun 21 18:09:50 volumio volumio[900]: info: sendMpdCommand status took 5 milliseconds Jun 21 18:09:50 volumio volumio[900]: info: sendMpdCommand playlistinfo took 4 milliseconds Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:09:50 volumio volumio[900]: info: ControllerMpd::pushState Jun 21 18:09:50 volumio volumio[900]: info: CoreCommandRouter::servicePushState Jun 21 18:09:50 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:09:50 volumio volumio[900]: verbose: STATE SERVICE {"status":"play","position":0,"seek":978,"duration":220,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"As I Moved On (NFXxls5XfOU).mp4","artist":null,"album":null,"uri":"USB/E491-C8EC/MP3/As I Moved On (NFXxls5XfOU).mp4","trackType":"mp4"} Jun 21 18:09:50 volumio volumio[900]: verbose: CURRENT POSITION 4 Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::syncState stateService play Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::syncState currentStatus play Jun 21 18:09:50 volumio volumio[900]: info: Received an update from plugin. extracting info from payload Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:09:50 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:09:50 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:09:50 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:09:50 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:09:50 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:09:50 volumio volumio[900]: info: ------------------------------ 9ms Jun 21 18:09:50 volumio volumio[900]: info: sendMpdCommand playlistinfo took 4 milliseconds Jun 21 18:09:50 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:09:50 volumio volumio[900]: info: ControllerMpd::pushState Jun 21 18:09:50 volumio volumio[900]: info: CoreCommandRouter::servicePushState Jun 21 18:09:50 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:09:50 volumio volumio[900]: verbose: STATE SERVICE {"status":"play","position":0,"seek":978,"duration":220,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"128 Kbps","isStreaming":false,"title":"As I Moved On (NFXxls5XfOU).mp4","artist":null,"album":null,"uri":"USB/E491-C8EC/MP3/As I Moved On (NFXxls5XfOU).mp4","trackType":"mp4"} Jun 21 18:09:50 volumio volumio[900]: verbose: CURRENT POSITION 4 Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::syncState stateService play Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::syncState currentStatus play Jun 21 18:09:50 volumio volumio[900]: info: Received an update from plugin. extracting info from payload Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:09:50 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:09:50 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:09:50 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:09:50 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:09:50 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:09:50 volumio volumio[900]: info: ------------------------------ 13ms Jun 21 18:10:07 volumio volumio[900]: info: VolumeController::SetAlsaVolume+ Jun 21 18:10:07 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:07 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:10:07 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:07 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:08 volumio volumio[900]: info: VolumeController::SetAlsaVolume+ Jun 21 18:10:08 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:08 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:10:08 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:08 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:08 volumio volumio[900]: info: VolumeController::SetAlsaVolume+ Jun 21 18:10:08 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:08 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:10:08 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:08 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:09 volumio volumio[900]: info: VolumeController::SetAlsaVolume+ Jun 21 18:10:09 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:09 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:10:09 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:09 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:10 volumio volumio[900]: info: VolumeController::SetAlsaVolume+ Jun 21 18:10:10 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:10 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:10:10 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:10 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:10 volumio volumio[900]: info: VolumeController::SetAlsaVolume+ Jun 21 18:10:10 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:10 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:10:10 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:10 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:11 volumio volumio[900]: info: VolumeController::SetAlsaVolume+ Jun 21 18:10:11 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:11 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:10:11 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:11 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:11 volumio volumio[900]: info: VolumeController::SetAlsaVolume+ Jun 21 18:10:11 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:11 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:10:11 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:11 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:12 volumio volumio[900]: info: VolumeController::SetAlsaVolume+ Jun 21 18:10:12 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:12 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:10:12 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:12 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:12 volumio volumio[900]: info: VolumeController::SetAlsaVolume+ Jun 21 18:10:12 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:12 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:10:12 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:12 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:21 volumio ntpd[1622]: 103.186.118.219 local addr 10.0.2.15 -> Jun 21 18:10:25 volumio ntpd[1622]: 103.186.118.217 local addr 10.0.2.15 -> Jun 21 18:10:28 volumio ntpd[1622]: 103.186.118.211 local addr 10.0.2.15 -> Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPlay Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::play index 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::setConsumeUpdateService undefined Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::stop Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::setConsumeUpdateService undefined Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::stPlaybackTimer Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::updateTrackBlock Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrackBlock Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::serviceStop Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 4 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::serviceStop Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::stop Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand stop Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand stop took 2 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::play index undefined Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::setConsumeUpdateService undefined Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::startPlaybackTimer Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::clearAddPlayTracks USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4 Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand stop Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand status took 1 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand stop took 1 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand status took 0 milliseconds Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand clear Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces system playlist update Jun 21 18:10:40 volumio volumio[900]: info: Ignoring MPD Status Update Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand playlistinfo took 2 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand clear took 2 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand playlistinfo took 2 milliseconds Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand add "USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4" Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::pushState Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::servicePushState Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: 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":"As I Moved On (NFXxls5XfOU).mp4","artist":null,"album":null,"uri":"USB/E491-C8EC/MP3/As I Moved On (NFXxls5XfOU).mp4","trackType":"mp4"} Jun 21 18:10:40 volumio volumio[900]: verbose: CURRENT POSITION 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState stateService stop Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState currentStatus stop Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: No code Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 9ms Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 8ms Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces system playlist update Jun 21 18:10:40 volumio volumio[900]: info: Ignoring MPD Status Update Jun 21 18:10:40 volumio volumio[900]: error: updateQueue error: null Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces system playlist update Jun 21 18:10:40 volumio volumio[900]: info: Ignoring MPD Status Update Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 6ms Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand add "USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4" took 5 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 1ms Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand play Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces system playlist update Jun 21 18:10:40 volumio volumio[900]: info: Ignoring MPD Status Update Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 1ms Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand play took 0 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 0ms Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:10:40 volumio volumio[900]: info: FusionDsp - ---- read samplerate, raw: 44100,S32_LE,2,32 Jun 21 18:10:40 volumio volumio[900]: info: FusionDsp - ---- read samplerate from file: 44100 Jun 21 18:10:40 volumio volumio[900]: info: FusionDsp - If filter freq >samplerate/2 then disable it Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand status took 7 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand status took 7 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand status took 1 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand playlistinfo took 1 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand playlistinfo took 1 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand status took 0 milliseconds Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::pushState Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::servicePushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":289,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"127 Kbps","isStreaming":false,"title":"Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","artist":null,"album":null,"uri":"USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","trackType":"mp4"} Jun 21 18:10:40 volumio volumio[900]: verbose: CURRENT POSITION 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState stateService play Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState currentStatus stop Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::pushState Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::servicePushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: verbose: STATE SERVICE {"status":"play","position":0,"seek":193,"duration":289,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"127 Kbps","isStreaming":false,"title":"Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","artist":null,"album":null,"uri":"USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","trackType":"mp4"} Jun 21 18:10:40 volumio volumio[900]: verbose: CURRENT POSITION 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState stateService play Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState currentStatus play Jun 21 18:10:40 volumio volumio[900]: info: Received an update from plugin. extracting info from payload Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 12ms Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 12ms Jun 21 18:10:40 volumio volumio[900]: error: FusionDsp - WebSocket error: [object Object] Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand playlistinfo took 3 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand playlistinfo took 4 milliseconds Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::pushState Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::servicePushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: verbose: STATE SERVICE {"status":"play","position":0,"seek":979,"duration":289,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"127 Kbps","isStreaming":false,"title":"Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","artist":null,"album":null,"uri":"USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","trackType":"mp4"} Jun 21 18:10:40 volumio volumio[900]: verbose: CURRENT POSITION 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState stateService play Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState currentStatus play Jun 21 18:10:40 volumio volumio[900]: info: Received an update from plugin. extracting info from payload Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::pushState Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::servicePushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: verbose: STATE SERVICE {"status":"play","position":0,"seek":979,"duration":289,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"127 Kbps","isStreaming":false,"title":"Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","artist":null,"album":null,"uri":"USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","trackType":"mp4"} Jun 21 18:10:40 volumio volumio[900]: verbose: CURRENT POSITION 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState stateService play Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState currentStatus play Jun 21 18:10:40 volumio volumio[900]: info: Received an update from plugin. extracting info from payload Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 11ms Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 10ms Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPlay Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::play index 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::setConsumeUpdateService undefined Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::stop Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::setConsumeUpdateService undefined Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::stPlaybackTimer Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::updateTrackBlock Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrackBlock Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::serviceStop Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::serviceStop Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::stop Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand stop Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand stop took 2 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::play index undefined Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::setConsumeUpdateService undefined Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::startPlaybackTimer Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::clearAddPlayTracks USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4 Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand stop Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand status took 2 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand stop took 2 milliseconds Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand clear Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand status took 2 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand playlistinfo took 0 milliseconds Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::pushState Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::servicePushState Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: 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":"Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","artist":null,"album":null,"uri":"USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","trackType":"mp4"} Jun 21 18:10:40 volumio volumio[900]: verbose: CURRENT POSITION 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState stateService stop Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState currentStatus stop Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: No code Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 5ms Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces system playlist update Jun 21 18:10:40 volumio volumio[900]: info: Ignoring MPD Status Update Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand clear took 3 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand playlistinfo took 4 milliseconds Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand add "USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4" Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:10:40 volumio volumio[900]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 6ms Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces system playlist update Jun 21 18:10:40 volumio volumio[900]: info: Ignoring MPD Status Update Jun 21 18:10:40 volumio volumio[900]: error: updateQueue error: null Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces system playlist update Jun 21 18:10:40 volumio volumio[900]: info: Ignoring MPD Status Update Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 2ms Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand add "USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4" took 1 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 1ms Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand play Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces system playlist update Jun 21 18:10:40 volumio volumio[900]: info: Ignoring MPD Status Update Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 1ms Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand play took 1 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 1ms Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:10:40 volumio volumio[900]: info: FusionDsp - ---- read samplerate, raw: 44100,S32_LE,2,32 Jun 21 18:10:40 volumio volumio[900]: info: FusionDsp - ---- read samplerate from file: 44100 Jun 21 18:10:40 volumio volumio[900]: info: FusionDsp - If filter freq >samplerate/2 then disable it Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand status took 5 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand status took 5 milliseconds Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:10:40 volumio volumio[900]: info: Jun 21 18:10:40 volumio volumio[900]: ---------------------------- MPD announces state update: player Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::getState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand status Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand status took 1 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand playlistinfo took 1 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand playlistinfo took 1 milliseconds Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::pushState Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::servicePushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":289,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"127 Kbps","isStreaming":false,"title":"Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","artist":null,"album":null,"uri":"USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","trackType":"mp4"} Jun 21 18:10:40 volumio volumio[900]: verbose: CURRENT POSITION 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState stateService play Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState currentStatus stop Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::pushState Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::servicePushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: verbose: STATE SERVICE {"status":"play","position":0,"seek":295,"duration":289,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"127 Kbps","isStreaming":false,"title":"Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","artist":null,"album":null,"uri":"USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","trackType":"mp4"} Jun 21 18:10:40 volumio volumio[900]: verbose: CURRENT POSITION 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState stateService play Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState currentStatus play Jun 21 18:10:40 volumio volumio[900]: info: Received an update from plugin. extracting info from payload Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 9ms Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 9ms Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand status took 4 milliseconds Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand playlistinfo took 4 milliseconds Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseState Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::pushState Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::servicePushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: verbose: STATE SERVICE {"status":"play","position":0,"seek":979,"duration":289,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"127 Kbps","isStreaming":false,"title":"Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","artist":null,"album":null,"uri":"USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","trackType":"mp4"} Jun 21 18:10:40 volumio volumio[900]: verbose: CURRENT POSITION 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState stateService play Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState currentStatus play Jun 21 18:10:40 volumio volumio[900]: info: Received an update from plugin. extracting info from payload Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 10ms Jun 21 18:10:40 volumio volumio[900]: error: FusionDsp - WebSocket error: [object Object] Jun 21 18:10:40 volumio volumio[900]: info: sendMpdCommand playlistinfo took 6 milliseconds Jun 21 18:10:40 volumio volumio[900]: verbose: ControllerMpd::parseTrackInfo Jun 21 18:10:40 volumio volumio[900]: info: ControllerMpd::pushState Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::servicePushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: verbose: STATE SERVICE {"status":"play","position":0,"seek":979,"duration":289,"samplerate":44.1,"bitdepth":"32 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"127 Kbps","isStreaming":false,"title":"Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","artist":null,"album":null,"uri":"USB/E491-C8EC/MP3/Bingo Players - Rattle (Original Mix) (XYgSHOWNE0M).mp4","trackType":"mp4"} Jun 21 18:10:40 volumio volumio[900]: verbose: CURRENT POSITION 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState stateService play Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::syncState currentStatus play Jun 21 18:10:40 volumio volumio[900]: info: Received an update from plugin. extracting info from payload Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: CoreStateMachine::pushState Jun 21 18:10:40 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:40 volumio volumio[900]: info: CoreCommandRouter::volumioPushState Jun 21 18:10:40 volumio volumio[900]: info: ------------------------------ 13ms Jun 21 18:10:44 volumio ntpd[1622]: 103.186.118.220 local addr 10.0.2.15 -> Jun 21 18:10:46 volumio volumio[900]: info: CoreCommandRouter::volumioGetState Jun 21 18:10:46 volumio volumio[900]: info: CorePlayQueue::getTrack 5 Jun 21 18:10:46 volumio ntpd[1622]: 103.186.118.222 local addr 10.0.2.15 -> Jun 21 18:10:49 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Jun 21 18:10:49 volumio volumio[900]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken Jun 21 18:10:49 volumio volumio[900]: info: CoreCommandRouter::getUIConfigOnPlugin Jun 21 18:10:49 volumio volumio[900]: info: FusionDsp - no preset used Jun 21 18:10:49 volumio volumio[900]: info: FusionDsp - undefined Jun 21 18:10:58 volumio volumio[900]: info: Starting Uninstall of plugin audio_interface - fusiondsp Jun 21 18:10:58 volumio volumio[900]: info: Uninstalling plugin fusiondsp Jun 21 18:10:58 volumio volumio[900]: info: FusionDsp - Stopping FusionDsp service Jun 21 18:10:58 volumio volumio[900]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jun 21 18:10:58 volumio volumio[900]: TypeError: Cannot read property 'stop' of null Jun 21 18:10:58 volumio volumio[900]: at FusionDsp.onStop (/data/plugins/audio_interface/fusiondsp/index.js:109:23) Jun 21 18:10:58 volumio volumio[900]: at PluginManager.stopPlugin (/volumio/app/pluginmanager.js:460:30) Jun 21 18:10:58 volumio volumio[900]: at PluginManager.unInstallPlugin (/volumio/app/pluginmanager.js:1449:10) Jun 21 18:10:58 volumio volumio[900]: at CoreCommandRouter.unInstallPlugin (/volumio/app/index.js:1484:22) Jun 21 18:10:58 volumio volumio[900]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:1260:45) Jun 21 18:10:58 volumio volumio[900]: at Socket.emit (events.js:400:28) Jun 21 18:10:58 volumio volumio[900]: at /volumio/node_modules/socket.io/lib/socket.js:528:12 Jun 21 18:10:58 volumio volumio[900]: at processTicksAndRejections (internal/process/task_queues.js:77:11) Jun 21 18:10:58 volumio volumio[900]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jun 21 18:10:58 volumio sudo[7344]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-06-21 18:09 Jun 21 18:10:58 volumio sudo[7344]: 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="a142ed2648fb91920de0dde3a60cd39b5d0ba4f6" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="04c18c158cc4bac70764c3360b25fcce0c69266a" VOLUMIO_ARCH="x64" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 10 Jun 2025 05:26:48 PM CEST" VOLUMIO_VERSION="3.816" VOLUMIO_HARDWARE="x86_amd64" VOLUMIO_DEVICENAME="x86_64" VOLUMIO_HASH="a63f40325536655a08b14de2b295ce76"