-- Logs begin at Sat 2024-10-05 12:46:06 +07, end at Sat 2024-10-05 13:09:47 +07. -- Oct 05 13:08:03 volumio ntpd[1075]: Soliciting pool server 103.184.124.23 Oct 05 13:08:13 volumio ntpd[1075]: Soliciting pool server 115.165.161.155 Oct 05 13:08:54 volumio volumio[1107]: info: CoreCommandRouter::volumioGetState Oct 05 13:08:54 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 05 13:08:55 volumio volumio[1107]: info: Retrieving Cloud Streaming UI Oct 05 13:08:55 volumio volumio[1107]: info: Getting Tidal Cloud Configuration Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 05 13:08:55 volumio volumio[1107]: info: Getting Qobuz Cloud Configuration Oct 05 13:08:55 volumio volumio[1107]: info: Asking plugin for UI Config Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 05 13:08:55 volumio volumio[1107]: info: Getting Spotify Cloud Configuration Oct 05 13:08:55 volumio volumio[1107]: info: Asking plugin for UI Config Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 05 13:08:55 volumio volumio[1107]: info: Saving Spotify Acccount Oct 05 13:08:55 volumio volumio[1107]: info: Got it Oct 05 13:08:55 volumio volumio[1107]: error: Could not retrieve Spotify Config from plugin Spotify: no section found Oct 05 13:08:55 volumio volumio[1107]: info: Got Tidal Cloud Configuration Oct 05 13:08:55 volumio volumio[1107]: info: Got it Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::volumioGetBrowseSources Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::volumioGetBrowseSources Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::volumioGetBrowseSources Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Oct 05 13:08:55 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares Oct 05 13:08:56 volumio volumio[1107]: info: Executing endpoint metavolumio Oct 05 13:08:56 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Oct 05 13:08:56 volumio volumio[1107]: info: Executing endpoint metavolumio Oct 05 13:08:56 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Oct 05 13:08:56 volumio volumio[1107]: info: Executing endpoint metavolumio Oct 05 13:08:56 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: metavolumio , requestToMetaVolumio Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: mpd , updateDb Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::sendMpdCommand update Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::sendMpdCommand status Oct 05 13:08:57 volumio volumio[1107]: info: Oct 05 13:08:57 volumio volumio[1107]: ---------------------------- MPD announces state update: update Oct 05 13:08:57 volumio volumio[1107]: info: sendMpdCommand update took 2 milliseconds Oct 05 13:08:57 volumio volumio[1107]: info: ControllerMpd::getState Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::sendMpdCommand status Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::sendMpdCommand status Oct 05 13:08:57 volumio volumio[1107]: info: Oct 05 13:08:57 volumio volumio[1107]: ---------------------------- MPD announces state update: update Oct 05 13:08:57 volumio volumio[1107]: info: ControllerMpd::getState Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::sendMpdCommand status Oct 05 13:08:57 volumio volumio[1107]: info: sendMpdCommand status took 1 milliseconds Oct 05 13:08:57 volumio volumio[1107]: info: sendMpdCommand status took 0 milliseconds Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::parseState Oct 05 13:08:57 volumio volumio[1107]: info: Command Router : Notfying DB Updatefalse Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::Close All Modals sent Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::parseState Oct 05 13:08:57 volumio volumio[1107]: info: ControllerMpd::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::servicePushState Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::volumioPushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: 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} Oct 05 13:08:57 volumio volumio[1107]: verbose: CURRENT POSITION 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::syncState stateService stop Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::syncState currentStatus stop Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::volumioPushState Oct 05 13:08:57 volumio volumio[1107]: info: No code Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::volumioPushState Oct 05 13:08:57 volumio volumio[1107]: info: ------------------------------ 38ms Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::sendMpdCommand status Oct 05 13:08:57 volumio volumio[1107]: info: Oct 05 13:08:57 volumio volumio[1107]: ---------------------------- MPD announces state update: update Oct 05 13:08:57 volumio volumio[1107]: info: ControllerMpd::getState Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::sendMpdCommand status Oct 05 13:08:57 volumio volumio[1107]: info: sendMpdCommand status took 38 milliseconds Oct 05 13:08:57 volumio volumio[1107]: info: sendMpdCommand status took 38 milliseconds Oct 05 13:08:57 volumio volumio[1107]: info: sendMpdCommand status took 0 milliseconds Oct 05 13:08:57 volumio volumio[1107]: info: sendMpdCommand status took 0 milliseconds Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::parseState Oct 05 13:08:57 volumio volumio[1107]: info: Command Router : Notfying DB Updatefalse Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::Close All Modals sent Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::parseState Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::parseState Oct 05 13:08:57 volumio volumio[1107]: info: Command Router : Notfying DB Updatefalse Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::Close All Modals sent Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::parseState Oct 05 13:08:57 volumio volumio[1107]: info: ControllerMpd::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::servicePushState Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::volumioPushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: 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} Oct 05 13:08:57 volumio volumio[1107]: verbose: CURRENT POSITION 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::syncState stateService stop Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::syncState currentStatus stop Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::volumioPushState Oct 05 13:08:57 volumio volumio[1107]: info: No code Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::volumioPushState Oct 05 13:08:57 volumio volumio[1107]: info: ControllerMpd::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::servicePushState Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::volumioPushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: 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} Oct 05 13:08:57 volumio volumio[1107]: verbose: CURRENT POSITION 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::syncState stateService stop Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::syncState currentStatus stop Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::volumioPushState Oct 05 13:08:57 volumio volumio[1107]: info: No code Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::volumioPushState Oct 05 13:08:57 volumio volumio[1107]: info: ------------------------------ 105ms Oct 05 13:08:57 volumio volumio[1107]: info: ------------------------------ 68ms Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::sendMpdCommand status Oct 05 13:08:57 volumio volumio[1107]: info: Oct 05 13:08:57 volumio volumio[1107]: ---------------------------- MPD announces state update: update Oct 05 13:08:57 volumio volumio[1107]: info: ControllerMpd::getState Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::sendMpdCommand status Oct 05 13:08:57 volumio volumio[1107]: info: sendMpdCommand status took 11 milliseconds Oct 05 13:08:57 volumio volumio[1107]: info: sendMpdCommand status took 11 milliseconds Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::parseState Oct 05 13:08:57 volumio volumio[1107]: info: Command Router : Notfying DB Updatefalse Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::Close All Modals sent Oct 05 13:08:57 volumio volumio[1107]: verbose: ControllerMpd::parseState Oct 05 13:08:57 volumio volumio[1107]: info: ControllerMpd::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::servicePushState Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::volumioPushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: 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} Oct 05 13:08:57 volumio volumio[1107]: verbose: CURRENT POSITION 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::syncState stateService stop Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::syncState currentStatus stop Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::volumioPushState Oct 05 13:08:57 volumio volumio[1107]: info: No code Oct 05 13:08:57 volumio volumio[1107]: info: CoreStateMachine::pushState Oct 05 13:08:57 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:08:57 volumio volumio[1107]: info: CoreCommandRouter::volumioPushState Oct 05 13:08:57 volumio volumio[1107]: info: ------------------------------ 41ms Oct 05 13:08:59 volumio volumio[1107]: error: Failed request for metavolumio API Oct 05 13:08:59 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Oct 05 13:09:00 volumio ntpd[1075]: Soliciting pool server 2a0c:b847:ffff:79::e53c Oct 05 13:09:03 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Oct 05 13:09:04 volumio ntpd[1075]: Soliciting pool server 115.165.161.155 Oct 05 13:09:07 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Oct 05 13:09:08 volumio kernel: usb 4-1: reset SuperSpeed USB device number 3 using xhci-hcd Oct 05 13:09:08 volumio ntpd[1075]: Soliciting pool server 103.184.124.23 Oct 05 13:09:08 volumio kernel: usb 4-1: USB disconnect, device number 3 Oct 05 13:09:08 volumio volumio[1107]: info: Partition removed: {"syspath":"/sys/devices/platform/axi/1000120000.pcie/1f00300000.usb/xhci-hcd.1/usb4/4-1/4-1:1.0/host1/target1:0:0/1:0:0:0/block/sdb/sdb1","ACTION":"remove","DEVLINKS":"/dev/disk/by-uuid/B43AE5A93AE56936 /dev/disk/by-id/wwn-0x5002538f3367b4d7-part1 /dev/disk/by-label/NHAC /dev/disk/by-partlabel/Basic\\x20data\\x20partition /dev/disk/by-id/ata-Samsung_SSD_870_EVO_4TB_S6PJNS0W623826N-part1 /dev/disk/by-path/platform-xhci-hcd.1-usb-0:1:1.0-scsi-0:0:0:0-part1 /dev/disk/by-partuuid/fdd362a1-e09a-4b9a-957e-a957c01cb57f","DEVNAME":"/dev/sdb1","DEVPATH":"/devices/platform/axi/1000120000.pcie/1f00300000.usb/xhci-hcd.1/usb4/4-1/4-1:1.0/host1/target1:0:0/1:0:0:0/block/sdb/sdb1","DEVTYPE":"partition","DISKSEQ":"34","ID_ATA":"1","ID_ATA_DOWNLOAD_MICROCODE":"1","ID_ATA_FEATURE_SET_HPA":"1","ID_ATA_FEATURE_SET_HPA_ENABLED":"1","ID_ATA_FEATURE_SET_PM":"1","ID_ATA_FEATURE_SET_PM_ENABLED":"1","ID_ATA_FEATURE_SET_SECURITY":"1","ID_ATA_FEATURE_SET_SECURITY_ENABLED":"0","ID_ATA_FEATURE_SET_SECURITY_ENHANCED_ERASE_UNIT_MIN":"8","ID_ATA_FEATURE_SET_SECURITY_ERASE_UNIT_MIN":"4","ID_ATA_FEATURE_SET_SMART":"1","ID_ATA_FEATURE_SET_SMART_ENABLED":"1","ID_ATA_ROTATION_RATE_RPM":"0","ID_ATA_SATA":"1","ID_ATA_SATA_SIGNAL_RATE_GEN1":"1","ID_ATA_SATA_SIGNAL_RATE_GEN2":"1","ID_ATA_WRITE_CACHE":"1","ID_ATA_WRITE_CACHE_ENABLED":"1","ID_BUS":"ata","ID_FS_LABEL":"NHAC","ID_FS_LABEL_ENC":"NHAC","ID_FS_TYPE":"ntfs","ID_FS_USAGE":"filesystem","ID_FS_UUID":"B43AE5A93AE56936","ID_FS_UUID_ENC":"B43AE5A93AE56936","ID_MODEL":"Samsung_SSD_870_EVO_4TB","ID_MODEL_ENC":"Samsung\\x20SSD\\x20870\\x20EVO\\x204TB\\x20\\x20\\x20\\x20\\x20\\x20\\x20\\x20\\x20\\x20\\x20\\x20\\x20\\x20\\x20\\x20\\x20","ID_PART_ENTRY_DISK":"8:16","ID_PART_ENTRY_NAME":"Basic\\x20data\\x20partition","ID_PART_ENTRY_NUMBER":"1","ID_PART_ENTRY_OFFSET":"2048","ID_PART_ENTRY_SCHEME":"gpt","ID_PART_ENTRY_SIZE":"7814033408","ID_PART_ENTRY_TYPE":"ebd0a0a2-b9e5-4433-87c0-68b6b72699c7","ID_PART_ENTRY_UUID":"fdd362a1-e09a-4b9a-957e-a957c01cb57f","ID_PART_TABLE_TYPE":"gpt","ID_PART_TABLE_UUID":"8cfaf727-116e-4a28-81ff-edafb771b6eb","ID_PATH":"platform-xhci-hcd.1-usb-0:1:1.0-scsi-0:0:0:0","ID_PATH_TAG":"platform-xhci-hcd_1-usb-0_1_1_0-scsi-0_0_0_0","ID_REVISION":"SVT02B6Q","ID_SERIAL":"Samsung_SSD_870_EVO_4TB_S6PJNS0W623826N","ID_SERIAL_SHORT":"S6PJNS0W623826N","ID_TYPE":"disk","ID_WWN":"0x5002538f3367b4d7","ID_WWN_WITH_EXTENSION":"0x5002538f3367b4d7","MAJOR":"8","MINOR":"17","PARTN":"1","PARTNAME":"Basic data partition","SEQNUM":"3257","SUBSYSTEM":"block","TAGS":":systemd:","USEC_INITIALIZED":"1250431285"} Oct 05 13:09:09 volumio kernel: sd 1:0:0:0: [sdb] Synchronizing SCSI cache Oct 05 13:09:09 volumio kernel: sd 1:0:0:0: [sdb] Synchronize Cache(10) failed: Result: hostbyte=0x07 driverbyte=DRIVER_OK Oct 05 13:09:11 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Oct 05 13:09:15 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Oct 05 13:09:19 volumio ntpd[1075]: Soliciting pool server 103.184.124.23 Oct 05 13:09:19 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Oct 05 13:09:20 volumio kernel: usb 4-1: new SuperSpeed USB device number 4 using xhci-hcd Oct 05 13:09:20 volumio kernel: usb 4-1: New USB device found, idVendor=174c, idProduct=55aa, bcdDevice= 1.00 Oct 05 13:09:20 volumio kernel: usb 4-1: New USB device strings: Mfr=2, Product=3, SerialNumber=1 Oct 05 13:09:20 volumio kernel: usb 4-1: Product: ASMT105x Oct 05 13:09:20 volumio kernel: usb 4-1: Manufacturer: ASMT Oct 05 13:09:20 volumio kernel: usb 4-1: SerialNumber: 234567890126 Oct 05 13:09:20 volumio kernel: scsi host1: uas Oct 05 13:09:20 volumio kernel: scsi 1:0:0:0: Direct-Access Samsung SSD 870 EVO 4TB 0 PQ: 0 ANSI: 6 Oct 05 13:09:20 volumio kernel: sd 1:0:0:0: Attached scsi generic sg0 type 0 Oct 05 13:09:20 volumio kernel: sd 1:0:0:0: [sdb] 7814037168 512-byte logical blocks: (4.00 TB/3.64 TiB) Oct 05 13:09:20 volumio kernel: sd 1:0:0:0: [sdb] Write Protect is off Oct 05 13:09:20 volumio kernel: sd 1:0:0:0: [sdb] Mode Sense: 43 00 00 00 Oct 05 13:09:20 volumio kernel: sd 1:0:0:0: [sdb] Write cache: enabled, read cache: enabled, doesn't support DPO or FUA Oct 05 13:09:20 volumio kernel: sd 1:0:0:0: [sdb] Preferred minimum I/O size 512 bytes Oct 05 13:09:20 volumio kernel: sd 1:0:0:0: [sdb] Optimal transfer size 33553920 bytes Oct 05 13:09:20 volumio kernel: sdb: sdb1 Oct 05 13:09:20 volumio kernel: sd 1:0:0:0: [sdb] Attached SCSI disk Oct 05 13:09:21 volumio volumio[1107]: info: Mounting Device NHAC Oct 05 13:09:21 volumio volumio[1107]: /bin/mkdir: cannot create directory ‘/mnt/USB/NHAC’: File exists Oct 05 13:09:21 volumio volumio[1107]: error: Failed to create folder Error: Command failed: /bin/mkdir -m 777 "/mnt/USB/NHAC" Oct 05 13:09:21 volumio volumio[1107]: /bin/mkdir: cannot create directory ‘/mnt/USB/NHAC’: File exists Oct 05 13:09:21 volumio sudo[3927]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mount /dev/sdb1 /mnt/USB/NHAC -o noatime,dmask=0000,fmask=0000,iocharset=utf8 Oct 05 13:09:21 volumio sudo[3927]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 05 13:09:22 volumio sudo[3927]: pam_unix(sudo:session): session closed for user root Oct 05 13:09:22 volumio volumio[1107]: ntfs-3g-mount: failed to access mountpoint /media/NHAC: Transport endpoint is not connected Oct 05 13:09:22 volumio volumio[1107]: error: Failed to mount NHAC: Error: Command failed: /usr/bin/sudo /bin/mount "/dev/sdb1" "/mnt/USB/NHAC" -o noatime,dmask=0000,fmask=0000,iocharset=utf8 Oct 05 13:09:22 volumio volumio[1107]: ntfs-3g-mount: failed to access mountpoint /media/NHAC: Transport endpoint is not connected Oct 05 13:09:23 volumio volumio[1107]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats Oct 05 13:09:27 volumio dhcpcd[895]: eth0: carrier lost Oct 05 13:09:27 volumio kernel: macb 1f00100000.ethernet eth0: Link is Down Oct 05 13:09:27 volumio avahi-daemon[837]: Withdrawing address record for 192.168.1.98 on eth0. Oct 05 13:09:27 volumio avahi-daemon[837]: Leaving mDNS multicast group on interface eth0.IPv4 with address 192.168.1.98. Oct 05 13:09:27 volumio avahi-daemon[837]: Interface eth0.IPv4 no longer relevant for mDNS. Oct 05 13:09:27 volumio dhcpcd[895]: eth0: deleting route to 192.168.1.0/24 Oct 05 13:09:27 volumio dhcpcd[895]: eth0: deleting default route via 192.168.1.3 Oct 05 13:09:27 volumio volumio[1107]: info: Discovery: A device disappeared from network Oct 05 13:09:27 volumio volumio[1107]: info: Discovery: Device volumio disappeared from network Oct 05 13:09:27 volumio ifplugd(eth0)[1088]: Link beat lost. Oct 05 13:09:28 volumio ntpd[1075]: Deleting interface #4 eth0, 192.168.1.98#123, interface stats: received=37, sent=65, dropped=0, active_time=584 secs Oct 05 13:09:28 volumio ntpd[1075]: 203.113.174.44 local addr 192.168.1.98 -> Oct 05 13:09:28 volumio ntpd[1075]: 27.71.27.209 local addr 192.168.1.98 -> Oct 05 13:09:28 volumio ntpd[1075]: 103.130.217.41 local addr 192.168.1.98 -> Oct 05 13:09:37 volumio ifplugd(eth0)[1088]: Executing '/etc/ifplugd/ifplugd.action eth0 down'. Oct 05 13:09:37 volumio kernel: macb 1f00100000.ethernet: gem-ptp-timer ptp clock unregistered. Oct 05 13:09:37 volumio ifplugd(eth0)[1088]: Program executed successfully. Oct 05 13:09:37 volumio kernel: macb 1f00100000.ethernet eth0: PHY [1f00100000.ethernet-ffffffff:01] driver [Broadcom BCM54213PE] (irq=POLL) Oct 05 13:09:37 volumio kernel: macb 1f00100000.ethernet eth0: configuring for phy/rgmii-id link mode Oct 05 13:09:37 volumio kernel: pps pps0: new PPS source ptp0 Oct 05 13:09:37 volumio kernel: macb 1f00100000.ethernet: gem-ptp-timer ptp clock registered. Oct 05 13:09:41 volumio dhcpcd[895]: eth0: carrier acquired Oct 05 13:09:41 volumio kernel: macb 1f00100000.ethernet eth0: Link is Up - 1Gbps/Full - flow control tx Oct 05 13:09:41 volumio dhcpcd[895]: eth0: IAID 67:17:93:2b Oct 05 13:09:41 volumio dhcpcd[895]: eth0: probing address 192.168.1.98/24 Oct 05 13:09:42 volumio dhcpcd[895]: eth0: soliciting an IPv6 router Oct 05 13:09:42 volumio ifplugd(eth0)[1088]: Link beat detected. Oct 05 13:09:43 volumio ifplugd(eth0)[1088]: Executing '/etc/ifplugd/ifplugd.action eth0 up'. Oct 05 13:09:43 volumio ifplugd(eth0)[1088]: Program executed successfully. Oct 05 13:09:46 volumio dhcpcd[895]: eth0: using static address 192.168.1.98/24 Oct 05 13:09:46 volumio dhcpcd[895]: eth0: adding route to 192.168.1.0/24 Oct 05 13:09:46 volumio dhcpcd[895]: eth0: adding default route via 192.168.1.3 Oct 05 13:09:46 volumio avahi-daemon[837]: Joining mDNS multicast group on interface eth0.IPv4 with address 192.168.1.98. Oct 05 13:09:46 volumio avahi-daemon[837]: New relevant interface eth0.IPv4 for mDNS. Oct 05 13:09:46 volumio avahi-daemon[837]: Registering new address record for 192.168.1.98 on eth0.IPv4. Oct 05 13:09:46 volumio volumio[1107]: verbose: New Socket.io Connection to 192.168.1.98 from 192.168.1.83 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/129.0.0.0 Safari/537.36 Engine version: 3 Transport: polling Total Clients: 9 Oct 05 13:09:46 volumio volumio[1107]: verbose: New Socket.io Connection to 192.168.1.98 from 192.168.1.83 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/129.0.0.0 Safari/537.36 Engine version: 3 Transport: polling Total Clients: 10 Oct 05 13:09:46 volumio volumio[1107]: verbose: New Socket.io Connection to 192.168.1.98 from 192.168.1.83 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/129.0.0.0 Safari/537.36 Engine version: 3 Transport: polling Total Clients: 11 Oct 05 13:09:46 volumio volumio[1107]: verbose: New Socket.io Connection to 192.168.1.98 from 192.168.1.83 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/129.0.0.0 Safari/537.36 Engine version: 3 Transport: polling Total Clients: 12 Oct 05 13:09:47 volumio volumio[1107]: info: Discovery: adding 7bf395af-1591-4667-b347-ad3b990cf15d Oct 05 13:09:47 volumio volumio[1107]: info: Discovery: Found device Volumio Oct 05 13:09:47 volumio volumio[1107]: info: CoreCommandRouter::volumioGetState Oct 05 13:09:47 volumio volumio[1107]: info: CorePlayQueue::getTrack 11 Oct 05 13:09:47 volumio volumio[1107]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Oct 05 13:09:47 volumio volumio[1107]: Error: The value NaN is not a number Oct 05 13:09:47 volumio volumio[1107]: at Config.forceToType (/volumio/node_modules/v-conf/index.js:322:20) Oct 05 13:09:47 volumio volumio[1107]: at Config.set (/volumio/node_modules/v-conf/index.js:153:25) Oct 05 13:09:47 volumio volumio[1107]: at ControllerVolumioDiscovery.updateMultiroomDevice (/volumio/app/plugins/system_controller/volumiodiscovery/index.js:323:25) Oct 05 13:09:47 volumio volumio[1107]: at ControllerVolumioDiscovery.connectToRemoteVolumio (/volumio/app/plugins/system_controller/volumiodiscovery/index.js:273:10) Oct 05 13:09:47 volumio volumio[1107]: at Browser. (/volumio/app/plugins/system_controller/volumiodiscovery/index.js:192:12) Oct 05 13:09:47 volumio volumio[1107]: at Browser.emit (events.js:315:20) Oct 05 13:09:47 volumio volumio[1107]: at on_resolver_done (/volumio/node_modules/mdns/lib/browser.js:31:14) Oct 05 13:09:47 volumio volumio[1107]: at next (/volumio/node_modules/mdns/lib/browser.js:106:7) Oct 05 13:09:47 volumio volumio[1107]: at Array.makeAddressesUnique (/volumio/node_modules/mdns/lib/resolver_sequence_tasks.js:177:5) Oct 05 13:09:47 volumio volumio[1107]: at next (/volumio/node_modules/mdns/lib/browser.js:109:21) Oct 05 13:09:47 volumio volumio[1107]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Oct 05 13:09:47 volumio sudo[4061]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-10-05 13:08 Oct 05 13:09:47 volumio sudo[4061]: 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="bba9e3185e150dd0995f9a49355b34fc6218d5a2" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="8aa57e3ae5b742ea1069404608336a9884ccfb4e" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 17 Sep 2024 05:01:09 PM CEST" VOLUMIO_VERSION="3.757" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="e0a6dc7e914e3fb93cbf2123f2f73eac"