-- Logs begin at Thu 2019-02-14 11:11:59 CET, end at Sat 2024-08-31 19:52:50 CEST. -- Aug 31 19:51:45 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 23 Aug 31 19:51:45 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:45 volumioandrea volumio[875]: info: Prefetching next song Aug 31 19:51:45 volumioandrea volumio[875]: info: DOING PREFETCH IN MPD Aug 31 19:51:45 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand add "USB/VolumioAndrea/Various Artists - Hi-Res Masters Soul Hits [24Bit-FLAC] [PMEDIA] ⭐️/50. Roberta Flack - Killing Me Softly With His Song.flac" Aug 31 19:51:45 volumioandrea volumio[875]: info: sendMpdCommand add "USB/VolumioAndrea/Various Artists - Hi-Res Masters Soul Hits [24Bit-FLAC] [PMEDIA] ⭐️/50. Roberta Flack - Killing Me Softly With His Song.flac" took 6 milliseconds Aug 31 19:51:45 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand consume 1 Aug 31 19:51:45 volumioandrea volumio[875]: info: Aug 31 19:51:45 volumioandrea volumio[875]: ---------------------------- MPD announces system playlist update Aug 31 19:51:45 volumioandrea volumio[875]: info: Ignoring MPD Status Update Aug 31 19:51:45 volumioandrea volumio[875]: info: sendMpdCommand consume 1 took 6 milliseconds Aug 31 19:51:45 volumioandrea volumio[875]: info: Aug 31 19:51:45 volumioandrea volumio[875]: ---------------------------- MPD announces system playlist update Aug 31 19:51:45 volumioandrea volumio[875]: info: Ignoring MPD Status Update Aug 31 19:51:45 volumioandrea volumio[875]: info: Aug 31 19:51:45 volumioandrea volumio[875]: ---------------------------- MPD announces system playlist update Aug 31 19:51:45 volumioandrea volumio[875]: info: Ignoring MPD Status Update Aug 31 19:51:45 volumioandrea volumio[875]: info: Aug 31 19:51:45 volumioandrea volumio[875]: ---------------------------- MPD announces system playlist update Aug 31 19:51:45 volumioandrea volumio[875]: info: Ignoring MPD Status Update Aug 31 19:51:45 volumioandrea volumio[875]: info: ------------------------------ 15ms Aug 31 19:51:45 volumioandrea volumio[875]: info: ------------------------------ 10ms Aug 31 19:51:45 volumioandrea volumio[875]: info: ------------------------------ 8ms Aug 31 19:51:45 volumioandrea volumio[875]: info: ------------------------------ 7ms Aug 31 19:51:49 volumioandrea volumio[875]: info: Aug 31 19:51:49 volumioandrea volumio[875]: ---------------------------- MPD announces system playlist update Aug 31 19:51:49 volumioandrea volumio[875]: info: Ignoring MPD Status Update Aug 31 19:51:49 volumioandrea volumio[875]: info: Aug 31 19:51:49 volumioandrea volumio[875]: ---------------------------- MPD announces state update: player Aug 31 19:51:49 volumioandrea volumio[875]: info: ControllerMpd::getState Aug 31 19:51:49 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand status Aug 31 19:51:49 volumioandrea volumio[875]: info: Aug 31 19:51:49 volumioandrea volumio[875]: ---------------------------- MPD announces system playlist update Aug 31 19:51:49 volumioandrea volumio[875]: info: Ignoring MPD Status Update Aug 31 19:51:49 volumioandrea volumio[875]: info: Aug 31 19:51:49 volumioandrea volumio[875]: ---------------------------- MPD announces state update: player Aug 31 19:51:49 volumioandrea volumio[875]: info: ControllerMpd::getState Aug 31 19:51:49 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand status Aug 31 19:51:49 volumioandrea volumio[875]: info: Aug 31 19:51:49 volumioandrea volumio[875]: ---------------------------- MPD announces system playlist update Aug 31 19:51:49 volumioandrea volumio[875]: info: Ignoring MPD Status Update Aug 31 19:51:49 volumioandrea volumio[875]: info: Aug 31 19:51:49 volumioandrea volumio[875]: ---------------------------- MPD announces state update: player Aug 31 19:51:49 volumioandrea volumio[875]: info: ControllerMpd::getState Aug 31 19:51:49 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand status Aug 31 19:51:49 volumioandrea volumio[875]: info: Aug 31 19:51:49 volumioandrea volumio[875]: ---------------------------- MPD announces system playlist update Aug 31 19:51:49 volumioandrea volumio[875]: info: Ignoring MPD Status Update Aug 31 19:51:49 volumioandrea volumio[875]: info: Aug 31 19:51:49 volumioandrea volumio[875]: ---------------------------- MPD announces state update: player Aug 31 19:51:49 volumioandrea volumio[875]: info: ControllerMpd::getState Aug 31 19:51:49 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand status Aug 31 19:51:49 volumioandrea volumio[875]: info: ------------------------------ 12ms Aug 31 19:51:49 volumioandrea volumio[875]: info: CoreStateMachine::startPlaybackTimer Aug 31 19:51:49 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - ---- read samplerate, raw: 192000,S32_LE,2,32 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - ---- read samplerate from file: 192000 Aug 31 19:51:50 volumioandrea volumio[875]: info: camilladsp stopping service pid 3204... Aug 31 19:51:50 volumioandrea volumio[875]: info: camilladsp service terminated, instance 1 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: camilladsp service started and running in background, instance 1 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - ---- read samplerate, raw: 192000,S32_LE,2,32 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - ---- read samplerate from file: 192000 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: Aug 31 19:51:50 volumioandrea volumio[875]: ---------------------------- MPD announces state update: player Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand status took 1297 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: info: ControllerMpd::getState Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand status Aug 31 19:51:50 volumioandrea volumio[875]: info: ------------------------------ 1297ms Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand status took 1295 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: info: ------------------------------ 1295ms Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand status took 1294 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: info: ------------------------------ 1293ms Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand status took 1291 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseState Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand playlistinfo Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseState Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand playlistinfo Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseState Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand playlistinfo Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseState Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand playlistinfo Aug 31 19:51:50 volumioandrea volumio[875]: info: Aug 31 19:51:50 volumioandrea volumio[875]: ---------------------------- MPD announces state update: player Aug 31 19:51:50 volumioandrea volumio[875]: info: ControllerMpd::getState Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand status Aug 31 19:51:50 volumioandrea volumio[875]: info: Aug 31 19:51:50 volumioandrea volumio[875]: ---------------------------- MPD announces state update: player Aug 31 19:51:50 volumioandrea volumio[875]: info: ControllerMpd::getState Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand status Aug 31 19:51:50 volumioandrea volumio[875]: info: Aug 31 19:51:50 volumioandrea volumio[875]: ---------------------------- MPD announces state update: player Aug 31 19:51:50 volumioandrea volumio[875]: info: ControllerMpd::getState Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand status Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand status took 37 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand playlistinfo took 34 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand playlistinfo took 33 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand playlistinfo took 33 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand playlistinfo took 32 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand status took 26 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand status took 23 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand status took 21 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseState Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand playlistinfo Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseTrackInfo Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseTrackInfo Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseTrackInfo Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseTrackInfo Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseState Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand playlistinfo Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseState Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand playlistinfo Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseState Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::sendMpdCommand playlistinfo Aug 31 19:51:50 volumioandrea volumio[875]: info: ControllerMpd::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::servicePushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":290,"samplerate":"192 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Killing Me Softly With His Song","artist":"Roberta Flack","album":"Killing Me Softly","uri":"USB/VolumioAndrea/Various Artists - Hi-Res Masters Soul Hits [24Bit-FLAC] [PMEDIA] ⭐️/50. Roberta Flack - Killing Me Softly With His Song.flac","trackType":"flac"} Aug 31 19:51:50 volumioandrea volumio[875]: verbose: CURRENT POSITION 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState stateService play Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState currentStatus play Aug 31 19:51:50 volumioandrea volumio[875]: info: Received an update from plugin. extracting info from payload Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: ControllerMpd::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::servicePushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: verbose: STATE SERVICE {"status":"play","position":0,"seek":13,"duration":290,"samplerate":"192 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Killing Me Softly With His Song","artist":"Roberta Flack","album":"Killing Me Softly","uri":"USB/VolumioAndrea/Various Artists - Hi-Res Masters Soul Hits [24Bit-FLAC] [PMEDIA] ⭐️/50. Roberta Flack - Killing Me Softly With His Song.flac","trackType":"flac"} Aug 31 19:51:50 volumioandrea volumio[875]: verbose: CURRENT POSITION 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState stateService play Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState currentStatus play Aug 31 19:51:50 volumioandrea volumio[875]: info: Received an update from plugin. extracting info from payload Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: ControllerMpd::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::servicePushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: verbose: STATE SERVICE {"status":"play","position":0,"seek":20,"duration":290,"samplerate":"192 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"Killing Me Softly With His Song","artist":"Roberta Flack","album":"Killing Me Softly","uri":"USB/VolumioAndrea/Various Artists - Hi-Res Masters Soul Hits [24Bit-FLAC] [PMEDIA] ⭐️/50. Roberta Flack - Killing Me Softly With His Song.flac","trackType":"flac"} Aug 31 19:51:50 volumioandrea volumio[875]: verbose: CURRENT POSITION 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState stateService play Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState currentStatus play Aug 31 19:51:50 volumioandrea volumio[875]: info: Received an update from plugin. extracting info from payload Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: ControllerMpd::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::servicePushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: verbose: STATE SERVICE {"status":"play","position":0,"seek":28,"duration":290,"samplerate":"192 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"5171 Kbps","isStreaming":false,"title":"Killing Me Softly With His Song","artist":"Roberta Flack","album":"Killing Me Softly","uri":"USB/VolumioAndrea/Various Artists - Hi-Res Masters Soul Hits [24Bit-FLAC] [PMEDIA] ⭐️/50. Roberta Flack - Killing Me Softly With His Song.flac","trackType":"flac"} Aug 31 19:51:50 volumioandrea volumio[875]: verbose: CURRENT POSITION 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState stateService play Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState currentStatus play Aug 31 19:51:50 volumioandrea volumio[875]: info: Received an update from plugin. extracting info from payload Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: ------------------------------ 1459ms Aug 31 19:51:50 volumioandrea volumio[875]: info: ------------------------------ 1456ms Aug 31 19:51:50 volumioandrea volumio[875]: info: ------------------------------ 1455ms Aug 31 19:51:50 volumioandrea volumio[875]: info: ------------------------------ 1453ms Aug 31 19:51:50 volumioandrea volumio[875]: error: FusionDsp - WebSocket error: [object Object] Aug 31 19:51:50 volumioandrea volumio[875]: info: camilladsp spawned new process with pid 3667, instance 1, run: true Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand playlistinfo took 184 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand playlistinfo took 182 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand playlistinfo took 181 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: info: sendMpdCommand playlistinfo took 182 milliseconds Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseTrackInfo Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseTrackInfo Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseTrackInfo Aug 31 19:51:50 volumioandrea volumio[875]: verbose: ControllerMpd::parseTrackInfo Aug 31 19:51:50 volumioandrea volumio[875]: info: ControllerMpd::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::servicePushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: verbose: STATE SERVICE {"status":"play","position":0,"seek":679,"duration":290,"samplerate":"192 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"5425 Kbps","isStreaming":false,"title":"Killing Me Softly With His Song","artist":"Roberta Flack","album":"Killing Me Softly","uri":"USB/VolumioAndrea/Various Artists - Hi-Res Masters Soul Hits [24Bit-FLAC] [PMEDIA] ⭐️/50. Roberta Flack - Killing Me Softly With His Song.flac","trackType":"flac"} Aug 31 19:51:50 volumioandrea volumio[875]: verbose: CURRENT POSITION 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState stateService play Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState currentStatus play Aug 31 19:51:50 volumioandrea volumio[875]: info: Received an update from plugin. extracting info from payload Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: ControllerMpd::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::servicePushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: verbose: STATE SERVICE {"status":"play","position":0,"seek":679,"duration":290,"samplerate":"192 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"5425 Kbps","isStreaming":false,"title":"Killing Me Softly With His Song","artist":"Roberta Flack","album":"Killing Me Softly","uri":"USB/VolumioAndrea/Various Artists - Hi-Res Masters Soul Hits [24Bit-FLAC] [PMEDIA] ⭐️/50. Roberta Flack - Killing Me Softly With His Song.flac","trackType":"flac"} Aug 31 19:51:50 volumioandrea volumio[875]: verbose: CURRENT POSITION 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState stateService play Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState currentStatus play Aug 31 19:51:50 volumioandrea volumio[875]: info: Received an update from plugin. extracting info from payload Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: ControllerMpd::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::servicePushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: verbose: STATE SERVICE {"status":"play","position":0,"seek":679,"duration":290,"samplerate":"192 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"5425 Kbps","isStreaming":false,"title":"Killing Me Softly With His Song","artist":"Roberta Flack","album":"Killing Me Softly","uri":"USB/VolumioAndrea/Various Artists - Hi-Res Masters Soul Hits [24Bit-FLAC] [PMEDIA] ⭐️/50. Roberta Flack - Killing Me Softly With His Song.flac","trackType":"flac"} Aug 31 19:51:50 volumioandrea volumio[875]: verbose: CURRENT POSITION 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState stateService play Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState currentStatus play Aug 31 19:51:50 volumioandrea volumio[875]: info: Received an update from plugin. extracting info from payload Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: ControllerMpd::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::servicePushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: verbose: STATE SERVICE {"status":"play","position":0,"seek":679,"duration":290,"samplerate":"192 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"5425 Kbps","isStreaming":false,"title":"Killing Me Softly With His Song","artist":"Roberta Flack","album":"Killing Me Softly","uri":"USB/VolumioAndrea/Various Artists - Hi-Res Masters Soul Hits [24Bit-FLAC] [PMEDIA] ⭐️/50. Roberta Flack - Killing Me Softly With His Song.flac","trackType":"flac"} Aug 31 19:51:50 volumioandrea volumio[875]: verbose: CURRENT POSITION 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState stateService play Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::syncState currentStatus play Aug 31 19:51:50 volumioandrea volumio[875]: info: Received an update from plugin. extracting info from payload Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreStateMachine::pushState Aug 31 19:51:50 volumioandrea volumio[875]: info: CorePlayQueue::getTrack 49 Aug 31 19:51:50 volumioandrea volumio[875]: info: CoreCommandRouter::volumioPushState Aug 31 19:51:50 volumioandrea volumio[875]: info: ------------------------------ 336ms Aug 31 19:51:50 volumioandrea volumio[875]: info: ------------------------------ 323ms Aug 31 19:51:50 volumioandrea volumio[875]: info: ------------------------------ 320ms Aug 31 19:51:50 volumioandrea volumio[875]: info: ------------------------------ 318ms Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - volume level for loudness 60 gain applied 0.00 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - If filter freq >samplerate/2 then disable it Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - Loudness is ON true Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: SPOTIFY: RECEIVED VOLUMIO VOLUME 60 Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:51:50 volumioandrea volumio[875]: info: FusionDsp - {"Reload":{"result":"Ok"}} Aug 31 19:52:29 volumioandrea volumio[875]: verbose: New Socket.io Connection to 192.168.178.161 from 192.168.178.162 UA: Mozilla/5.0 (SMART-TV; Linux; Tizen 5.0) AppleWebKit/537.36 (KHTML, like Gecko) SamsungBrowser/2.2 Chrome/63.0.3239.84 TV Safari/537.36 Engine version: 3 Transport: polling Total Clients: 6 Aug 31 19:52:42 volumioandrea volumio[875]: Searching plugin music_service/mpd Aug 31 19:52:42 volumioandrea volumio[875]: info: CoreCommandRouter::executeOnPlugin: mpd , search Aug 31 19:52:43 volumioandrea volumio[875]: info: All search sources collected, pushing search results Aug 31 19:52:43 volumioandrea volumio[875]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/The%20Fire/d81b9d1f-50d2-4941-8067-c29a7a371791.jpg' Aug 31 19:52:49 volumioandrea volumio[875]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Aug 31 19:52:49 volumioandrea volumio[875]: Error: connect ETIMEDOUT 146.75.62.79:80 Aug 31 19:52:49 volumioandrea volumio[875]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1146:16) { Aug 31 19:52:49 volumioandrea volumio[875]: errno: -110, Aug 31 19:52:49 volumioandrea volumio[875]: code: 'ETIMEDOUT', Aug 31 19:52:49 volumioandrea volumio[875]: syscall: 'connect', Aug 31 19:52:49 volumioandrea volumio[875]: address: '146.75.62.79', Aug 31 19:52:49 volumioandrea volumio[875]: port: 80 Aug 31 19:52:49 volumioandrea volumio[875]: } Aug 31 19:52:49 volumioandrea volumio[875]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Aug 31 19:52:50 volumioandrea sudo[3861]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-08-31 19:51 Aug 31 19:52:50 volumioandrea sudo[3861]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Raspbian GNU/Linux 10 (buster)" NAME="Raspbian GNU/Linux" VERSION_ID="10" VERSION="10 (buster)" VERSION_CODENAME=buster ID=raspbian ID_LIKE=debian HOME_URL="http://www.raspbian.org/" SUPPORT_URL="http://www.raspbian.org/RaspbianForums" BUG_REPORT_URL="http://www.raspbian.org/RaspbianBugs" VOLUMIO_BUILD_VERSION="5fd3886148e72a9cecd88a772d1f6079fb64d11a" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="8bb23b009e91ae4c7ecd678f193e7d3b281fca0c" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Mon 22 Jul 2024 07:17:01 PM CEST" VOLUMIO_VERSION="3.742" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="2782e52360f70dfab079c82951ebbbb1"