Jan 27 00:32:16 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:32:16 volumio volumio[1187]: info: CorePlayQueue::getTrack 1 Jan 27 00:32:16 volumio volumio[1187]: info: Prefetching next song Jan 27 00:32:16 volumio volumio[1187]: info: DOING PREFETCH IN MPD Jan 27 00:32:16 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand add "USB/1TB_SanDisk/jazz/Harry Styles - Fine Line (2019)/02. Watermelon Sugar.flac" Jan 27 00:32:20 volumio volumio[1187]: info: CoreStateMachine::startPlaybackTimer Jan 27 00:32:20 volumio volumio[1187]: info: CorePlayQueue::getTrack 1 Jan 27 00:32:20 volumio kernel: usb 2-1: new SuperSpeed USB device number 6 using xhci_hcd Jan 27 00:32:20 volumio kernel: usb 2-1: New USB device found, idVendor=0781, idProduct=55b0, bcdDevice= 3.05 Jan 27 00:32:20 volumio kernel: usb 2-1: New USB device strings: Mfr=2, Product=3, SerialNumber=1 Jan 27 00:32:20 volumio kernel: usb 2-1: Product: Portable SSD Jan 27 00:32:20 volumio kernel: usb 2-1: Manufacturer: SanDisk Jan 27 00:32:20 volumio kernel: usb 2-1: SerialNumber: 323132303536343032313732 Jan 27 00:32:20 volumio kernel: scsi host0: uas Jan 27 00:32:20 volumio kernel: scsi 0:0:0:0: Direct-Access SanDisk Portable SSD 0305 PQ: 0 ANSI: 6 Jan 27 00:32:20 volumio kernel: sd 0:0:0:0: Attached scsi generic sg0 type 0 Jan 27 00:32:20 volumio kernel: sd 0:0:0:0: [sda] 1953523712 512-byte logical blocks: (1.00 TB/932 GiB) Jan 27 00:32:20 volumio kernel: sd 0:0:0:0: [sda] 4096-byte physical blocks Jan 27 00:32:20 volumio kernel: sd 0:0:0:0: [sda] Write Protect is off Jan 27 00:32:20 volumio kernel: sd 0:0:0:0: [sda] Mode Sense: 5f 00 10 00 Jan 27 00:32:20 volumio kernel: scsi 0:0:0:1: Enclosure SanDisk SES Device 0305 PQ: 0 ANSI: 6 Jan 27 00:32:20 volumio kernel: sd 0:0:0:0: [sda] Write cache: enabled, read cache: enabled, supports DPO and FUA Jan 27 00:32:20 volumio kernel: scsi 0:0:0:1: Attached scsi generic sg1 type 13 Jan 27 00:32:20 volumio volumio[1187]: info: CoreStateMachine::pushState Jan 27 00:32:20 volumio volumio[1187]: info: CorePlayQueue::getTrack 1 Jan 27 00:32:20 volumio volumio[1187]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 27 00:32:20 volumio volumio[1187]: info: CoreCommandRouter::volumioPushState Jan 27 00:32:20 volumio volumio[1187]: info: MRS: Pushing multiroomSync output update for this device Jan 27 00:32:20 volumio volumio[1187]: info: MRS: Pushing multiroomSync output Jan 27 00:32:20 volumio volumio[1187]: info: CoreCommandRouter::volumioGetState Jan 27 00:32:20 volumio volumio[1187]: info: CorePlayQueue::getTrack 1 Jan 27 00:32:21 volumio kernel: sd 0:0:0:0: [sda] Preferred minimum I/O size 4096 bytes Jan 27 00:32:21 volumio kernel: sd 0:0:0:0: [sda] Optimal transfer size 1048576 bytes Jan 27 00:32:21 volumio kernel: sda: sda1 Jan 27 00:32:21 volumio kernel: sd 0:0:0:0: [sda] Attached SCSI disk Jan 27 00:32:21 volumio volumio[1187]: info: Mounting Device 1TB_SanDisk Jan 27 00:32:21 volumio sudo[2355]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/mount /dev/sda1 /mnt/USB/1TB_SanDisk -o noatime Jan 27 00:32:21 volumio sudo[2355]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Jan 27 00:32:21 volumio kernel: exFAT-fs (sda1): Volume was not properly unmounted. Some data may be corrupt. Please run fsck. Jan 27 00:32:21 volumio sudo[2355]: pam_unix(sudo:session): session closed for user root Jan 27 00:32:21 volumio volumio[1187]: info: Jan 27 00:32:21 volumio volumio[1187]: ---------------------------- MPD announces state update: player Jan 27 00:32:21 volumio volumio[1187]: info: ControllerMpd::getState Jan 27 00:32:21 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand status Jan 27 00:32:21 volumio volumio[1187]: info: sendMpdCommand status took 3 milliseconds Jan 27 00:32:21 volumio volumio[1187]: verbose: ControllerMpd::parseState Jan 27 00:32:21 volumio volumio[1187]: info: ControllerMpd::pushState Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::servicePushState Jan 27 00:32:21 volumio volumio[1187]: info: CoreStateMachine::pushState Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 1 Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::volumioPushState Jan 27 00:32:21 volumio volumio[1187]: info: MRS: Pushing multiroomSync output update for this device Jan 27 00:32:21 volumio volumio[1187]: info: MRS: Pushing multiroomSync output Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::volumioGetState Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 1 Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 1 Jan 27 00:32:21 volumio volumio[1187]: 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} Jan 27 00:32:21 volumio volumio[1187]: verbose: CURRENT POSITION 1 Jan 27 00:32:21 volumio volumio[1187]: info: CoreStateMachine::syncState stateService stop Jan 27 00:32:21 volumio volumio[1187]: info: CoreStateMachine::syncState currentStatus play Jan 27 00:32:21 volumio volumio[1187]: info: CoreStateMachine::play index undefined Jan 27 00:32:21 volumio volumio[1187]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 27 00:32:21 volumio volumio[1187]: info: CoreStateMachine::pushState Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 2 Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::volumioPushState Jan 27 00:32:21 volumio volumio[1187]: info: MRS: Pushing multiroomSync output update for this device Jan 27 00:32:21 volumio volumio[1187]: info: MRS: Pushing multiroomSync output Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::volumioGetState Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 2 Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 2 Jan 27 00:32:21 volumio volumio[1187]: info: CoreStateMachine::startPlaybackTimer Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 2 Jan 27 00:32:21 volumio volumio[1187]: verbose: ControllerMpd::clearAddPlayTracks USB/1TB_SanDisk/jazz/Harry Styles - Fine Line (2019)/03. Adore You.flac Jan 27 00:32:21 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand stop Jan 27 00:32:21 volumio volumio[1187]: info: ------------------------------ 33ms Jan 27 00:32:21 volumio volumio[1187]: info: CoreStateMachine::pushState Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 2 Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::volumioPushState Jan 27 00:32:21 volumio volumio[1187]: info: MRS: Pushing multiroomSync output update for this device Jan 27 00:32:21 volumio volumio[1187]: info: MRS: Pushing multiroomSync output Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::volumioGetState Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 2 Jan 27 00:32:21 volumio volumio[1187]: info: sendMpdCommand stop took 20 milliseconds Jan 27 00:32:21 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand clear Jan 27 00:32:21 volumio volumio[1187]: info: Jan 27 00:32:21 volumio volumio[1187]: ---------------------------- MPD announces system playlist update Jan 27 00:32:21 volumio volumio[1187]: info: Ignoring MPD Status Update Jan 27 00:32:21 volumio volumio[1187]: info: sendMpdCommand clear took 23 milliseconds Jan 27 00:32:21 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand add "USB/1TB_SanDisk/jazz/Harry Styles - Fine Line (2019)/03. Adore You.flac" Jan 27 00:32:21 volumio volumio[1187]: error: updateQueue error: null Jan 27 00:32:21 volumio volumio[1187]: info: ------------------------------ 2ms Jan 27 00:32:21 volumio volumio[1187]: info: Scanning new location : "USB/1TB_SanDisk" Jan 27 00:32:21 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand status Jan 27 00:32:21 volumio volumio[1187]: info: Jan 27 00:32:21 volumio volumio[1187]: ---------------------------- MPD announces state update: update Jan 27 00:32:21 volumio volumio[1187]: info: ControllerMpd::getState Jan 27 00:32:21 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand status Jan 27 00:32:21 volumio volumio[1187]: info: sendMpdCommand status took 3 milliseconds Jan 27 00:32:21 volumio volumio[1187]: info: sendMpdCommand status took 2 milliseconds Jan 27 00:32:21 volumio volumio[1187]: verbose: ControllerMpd::parseState Jan 27 00:32:21 volumio volumio[1187]: info: Command Router : Notfying DB Updatetrue Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::Close All Modals sent Jan 27 00:32:21 volumio volumio[1187]: verbose: ControllerMpd::parseState Jan 27 00:32:21 volumio volumio[1187]: info: ControllerMpd::pushState Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::servicePushState Jan 27 00:32:21 volumio volumio[1187]: info: CoreStateMachine::pushState Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 2 Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::volumioPushState Jan 27 00:32:21 volumio volumio[1187]: info: MRS: Pushing multiroomSync output update for this device Jan 27 00:32:21 volumio volumio[1187]: info: MRS: Pushing multiroomSync output Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::volumioGetState Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 2 Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 2 Jan 27 00:32:21 volumio volumio[1187]: verbose: STATE SERVICE {"status":"stop","position":null,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":true,"repeat":false,"bitrate":null,"isStreaming":false,"title":null,"artist":null,"album":null,"uri":null} Jan 27 00:32:21 volumio volumio[1187]: verbose: CURRENT POSITION 2 Jan 27 00:32:21 volumio volumio[1187]: info: CoreStateMachine::syncState stateService stop Jan 27 00:32:21 volumio volumio[1187]: info: CoreStateMachine::syncState currentStatus stop Jan 27 00:32:21 volumio volumio[1187]: info: CoreStateMachine::pushState Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 2 Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::volumioPushState Jan 27 00:32:21 volumio volumio[1187]: info: MRS: Pushing multiroomSync output update for this device Jan 27 00:32:21 volumio volumio[1187]: info: MRS: Pushing multiroomSync output Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::volumioGetState Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 2 Jan 27 00:32:21 volumio volumio[1187]: info: No code Jan 27 00:32:21 volumio volumio[1187]: info: CoreStateMachine::pushState Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 2 Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::volumioPushState Jan 27 00:32:21 volumio volumio[1187]: info: MRS: Pushing multiroomSync output update for this device Jan 27 00:32:21 volumio volumio[1187]: info: MRS: Pushing multiroomSync output Jan 27 00:32:21 volumio volumio[1187]: info: CoreCommandRouter::volumioGetState Jan 27 00:32:21 volumio volumio[1187]: info: CorePlayQueue::getTrack 2 Jan 27 00:32:22 volumio volumio[1187]: info: ------------------------------ 84ms Jan 27 00:32:58 volumio volumio[1187]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Jan 27 00:32:58 volumio volumio[1187]: info: CURURI: music-library Jan 27 00:32:58 volumio volumio[1187]: info: Preload queue cleared Jan 27 00:32:59 volumio volumio[1187]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Jan 27 00:32:59 volumio volumio[1187]: info: CURURI: music-library/USB Jan 27 00:32:59 volumio volumio[1187]: info: Preload queue cleared Jan 27 00:33:00 volumio volumio[1187]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Jan 27 00:33:00 volumio volumio[1187]: info: CURURI: music-library/USB/1TB_SanDisk Jan 27 00:33:00 volumio volumio[1187]: info: Preload queue cleared Jan 27 00:33:01 volumio volumio[1187]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Jan 27 00:33:01 volumio volumio[1187]: info: CURURI: music-library/USB/1TB_SanDisk/jazz Jan 27 00:33:01 volumio volumio[1187]: info: Preload queue cleared Jan 27 00:33:03 volumio volumio[1187]: info: Preload queue cleared Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioReplaceandPlayItems Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::ClearQueue Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::stop Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::clearPlayQueue Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::saveQueue Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioPushQueue Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::addQueueItems Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::addQueueItems Jan 27 00:33:03 volumio volumio[1187]: info: Preload queue cleared Jan 27 00:33:03 volumio volumio[1187]: info: Adding Item to queue: music-library/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics) Jan 27 00:33:03 volumio volumio[1187]: info: Exploding uri music-library/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics) in service mpd Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._01%20-%20Swingin'%20'Til%20the%20Girls%20Come%20Home.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._01 - Swingin' 'Til the Girls Come Home.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._02%20-%20Bei%20mir%20bist%20du%20schoen.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._02 - Bei mir bist du schoen.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._03%20-%20Cello%20Again.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._03 - Cello Again.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._04%20-%20Ah-Dee-Dong%20Blues%20(Oriental%20Cello%20Blues).flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._04 - Ah-Dee-Dong Blues (Oriental Cello Blues).flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._05%20-%20Sonny%20Boy.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._05 - Sonny Boy.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._06%20-%20I'm%20Beginning%20to%20See%20the%20Light.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._06 - I'm Beginning to See the Light.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._07%20-%20Too%20Marvelous%20for%20Words.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._07 - Too Marvelous for Words.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._08%20-%20Monti%20Cello.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._08 - Monti Cello.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._09%20-%20In%20a%20Cello%20Mood.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._09 - In a Cello Mood.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._10%20-%20Blues%20in%20the%20Closet.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._10 - Blues in the Closet.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._11%20-%20Tamalpais.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._11 - Tamalpais.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._12%20-%20The%20Pendulum%20at%20Falcon's%20Lair.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._12 - The Pendulum at Falcon's Lair.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._13%20-%20Jack%20the%20Fieldstalker.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._13 - Jack the Fieldstalker.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._14%20-%20Stockholm%20Sweetnin'.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._14 - Stockholm Sweetnin'.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._15%20-%20Low%20and%20Behold.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._15 - Low and Behold.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._16%20-%20Burt's%20Pad.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._16 - Burt's Pad.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._17%20-%20Marcel%20the%20Furrier.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._17 - Marcel the Furrier.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._18%20-%20Ondine.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._18 - Ondine.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F._19%20-%20Stardust.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._19 - Stardust.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F01%20-%20Swingin'%20'Til%20the%20Girls%20Come%20Home.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/01 - Swingin' 'Til the Girls Come Home.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F02%20-%20Bei%20mir%20bist%20du%20schoen.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/02 - Bei mir bist du schoen.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F03%20-%20Cello%20Again.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/03 - Cello Again.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F04%20-%20Ah-Dee-Dong%20Blues%20(Oriental%20Cello%20Blues).flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/04 - Ah-Dee-Dong Blues (Oriental Cello Blues).flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F05%20-%20Sonny%20Boy.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/05 - Sonny Boy.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F06%20-%20I'm%20Beginning%20to%20See%20the%20Light.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/06 - I'm Beginning to See the Light.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F07%20-%20Too%20Marvelous%20for%20Words.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/07 - Too Marvelous for Words.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F08%20-%20Monti%20Cello.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/08 - Monti Cello.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F09%20-%20In%20a%20Cello%20Mood.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/09 - In a Cello Mood.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F10%20-%20Blues%20in%20the%20Closet.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/10 - Blues in the Closet.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F11%20-%20Tamalpais.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/11 - Tamalpais.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F12%20-%20The%20Pendulum%20at%20Falcon's%20Lair.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/12 - The Pendulum at Falcon's Lair.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F13%20-%20Jack%20the%20Fieldstalker.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/13 - Jack the Fieldstalker.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F14%20-%20Stockholm%20Sweetnin'.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/14 - Stockholm Sweetnin'.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F15%20-%20Low%20and%20Behold.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/15 - Low and Behold.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F16%20-%20Burt's%20Pad.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/16 - Burt's Pad.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F17%20-%20Marcel%20the%20Furrier.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/17 - Marcel the Furrier.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F18%20-%20Ondine.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/18 - Ondine.flac Jan 27 00:33:03 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Oscar%20Pettiford/1951-1954/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2FOscar%20Pettiford%20-%201951-1954%20(2005%2C%20Chronological%20Classics)%2F19%20-%20Stardust.flac&metadata=false Jan 27 00:33:03 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/19 - Stardust.flac Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioPushQueue Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::saveQueue Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::updateTrackBlock Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrackBlock Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioGetState Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 2 Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::executeOnPlugin: play , [object Object] Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioPlay Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::play index 0 Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::stop Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::play index undefined Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::startPlaybackTimer Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::clearAddPlayTracks USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._01 - Swingin' 'Til the Girls Come Home.flac Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand stop Jan 27 00:33:03 volumio volumio[1187]: info: sendMpdCommand stop took 9 milliseconds Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand clear Jan 27 00:33:03 volumio volumio[1187]: info: Jan 27 00:33:03 volumio volumio[1187]: ---------------------------- MPD announces system playlist update Jan 27 00:33:03 volumio volumio[1187]: info: Ignoring MPD Status Update Jan 27 00:33:03 volumio volumio[1187]: info: sendMpdCommand clear took 1 milliseconds Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand add "USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._01 - Swingin' 'Til the Girls Come Home.flac" Jan 27 00:33:03 volumio volumio[1187]: error: updateQueue error: null Jan 27 00:33:03 volumio volumio[1187]: info: Jan 27 00:33:03 volumio volumio[1187]: ---------------------------- MPD announces system playlist update Jan 27 00:33:03 volumio volumio[1187]: info: Ignoring MPD Status Update Jan 27 00:33:03 volumio volumio[1187]: info: ------------------------------ 3ms Jan 27 00:33:03 volumio volumio[1187]: info: sendMpdCommand add "USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._01 - Swingin' 'Til the Girls Come Home.flac" took 2 milliseconds Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand play Jan 27 00:33:03 volumio volumio[1187]: info: ------------------------------ 2ms Jan 27 00:33:03 volumio volumio[1187]: info: sendMpdCommand play took 2 milliseconds Jan 27 00:33:03 volumio volumio[1187]: info: Jan 27 00:33:03 volumio volumio[1187]: ---------------------------- MPD announces state update: player Jan 27 00:33:03 volumio volumio[1187]: info: ControllerMpd::getState Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand status Jan 27 00:33:03 volumio volumio[1187]: info: Jan 27 00:33:03 volumio volumio[1187]: ---------------------------- MPD announces state update: player Jan 27 00:33:03 volumio volumio[1187]: info: ControllerMpd::getState Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand status Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand clearerror Jan 27 00:33:03 volumio volumio[1187]: info: sendMpdCommand status took 7 milliseconds Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::parseState Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand clearerror Jan 27 00:33:03 volumio volumio[1187]: info: sendMpdCommand status took 12 milliseconds Jan 27 00:33:03 volumio volumio[1187]: info: sendMpdCommand clearerror took 7 milliseconds Jan 27 00:33:03 volumio volumio[1187]: info: sendMpdCommand playlistinfo took 5 milliseconds Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::parseState Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::parseTrackInfo Jan 27 00:33:03 volumio volumio[1187]: info: ControllerMpd::pushState Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::servicePushState Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::pushState Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioPushState Jan 27 00:33:03 volumio volumio[1187]: info: MRS: Pushing multiroomSync output update for this device Jan 27 00:33:03 volumio volumio[1187]: info: MRS: Pushing multiroomSync output Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioGetState Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: verbose: STATE SERVICE {"status":"stop","position":0,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":true,"repeat":false,"bitrate":null,"isStreaming":false,"title":"._01 - Swingin' 'Til the Girls Come Home.flac","artist":null,"album":null,"uri":"USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._01 - Swingin' 'Til the Girls Come Home.flac","trackType":"flac"} Jan 27 00:33:03 volumio volumio[1187]: verbose: CURRENT POSITION 0 Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::syncState stateService stop Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::syncState currentStatus stop Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::pushState Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioPushState Jan 27 00:33:03 volumio volumio[1187]: info: MRS: Pushing multiroomSync output update for this device Jan 27 00:33:03 volumio volumio[1187]: info: MRS: Pushing multiroomSync output Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioGetState Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: info: No code Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::pushState Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioPushState Jan 27 00:33:03 volumio volumio[1187]: info: MRS: Pushing multiroomSync output update for this device Jan 27 00:33:03 volumio volumio[1187]: info: MRS: Pushing multiroomSync output Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioGetState Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: info: ------------------------------ 60ms Jan 27 00:33:03 volumio volumio[1187]: info: sendMpdCommand clearerror took 79 milliseconds Jan 27 00:33:03 volumio volumio[1187]: info: sendMpdCommand playlistinfo took 78 milliseconds Jan 27 00:33:03 volumio volumio[1187]: verbose: ControllerMpd::parseTrackInfo Jan 27 00:33:03 volumio volumio[1187]: info: ControllerMpd::pushState Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::servicePushState Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::pushState Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioPushState Jan 27 00:33:03 volumio volumio[1187]: info: MRS: Pushing multiroomSync output update for this device Jan 27 00:33:03 volumio volumio[1187]: info: MRS: Pushing multiroomSync output Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioGetState Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: verbose: STATE SERVICE {"status":"stop","position":0,"seek":null,"duration":null,"samplerate":null,"bitdepth":null,"channels":null,"random":false,"updatedb":true,"repeat":false,"bitrate":null,"isStreaming":false,"title":"._01 - Swingin' 'Til the Girls Come Home.flac","artist":null,"album":null,"uri":"USB/1TB_SanDisk/jazz/Oscar Pettiford - 1951-1954 (2005, Chronological Classics)/._01 - Swingin' 'Til the Girls Come Home.flac","trackType":"flac"} Jan 27 00:33:03 volumio volumio[1187]: verbose: CURRENT POSITION 0 Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::syncState stateService stop Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::syncState currentStatus stop Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::pushState Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioPushState Jan 27 00:33:03 volumio volumio[1187]: info: MRS: Pushing multiroomSync output update for this device Jan 27 00:33:03 volumio volumio[1187]: info: MRS: Pushing multiroomSync output Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioGetState Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: info: No code Jan 27 00:33:03 volumio volumio[1187]: info: CoreStateMachine::pushState Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioPushState Jan 27 00:33:03 volumio volumio[1187]: info: MRS: Pushing multiroomSync output update for this device Jan 27 00:33:03 volumio volumio[1187]: info: MRS: Pushing multiroomSync output Jan 27 00:33:03 volumio volumio[1187]: info: CoreCommandRouter::volumioGetState Jan 27 00:33:03 volumio volumio[1187]: info: CorePlayQueue::getTrack 0 Jan 27 00:33:03 volumio volumio[1187]: info: ------------------------------ 133ms Jan 27 00:33:06 volumio volumio[1187]: info: Preload queue cleared Jan 27 00:33:06 volumio volumio[1187]: info: CoreCommandRouter::volumioReplaceandPlayItems Jan 27 00:33:06 volumio volumio[1187]: info: CoreStateMachine::ClearQueue Jan 27 00:33:06 volumio volumio[1187]: info: CoreStateMachine::stop Jan 27 00:33:06 volumio volumio[1187]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 27 00:33:06 volumio volumio[1187]: info: CorePlayQueue::clearPlayQueue Jan 27 00:33:06 volumio volumio[1187]: info: CorePlayQueue::saveQueue Jan 27 00:33:06 volumio volumio[1187]: info: CoreCommandRouter::volumioPushQueue Jan 27 00:33:06 volumio volumio[1187]: info: CoreStateMachine::addQueueItems Jan 27 00:33:06 volumio volumio[1187]: info: CorePlayQueue::addQueueItems Jan 27 00:33:06 volumio volumio[1187]: info: Preload queue cleared Jan 27 00:33:06 volumio volumio[1187]: info: Adding Item to queue: music-library/USB/1TB_SanDisk/jazz/1980 - Archie Shepp & Niels Pedersen - Looking At Bird Jan 27 00:33:06 volumio volumio[1187]: info: Exploding uri music-library/USB/1TB_SanDisk/jazz/1980 - Archie Shepp & Niels Pedersen - Looking At Bird in service mpd Jan 27 00:33:06 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=//extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2F1980%20-%20Archie%20Shepp%20%26%20Niels%20Pedersen%20-%20Looking%20At%20Bird%2FLooking%20At%20Bird.ape&metadata=false Jan 27 00:33:06 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/1980 - Archie Shepp & Niels Pedersen - Looking At Bird/Looking At Bird.ape Jan 27 00:33:06 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Archie%20Shepp%20%26%20Niels-Henning%20%3Frsted%20Pedersen/Looking%20At%20Bird/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2F1980%20-%20Archie%20Shepp%20%26%20Niels%20Pedersen%20-%20Looking%20At%20Bird%2FLooking%20At%20Bird.ape.cue&metadata=false Jan 27 00:33:06 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/1980 - Archie Shepp & Niels Pedersen - Looking At Bird/Looking At Bird.ape.cue Jan 27 00:33:06 volumio volumio[1187]: info: ALBUMART /albumart?cacheid=588&web=Archie%20Shepp%20%26%20Niels-Henning%20%3Frsted%20Pedersen/Looking%20At%20Bird/extralarge&path=%2Fmnt%2FUSB%2F1TB_SanDisk%2Fjazz%EF%80%A8%2F1980%20-%20Archie%20Shepp%20%26%20Niels%20Pedersen%20-%20Looking%20At%20Bird%2FLooking%20At%20Bird.ape.cue&metadata=false Jan 27 00:33:06 volumio volumio[1187]: info: URI /mnt/USB/1TB_SanDisk/jazz/1980 - Archie Shepp & Niels Pedersen - Looking At Bird/Looking At Bird.ape.cue Jan 27 00:33:06 volumio volumio[1187]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jan 27 00:33:06 volumio volumio[1187]: Error: Unable to resolve or reject the same promise twice Jan 27 00:33:06 volumio volumio[1187]: at Promise.resolve (/volumio/node_modules/kew/kew.js:140:43) Jan 27 00:33:06 volumio volumio[1187]: at /volumio/app/plugins/music_service/mpd/index.js:2569:21 Jan 27 00:33:06 volumio volumio[1187]: at MpdClient.handleMessage (/volumio/app/plugins/music_service/mpd/lib/mpd.js:77:3) Jan 27 00:33:06 volumio volumio[1187]: at MpdClient.receive (/volumio/app/plugins/music_service/mpd/lib/mpd.js:68:12) Jan 27 00:33:06 volumio volumio[1187]: at Socket. (/volumio/app/plugins/music_service/mpd/lib/mpd.js:43:12) Jan 27 00:33:06 volumio volumio[1187]: at Socket.emit (node:events:514:28) Jan 27 00:33:06 volumio volumio[1187]: at addChunk (node:internal/streams/readable:343:12) Jan 27 00:33:06 volumio volumio[1187]: at readableAddChunk (node:internal/streams/readable:312:11) Jan 27 00:33:06 volumio volumio[1187]: at Readable.push (node:internal/streams/readable:253:10) Jan 27 00:33:06 volumio volumio[1187]: at Pipe.onStreamRead (node:internal/stream_base_commons:190:23) Jan 27 00:33:06 volumio volumio[1187]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jan 27 00:33:06 volumio sudo[2441]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-01-27 00:32' Jan 27 00:33:06 volumio sudo[2441]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) PRETTY_NAME="Raspbian GNU/Linux 12 (bookworm)" NAME="Raspbian GNU/Linux" VERSION_ID="12" VERSION="12 (bookworm)" VERSION_CODENAME=bookworm 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="b05a530ca81d05eb9a84d0acf82089f0a60b8ee6" VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd" VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2" VOLUMIO_BE_VERSION="4ad85e2147d972f0b838d33c21382d2d813b2ae8" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Thu Dec 25 09:13:19 UTC 2025" VOLUMIO_VERSION="4.084" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="792f09af7488531aecd1aadcaa9b175e"