-- Logs begin at Wed 2025-11-05 06:22:43 CST, end at Wed 2025-11-05 17:40:31 CST. -- Nov 05 17:39:06 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Nov 05 17:39:06 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Nov 05 17:39:06 volumio volumio[1038]: info: Discovery: Getting this device information Nov 05 17:39:06 volumio volumio[1038]: info: CoreCommandRouter::volumioGetState Nov 05 17:39:06 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:06 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Nov 05 17:39:09 volumio volumio[1038]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/Dire%20Straits/Dire%20Straits/7fd9d4cf-b23f-4298-a5fd-c4dd012ab557.jpg' Nov 05 17:39:10 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Nov 05 17:39:10 volumio volumio[1038]: info: CURURI: music-library Nov 05 17:39:10 volumio volumio[1038]: info: Preload queue cleared Nov 05 17:39:11 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Nov 05 17:39:11 volumio volumio[1038]: info: CURURI: music-library/USB Nov 05 17:39:11 volumio volumio[1038]: info: Preload queue cleared Nov 05 17:39:13 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Nov 05 17:39:13 volumio volumio[1038]: info: CURURI: music-library/USB/Seagate_Expansion_Drive Nov 05 17:39:13 volumio volumio[1038]: error: Failed LSINFO: null Nov 05 17:39:13 volumio volumio[1038]: info: Preload queue cleared Nov 05 17:39:16 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Nov 05 17:39:16 volumio volumio[1038]: info: CURURI: music-library/USB/音乐 Nov 05 17:39:16 volumio volumio[1038]: error: Failed LSINFO: null Nov 05 17:39:17 volumio volumio[1038]: info: Preload queue cleared Nov 05 17:39:21 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Nov 05 17:39:21 volumio volumio[1038]: info: CURURI: music-library/USB/新加卷 Nov 05 17:39:21 volumio volumio[1038]: error: Failed LSINFO: null Nov 05 17:39:21 volumio volumio[1038]: info: Preload queue cleared Nov 05 17:39:25 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Nov 05 17:39:25 volumio volumio[1038]: info: CURURI: music-library Nov 05 17:39:25 volumio volumio[1038]: info: Preload queue cleared Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:39:33 volumio volumio[1038]: info: Retrieving Cloud Streaming UI Nov 05 17:39:33 volumio volumio[1038]: info: Getting Tidal Cloud Configuration Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:39:33 volumio volumio[1038]: info: Getting Qobuz Cloud Configuration Nov 05 17:39:33 volumio volumio[1038]: info: Asking plugin for UI Config Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:39:33 volumio volumio[1038]: info: Getting Spotify Cloud Configuration Nov 05 17:39:33 volumio volumio[1038]: info: Asking plugin for UI Config Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:39:33 volumio volumio[1038]: info: Saving Spotify Acccount Nov 05 17:39:33 volumio volumio[1038]: info: Got Tidal Cloud Configuration Nov 05 17:39:33 volumio volumio[1038]: info: Got it Nov 05 17:39:33 volumio volumio[1038]: info: Got it Nov 05 17:39:33 volumio volumio[1038]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:39:33 volumio volumio[1038]: error: Error retrieving Highresaudio conf: TypeError: Cannot read property 'onSave' of undefined Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::volumioGetBrowseSources Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::volumioGetBrowseSources Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Nov 05 17:39:33 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares Nov 05 17:39:35 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , rescanDb Nov 05 17:39:35 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand rescan Nov 05 17:39:35 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand status Nov 05 17:39:35 volumio volumio[1038]: info: Nov 05 17:39:35 volumio volumio[1038]: ---------------------------- MPD announces state update: update Nov 05 17:39:35 volumio volumio[1038]: info: sendMpdCommand rescan took 6 milliseconds Nov 05 17:39:35 volumio volumio[1038]: info: ControllerMpd::getState Nov 05 17:39:35 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand status Nov 05 17:39:35 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand status Nov 05 17:39:35 volumio volumio[1038]: info: Nov 05 17:39:35 volumio volumio[1038]: ---------------------------- MPD announces state update: update Nov 05 17:39:35 volumio volumio[1038]: info: sendMpdCommand status took 6 milliseconds Nov 05 17:39:35 volumio volumio[1038]: info: ControllerMpd::getState Nov 05 17:39:35 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand status Nov 05 17:39:35 volumio volumio[1038]: info: sendMpdCommand status took 5 milliseconds Nov 05 17:39:35 volumio volumio[1038]: verbose: ControllerMpd::parseState Nov 05 17:39:35 volumio volumio[1038]: info: Command Router : Notfying DB Updatetrue Nov 05 17:39:35 volumio volumio[1038]: info: CoreCommandRouter::Close All Modals sent Nov 05 17:39:35 volumio volumio[1038]: verbose: ControllerMpd::parseState Nov 05 17:39:35 volumio volumio[1038]: info: ControllerMpd::pushState Nov 05 17:39:35 volumio volumio[1038]: info: CoreCommandRouter::servicePushState Nov 05 17:39:35 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:39:35 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:35 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 05 17:39:35 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:39:35 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:35 volumio volumio[1038]: 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} Nov 05 17:39:35 volumio volumio[1038]: verbose: CURRENT POSITION 8 Nov 05 17:39:35 volumio volumio[1038]: info: CoreStateMachine::syncState stateService stop Nov 05 17:39:35 volumio volumio[1038]: info: CoreStateMachine::syncState currentStatus stop Nov 05 17:39:35 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:39:35 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:35 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:39:35 volumio volumio[1038]: info: No code Nov 05 17:39:35 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:39:35 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:35 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:39:35 volumio volumio[1038]: info: ------------------------------ 98ms Nov 05 17:39:35 volumio volumio[1038]: info: sendMpdCommand status took 100 milliseconds Nov 05 17:39:35 volumio volumio[1038]: info: sendMpdCommand status took 99 milliseconds Nov 05 17:39:35 volumio volumio[1038]: verbose: ControllerMpd::parseState Nov 05 17:39:35 volumio volumio[1038]: info: Command Router : Notfying DB Updatefalse Nov 05 17:39:35 volumio volumio[1038]: info: CoreCommandRouter::Close All Modals sent Nov 05 17:39:35 volumio volumio[1038]: verbose: ControllerMpd::parseState Nov 05 17:39:35 volumio volumio[1038]: info: ControllerMpd::pushState Nov 05 17:39:35 volumio volumio[1038]: info: CoreCommandRouter::servicePushState Nov 05 17:39:35 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:39:35 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:35 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 05 17:39:35 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:39:35 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:35 volumio volumio[1038]: 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} Nov 05 17:39:35 volumio volumio[1038]: verbose: CURRENT POSITION 8 Nov 05 17:39:35 volumio volumio[1038]: info: CoreStateMachine::syncState stateService stop Nov 05 17:39:35 volumio volumio[1038]: info: CoreStateMachine::syncState currentStatus stop Nov 05 17:39:35 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:39:35 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:35 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:39:35 volumio volumio[1038]: info: No code Nov 05 17:39:35 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:39:35 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:35 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:39:35 volumio volumio[1038]: info: ------------------------------ 149ms Nov 05 17:39:36 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Nov 05 17:39:36 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Nov 05 17:39:36 volumio volumio[1038]: info: Discovery: Getting this device information Nov 05 17:39:36 volumio volumio[1038]: info: CoreCommandRouter::volumioGetState Nov 05 17:39:36 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:36 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , updateDb Nov 05 17:39:37 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand update Nov 05 17:39:37 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand status Nov 05 17:39:37 volumio volumio[1038]: info: Nov 05 17:39:37 volumio volumio[1038]: ---------------------------- MPD announces state update: update Nov 05 17:39:37 volumio volumio[1038]: info: sendMpdCommand update took 5 milliseconds Nov 05 17:39:37 volumio volumio[1038]: info: ControllerMpd::getState Nov 05 17:39:37 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand status Nov 05 17:39:37 volumio volumio[1038]: info: sendMpdCommand status took 3 milliseconds Nov 05 17:39:37 volumio volumio[1038]: info: sendMpdCommand status took 1 milliseconds Nov 05 17:39:37 volumio volumio[1038]: verbose: ControllerMpd::parseState Nov 05 17:39:37 volumio volumio[1038]: info: Command Router : Notfying DB Updatetrue Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::Close All Modals sent Nov 05 17:39:37 volumio volumio[1038]: verbose: ControllerMpd::parseState Nov 05 17:39:37 volumio volumio[1038]: info: ControllerMpd::pushState Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::servicePushState Nov 05 17:39:37 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:39:37 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:39:37 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:37 volumio volumio[1038]: 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} Nov 05 17:39:37 volumio volumio[1038]: verbose: CURRENT POSITION 8 Nov 05 17:39:37 volumio volumio[1038]: info: CoreStateMachine::syncState stateService stop Nov 05 17:39:37 volumio volumio[1038]: info: CoreStateMachine::syncState currentStatus stop Nov 05 17:39:37 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:39:37 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:39:37 volumio volumio[1038]: info: No code Nov 05 17:39:37 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:39:37 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:39:37 volumio volumio[1038]: info: ------------------------------ 94ms Nov 05 17:39:37 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand status Nov 05 17:39:37 volumio volumio[1038]: info: Nov 05 17:39:37 volumio volumio[1038]: ---------------------------- MPD announces state update: update Nov 05 17:39:37 volumio volumio[1038]: info: ControllerMpd::getState Nov 05 17:39:37 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand status Nov 05 17:39:37 volumio volumio[1038]: info: sendMpdCommand status took 6 milliseconds Nov 05 17:39:37 volumio volumio[1038]: info: sendMpdCommand status took 5 milliseconds Nov 05 17:39:37 volumio volumio[1038]: verbose: ControllerMpd::parseState Nov 05 17:39:37 volumio volumio[1038]: info: Command Router : Notfying DB Updatefalse Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::Close All Modals sent Nov 05 17:39:37 volumio volumio[1038]: verbose: ControllerMpd::parseState Nov 05 17:39:37 volumio volumio[1038]: info: ControllerMpd::pushState Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::servicePushState Nov 05 17:39:37 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:39:37 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:39:37 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:37 volumio volumio[1038]: 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} Nov 05 17:39:37 volumio volumio[1038]: verbose: CURRENT POSITION 8 Nov 05 17:39:37 volumio volumio[1038]: info: CoreStateMachine::syncState stateService stop Nov 05 17:39:37 volumio volumio[1038]: info: CoreStateMachine::syncState currentStatus stop Nov 05 17:39:37 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:39:37 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:39:37 volumio volumio[1038]: info: No code Nov 05 17:39:37 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:39:37 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:39:37 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:39:37 volumio volumio[1038]: info: ------------------------------ 82ms Nov 05 17:39:51 volumio kernel: usb 1-3: USB disconnect, device number 11 Nov 05 17:39:51 volumio volumio[1038]: info: Partition removed: {"syspath":"/sys/devices/pci0000:00/0000:00:14.0/usb1/1-3/1-3:1.0/host1/target1:0:0/1:0:0:0/block/sdb/sdb1","ACTION":"remove","DEVLINKS":"/dev/disk/by-uuid/78BC8D1659B30A33 /dev/disk/by-path/pci-0000:00:14.0-usb-0:3:1.0-scsi-0:0:0:0-part1 /dev/disk/by-partuuid/9bbb2c0b-01 /dev/disk/by-label/娱乐 /dev/disk/by-id/usb-Mestor_BOX010_012345687606-0:0-part1","DEVNAME":"/dev/sdb1","DEVPATH":"/devices/pci0000:00/0000:00:14.0/usb1/1-3/1-3:1.0/host1/target1:0:0/1:0:0:0/block/sdb/sdb1","DEVTYPE":"partition","DISKSEQ":"17","ID_BUS":"usb","ID_FS_LABEL":"娱乐","ID_FS_LABEL_ENC":"娱乐","ID_FS_TYPE":"ntfs","ID_FS_USAGE":"filesystem","ID_FS_UUID":"78BC8D1659B30A33","ID_FS_UUID_ENC":"78BC8D1659B30A33","ID_INSTANCE":"0:0","ID_MODEL":"BOX010","ID_MODEL_ENC":"BOX010\\x20\\x20\\x20\\x20\\x20\\x20\\x20\\x20\\x20\\x20","ID_MODEL_ID":"10a1","ID_PART_ENTRY_DISK":"8:16","ID_PART_ENTRY_FLAGS":"0x80","ID_PART_ENTRY_NUMBER":"1","ID_PART_ENTRY_OFFSET":"2048","ID_PART_ENTRY_SCHEME":"dos","ID_PART_ENTRY_SIZE":"2000406528","ID_PART_ENTRY_TYPE":"0x7","ID_PART_ENTRY_UUID":"9bbb2c0b-01","ID_PART_TABLE_TYPE":"atari","ID_PART_TABLE_UUID":"9bbb2c0b","ID_PATH":"pci-0000:00:14.0-usb-0:3:1.0-scsi-0:0:0:0","ID_PATH_TAG":"pci-0000_00_14_0-usb-0_3_1_0-scsi-0_0_0_0","ID_REVISION":"1.00","ID_SERIAL":"Mestor_BOX010_012345687606-0:0","ID_SERIAL_SHORT":"012345687606","ID_TYPE":"disk","ID_USB_DRIVER":"usb-storage","ID_USB_INTERFACES":":080650:","ID_USB_INTERFACE_NUM":"00","ID_VENDOR":"Mestor","ID_VENDOR_ENC":"Mestor\\x20\\x20","ID_VENDOR_ID":"8644","MAJOR":"8","MINOR":"17","PARTN":"1","SEQNUM":"3897","SUBSYSTEM":"block","TAGS":":systemd:","USEC_INITIALIZED":"39217115686"} Nov 05 17:39:55 volumio kernel: usb 1-3: new high-speed USB device number 13 using xhci_hcd Nov 05 17:40:01 volumio kernel: usb 1-3: new full-speed USB device number 14 using xhci_hcd Nov 05 17:40:01 volumio kernel: usb 1-3: device descriptor read/64, error -71 Nov 05 17:40:01 volumio kernel: usb 1-3: device descriptor read/64, error -71 Nov 05 17:40:01 volumio kernel: usb usb1-port3: attempt power cycle Nov 05 17:40:02 volumio kernel: usb 1-3: new full-speed USB device number 15 using xhci_hcd Nov 05 17:40:02 volumio kernel: usb 1-3: Device not responding to setup address. Nov 05 17:40:02 volumio kernel: usb 1-3: Device not responding to setup address. Nov 05 17:40:02 volumio kernel: usb 1-3: device not accepting address 15, error -71 Nov 05 17:40:02 volumio kernel: usb 1-3: new full-speed USB device number 16 using xhci_hcd Nov 05 17:40:02 volumio kernel: usb 1-3: Device not responding to setup address. Nov 05 17:40:02 volumio kernel: usb 1-3: Device not responding to setup address. Nov 05 17:40:03 volumio kernel: usb 1-3: device not accepting address 16, error -71 Nov 05 17:40:03 volumio kernel: usb usb1-port3: unable to enumerate USB device Nov 05 17:40:06 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Nov 05 17:40:06 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Nov 05 17:40:06 volumio volumio[1038]: info: Discovery: Getting this device information Nov 05 17:40:06 volumio volumio[1038]: info: CoreCommandRouter::volumioGetState Nov 05 17:40:06 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:40:06 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:40:07 volumio volumio[1038]: info: Retrieving Cloud Streaming UI Nov 05 17:40:07 volumio volumio[1038]: info: Getting Tidal Cloud Configuration Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:40:07 volumio volumio[1038]: info: Getting Qobuz Cloud Configuration Nov 05 17:40:07 volumio volumio[1038]: info: Asking plugin for UI Config Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:40:07 volumio volumio[1038]: info: Getting Spotify Cloud Configuration Nov 05 17:40:07 volumio volumio[1038]: info: Asking plugin for UI Config Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:40:07 volumio volumio[1038]: info: Saving Spotify Acccount Nov 05 17:40:07 volumio volumio[1038]: info: Got Tidal Cloud Configuration Nov 05 17:40:07 volumio volumio[1038]: info: Got it Nov 05 17:40:07 volumio volumio[1038]: info: Got it Nov 05 17:40:07 volumio volumio[1038]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:40:07 volumio volumio[1038]: error: Error retrieving Highresaudio conf: TypeError: Cannot read property 'onSave' of undefined Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::volumioGetBrowseSources Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::volumioGetBrowseSources Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Nov 05 17:40:07 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:40:12 volumio volumio[1038]: info: Retrieving Cloud Streaming UI Nov 05 17:40:12 volumio volumio[1038]: info: Getting Tidal Cloud Configuration Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:40:12 volumio volumio[1038]: info: Getting Qobuz Cloud Configuration Nov 05 17:40:12 volumio volumio[1038]: info: Asking plugin for UI Config Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:40:12 volumio volumio[1038]: info: Getting Spotify Cloud Configuration Nov 05 17:40:12 volumio volumio[1038]: info: Asking plugin for UI Config Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:40:12 volumio volumio[1038]: info: Saving Spotify Acccount Nov 05 17:40:12 volumio volumio[1038]: info: Got Tidal Cloud Configuration Nov 05 17:40:12 volumio volumio[1038]: info: Got it Nov 05 17:40:12 volumio volumio[1038]: info: Got it Nov 05 17:40:12 volumio volumio[1038]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::getUIConfigOnPlugin Nov 05 17:40:12 volumio volumio[1038]: error: Error retrieving Highresaudio conf: TypeError: Cannot read property 'onSave' of undefined Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::volumioGetBrowseSources Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::volumioGetBrowseSources Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::volumioGetBrowseSources Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Nov 05 17:40:12 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares Nov 05 17:40:13 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , rescanDb Nov 05 17:40:13 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand rescan Nov 05 17:40:13 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand status Nov 05 17:40:13 volumio volumio[1038]: info: Nov 05 17:40:13 volumio volumio[1038]: ---------------------------- MPD announces state update: update Nov 05 17:40:13 volumio volumio[1038]: info: sendMpdCommand rescan took 5 milliseconds Nov 05 17:40:13 volumio volumio[1038]: info: ControllerMpd::getState Nov 05 17:40:13 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand status Nov 05 17:40:13 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand status Nov 05 17:40:13 volumio volumio[1038]: info: Nov 05 17:40:13 volumio volumio[1038]: ---------------------------- MPD announces state update: update Nov 05 17:40:13 volumio volumio[1038]: info: sendMpdCommand status took 7 milliseconds Nov 05 17:40:13 volumio volumio[1038]: info: ControllerMpd::getState Nov 05 17:40:13 volumio volumio[1038]: verbose: ControllerMpd::sendMpdCommand status Nov 05 17:40:13 volumio volumio[1038]: info: sendMpdCommand status took 6 milliseconds Nov 05 17:40:13 volumio volumio[1038]: verbose: ControllerMpd::parseState Nov 05 17:40:13 volumio volumio[1038]: info: Command Router : Notfying DB Updatetrue Nov 05 17:40:13 volumio volumio[1038]: info: CoreCommandRouter::Close All Modals sent Nov 05 17:40:13 volumio volumio[1038]: verbose: ControllerMpd::parseState Nov 05 17:40:13 volumio volumio[1038]: info: ControllerMpd::pushState Nov 05 17:40:13 volumio volumio[1038]: info: CoreCommandRouter::servicePushState Nov 05 17:40:13 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:40:13 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:40:13 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Nov 05 17:40:13 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:40:13 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:40:13 volumio volumio[1038]: 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} Nov 05 17:40:13 volumio volumio[1038]: verbose: CURRENT POSITION 8 Nov 05 17:40:13 volumio volumio[1038]: info: CoreStateMachine::syncState stateService stop Nov 05 17:40:13 volumio volumio[1038]: info: CoreStateMachine::syncState currentStatus stop Nov 05 17:40:13 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:40:13 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:40:13 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:40:13 volumio volumio[1038]: info: No code Nov 05 17:40:13 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:40:13 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:40:13 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:40:13 volumio volumio[1038]: info: ------------------------------ 98ms Nov 05 17:40:13 volumio volumio[1038]: info: sendMpdCommand status took 94 milliseconds Nov 05 17:40:13 volumio volumio[1038]: info: sendMpdCommand status took 91 milliseconds Nov 05 17:40:13 volumio volumio[1038]: verbose: ControllerMpd::parseState Nov 05 17:40:13 volumio volumio[1038]: info: Command Router : Notfying DB Updatefalse Nov 05 17:40:13 volumio volumio[1038]: info: CoreCommandRouter::Close All Modals sent Nov 05 17:40:13 volumio volumio[1038]: verbose: ControllerMpd::parseState Nov 05 17:40:13 volumio volumio[1038]: info: ControllerMpd::pushState Nov 05 17:40:13 volumio volumio[1038]: info: CoreCommandRouter::servicePushState Nov 05 17:40:13 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:40:13 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:40:13 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:40:13 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:40:13 volumio volumio[1038]: 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} Nov 05 17:40:13 volumio volumio[1038]: verbose: CURRENT POSITION 8 Nov 05 17:40:13 volumio volumio[1038]: info: CoreStateMachine::syncState stateService stop Nov 05 17:40:13 volumio volumio[1038]: info: CoreStateMachine::syncState currentStatus stop Nov 05 17:40:13 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:40:13 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:40:13 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:40:13 volumio volumio[1038]: info: No code Nov 05 17:40:13 volumio volumio[1038]: info: CoreStateMachine::pushState Nov 05 17:40:13 volumio volumio[1038]: info: CorePlayQueue::getTrack 8 Nov 05 17:40:13 volumio volumio[1038]: info: CoreCommandRouter::volumioPushState Nov 05 17:40:13 volumio volumio[1038]: info: ------------------------------ 141ms Nov 05 17:40:18 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Nov 05 17:40:18 volumio volumio[1038]: info: CURURI: music-library Nov 05 17:40:18 volumio volumio[1038]: info: Preload queue cleared Nov 05 17:40:19 volumio volumio[1038]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Nov 05 17:40:19 volumio volumio[1038]: info: CURURI: music-library/USB Nov 05 17:40:19 volumio volumio[1038]: info: Preload queue cleared Nov 05 17:40:30 volumio volumio[1038]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Nov 05 17:40:30 volumio volumio[1038]: Error: connect ETIMEDOUT 202.160.128.238:443 Nov 05 17:40:30 volumio volumio[1038]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1159:16) { Nov 05 17:40:30 volumio volumio[1038]: errno: -110, Nov 05 17:40:30 volumio volumio[1038]: code: 'ETIMEDOUT', Nov 05 17:40:30 volumio volumio[1038]: syscall: 'connect', Nov 05 17:40:30 volumio volumio[1038]: address: '202.160.128.238', Nov 05 17:40:30 volumio volumio[1038]: port: 443 Nov 05 17:40:30 volumio volumio[1038]: } Nov 05 17:40:30 volumio volumio[1038]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Nov 05 17:40:31 volumio sudo[4277]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-11-05 17:39 Nov 05 17:40:31 volumio sudo[4277]: 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="669bb6cc406bb77b11c5184fedb8a4dfd19ba4ec" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="fc4c820ddd3b5fc1a7a6b54ef112273ebd122010" VOLUMIO_ARCH="x64" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Sat 26 Jul 2025 11:08:46 AM CEST" VOLUMIO_VERSION="3.832" VOLUMIO_HARDWARE="x86_amd64" VOLUMIO_DEVICENAME="x86_64" VOLUMIO_HASH="9ef0bfa9b61509be20c9051562554f31"