Feb 25 21:26:19 volumio nmbd[1067]: [2026/02/25 21:26:19.331764, 0] ../../source3/nmbd/nmbd_namequery.c:109(query_name_response)
Feb 25 21:26:19 volumio nmbd[1067]: query_name_response: Multiple (2) responses received for a query on subnet 192.168.31.53 for name WORKGROUP<1d>.
Feb 25 21:26:19 volumio nmbd[1067]: This response was from IP 192.168.31.88, reporting an IP address of 192.168.31.88.
Feb 25 21:26:19 volumio nmbd[1067]: [2026/02/25 21:26:19.332100, 0] ../../source3/nmbd/nmbd_namequery.c:109(query_name_response)
Feb 25 21:26:19 volumio nmbd[1067]: query_name_response: Multiple (3) responses received for a query on subnet 192.168.31.53 for name WORKGROUP<1d>.
Feb 25 21:26:19 volumio nmbd[1067]: This response was from IP 192.168.31.88, reporting an IP address of 192.168.31.88.
Feb 25 21:26:26 volumio systemd[1]: Starting setdatetime-helper.service - Time Synchronization Helper Service...
Feb 25 21:26:36 volumio volumio[1092]: info: CorePlayQueue::getTrack 1
Feb 25 21:26:36 volumio volumio[1092]: info: CorePlayQueue::getTrack 2
Feb 25 21:26:42 volumio volumio[1092]: info:
Feb 25 21:26:42 volumio volumio[1092]: ---------------------------- MPD announces system playlist update
Feb 25 21:26:42 volumio volumio[1092]: info: Ignoring MPD Status Update
Feb 25 21:26:42 volumio volumio[1092]: info:
Feb 25 21:26:42 volumio volumio[1092]: ---------------------------- MPD announces state update: player
Feb 25 21:26:42 volumio volumio[1092]: info: ControllerMpd::getState
Feb 25 21:26:42 volumio volumio[1092]: verbose: ControllerMpd::sendMpdCommand status
Feb 25 21:26:42 volumio volumio[1092]: error: updateQueue error: null
Feb 25 21:26:42 volumio volumio[1092]: info: ------------------------------ 2ms
Feb 25 21:26:42 volumio volumio[1092]: info: sendMpdCommand status took 1 milliseconds
Feb 25 21:26:42 volumio volumio[1092]: verbose: ControllerMpd::parseState
Feb 25 21:26:42 volumio volumio[1092]: info: ControllerMpd::pushState
Feb 25 21:26:42 volumio volumio[1092]: info: CoreCommandRouter::servicePushState
Feb 25 21:26:42 volumio volumio[1092]: info: CoreStateMachine::pushState
Feb 25 21:26:42 volumio volumio[1092]: info: CorePlayQueue::getTrack 1
Feb 25 21:26:42 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Feb 25 21:26:42 volumio volumio[1092]: info: CoreCommandRouter::volumioPushState
Feb 25 21:26:42 volumio volumio[1092]: info: CorePlayQueue::getTrack 1
Feb 25 21:26:42 volumio volumio[1092]: 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}
Feb 25 21:26:42 volumio volumio[1092]: verbose: CURRENT POSITION 1
Feb 25 21:26:42 volumio volumio[1092]: info: CoreStateMachine::syncState stateService stop
Feb 25 21:26:42 volumio volumio[1092]: info: CoreStateMachine::syncState currentStatus play
Feb 25 21:26:42 volumio volumio[1092]: info: CoreCommandRouter::volumioPushState
Feb 25 21:26:42 volumio volumio[1092]: info: CoreStateMachine::stPlaybackTimer
Feb 25 21:26:42 volumio volumio[1092]: info: ------------------------------ 18ms
Feb 25 21:26:47 volumio volumio[1092]: verbose: New Socket.io Connection to 192.168.31.53:3000 from 192.168.31.253 UA: Dart/3.10 (dart:io) Engine version: 3 Transport: websocket Total Clients: 5
Feb 25 21:26:47 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Feb 25 21:26:47 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Feb 25 21:26:47 volumio volumio[1092]: info: Discovery: Getting this device information
Feb 25 21:26:47 volumio volumio[1092]: info: CoreCommandRouter::volumioGetState
Feb 25 21:26:47 volumio volumio[1092]: info: CorePlayQueue::getTrack 0
Feb 25 21:26:47 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Feb 25 21:26:49 volumio systemd[1]: setdatetime-helper.service: Deactivated successfully.
Feb 25 21:26:49 volumio systemd[1]: Finished setdatetime-helper.service - Time Synchronization Helper Service.
Feb 25 21:26:49 volumio systemd[1]: setdatetime-helper.service: Consumed 1.499s CPU time.
Feb 25 21:26:49 volumio volumio[1092]: verbose: New Socket.io Connection to 192.168.31.53 from 192.168.31.253 UA: Mozilla/5.0 (Linux; Android 16; ELI-AN00 Build/HONORELI-AN00; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/144.0.7559.132 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 6
Feb 25 21:26:49 volumio volumio[1092]: info: CoreCommandRouter::volumioGetState
Feb 25 21:26:49 volumio volumio[1092]: info: CorePlayQueue::getTrack 0
Feb 25 21:26:49 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
Feb 25 21:26:49 volumio volumio[1092]: info: Listing playlists
Feb 25 21:26:49 volumio volumio[1092]: info: CoreCommandRouter::volumioGetVisibleSources
Feb 25 21:26:49 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Feb 25 21:26:49 volumio volumio[1092]: info: CoreCommandRouter::volumioGetQueue
Feb 25 21:26:49 volumio volumio[1092]: info: CoreStateMachine::getQueue
Feb 25 21:26:49 volumio volumio[1092]: info: CorePlayQueue::getQueue
Feb 25 21:26:49 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Feb 25 21:26:54 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard
Feb 25 21:26:54 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard
Feb 25 21:26:54 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Feb 25 21:26:54 volumio sudo[27013]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Feb 25 21:26:54 volumio sudo[27011]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Feb 25 21:26:54 volumio sudo[27013]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Feb 25 21:26:54 volumio sudo[27011]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Feb 25 21:26:54 volumio sudo[27011]: pam_unix(sudo:session): session closed for user root
Feb 25 21:26:54 volumio sudo[27013]: pam_unix(sudo:session): session closed for user root
Feb 25 21:26:54 volumio volumio[1092]: verbose: New Socket.io Connection to 192.168.31.53 from 192.168.31.253 UA: Mozilla/5.0 (Linux; Android 16; ELI-AN00 Build/HONORELI-AN00; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/144.0.7559.132 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 7
Feb 25 21:26:54 volumio sudo[27017]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Feb 25 21:26:54 volumio sudo[27017]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Feb 25 21:26:54 volumio sudo[27017]: pam_unix(sudo:session): session closed for user root
Feb 25 21:26:54 volumio sudo[27019]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Feb 25 21:26:54 volumio sudo[27019]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Feb 25 21:26:54 volumio sudo[27019]: pam_unix(sudo:session): session closed for user root
Feb 25 21:26:54 volumio volumio[1092]: verbose: New Socket.io Connection to 192.168.31.53 from 192.168.31.253 UA: Mozilla/5.0 (Linux; Android 16; ELI-AN00 Build/HONORELI-AN00; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/144.0.7559.132 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 7
Feb 25 21:26:55 volumio volumio[1092]: info: CoreCommandRouter::volumioGetState
Feb 25 21:26:55 volumio volumio[1092]: info: CorePlayQueue::getTrack 0
Feb 25 21:26:55 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
Feb 25 21:26:55 volumio volumio[1092]: info: Listing playlists
Feb 25 21:26:55 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings
Feb 25 21:26:55 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard
Feb 25 21:26:55 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard
Feb 25 21:26:55 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
Feb 25 21:26:56 volumio volumio[1092]: info: CoreCommandRouter::volumioGetVisibleSources
Feb 25 21:26:56 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Feb 25 21:26:56 volumio volumio[1092]: info: CoreCommandRouter::volumioGetQueue
Feb 25 21:26:56 volumio volumio[1092]: info: CoreStateMachine::getQueue
Feb 25 21:26:56 volumio volumio[1092]: info: CorePlayQueue::getQueue
Feb 25 21:26:58 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Feb 25 21:26:58 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri
Feb 25 21:26:58 volumio volumio[1092]: info: CURURI: music-library
Feb 25 21:26:58 volumio volumio[1092]: info: Preload queue cleared
Feb 25 21:26:59 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri
Feb 25 21:26:59 volumio volumio[1092]: info: CURURI: music-library/NAS
Feb 25 21:26:59 volumio volumio[1092]: info: Preload queue cleared
Feb 25 21:27:00 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri
Feb 25 21:27:00 volumio volumio[1092]: info: CURURI: music-library/NAS/飞牛
Feb 25 21:27:00 volumio volumio[1092]: info: Preload queue cleared
Feb 25 21:27:02 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Feb 25 21:27:02 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri
Feb 25 21:27:02 volumio volumio[1092]: info: CURURI: music-library/NAS/飞牛/500GWD
Feb 25 21:27:02 volumio volumio[1092]: info: Preload queue cleared
Feb 25 21:27:03 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri
Feb 25 21:27:03 volumio volumio[1092]: info: CURURI: music-library/NAS/飞牛/500GWD/fn86_Music
Feb 25 21:27:03 volumio volumio[1092]: info: Preload queue cleared
Feb 25 21:27:06 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Feb 25 21:27:06 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri
Feb 25 21:27:06 volumio volumio[1092]: info: CURURI: music-library/NAS/飞牛/500GWD/fn86_Music/002.纯音乐
Feb 25 21:27:06 volumio volumio[1092]: info: Preload queue cleared
Feb 25 21:27:10 volumio volumio[1092]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Feb 25 21:27:12 volumio volumio[1092]: info: Preload queue cleared
Feb 25 21:27:12 volumio volumio[1092]: info: CoreCommandRouter::volumioReplaceandPlayItems
Feb 25 21:27:12 volumio volumio[1092]: info: CoreStateMachine::ClearQueue
Feb 25 21:27:12 volumio volumio[1092]: info: CoreStateMachine::stop
Feb 25 21:27:12 volumio volumio[1092]: info: CoreStateMachine::setConsumeUpdateService undefined
Feb 25 21:27:12 volumio volumio[1092]: info: CorePlayQueue::clearPlayQueue
Feb 25 21:27:12 volumio volumio[1092]: info: CorePlayQueue::saveQueue
Feb 25 21:27:12 volumio volumio[1092]: info: CoreCommandRouter::volumioPushQueue
Feb 25 21:27:12 volumio volumio[1092]: info: CoreStateMachine::addQueueItems
Feb 25 21:27:12 volumio volumio[1092]: info: CorePlayQueue::addQueueItems
Feb 25 21:27:12 volumio volumio[1092]: info: Preload queue cleared
Feb 25 21:27:12 volumio volumio[1092]: info: Adding Item to queue: music-library/NAS/飞牛/500GWD/fn86_Music/002.纯音乐/05-Great Violin Concertos
Feb 25 21:27:12 volumio volumio[1092]: info: Exploding uri music-library/NAS/飞牛/500GWD/fn86_Music/002.纯音乐/05-Great Violin Concertos in service mpd
Feb 25 21:27:12 volumio volumio[1092]: info: ALBUMART /albumart?cacheid=377&web=Vivaldi%3A%20The%204%20Seasons%20%2F%20Bach%3A%202%20Violin%20Concertos/Great%20Violin%20Concertos%20CD1/extralarge&path=%2Fmnt%2FNAS%2F%E9%A3%9E%E7%89%9B%2F500GWD%2Ffn86_Music%2F002.%E7%BA%AF%E9%9F%B3%E4%B9%90%2F05-Great%20Violin%20Concertos%2FCD01%20Vivaldi%20%26%20Bach%2FViolin%20Concertos%20CD1.cue&metadata=false
Feb 25 21:27:12 volumio volumio[1092]: info: URI /mnt/NAS/飞牛/500GWD/fn86_Music/002.纯音乐/05-Great Violin Concertos/CD01 Vivaldi & Bach/Violin Concertos CD1.cue
Feb 25 21:27:12 volumio volumio[1092]: info: ALBUMART /albumart?cacheid=377&web=Vivaldi%3A%20The%204%20Seasons%20%2F%20Bach%3A%202%20Violin%20Concertos/Great%20Violin%20Concertos%20CD1/extralarge&path=%2Fmnt%2FNAS%2F%E9%A3%9E%E7%89%9B%2F500GWD%2Ffn86_Music%2F002.%E7%BA%AF%E9%9F%B3%E4%B9%90%2F05-Great%20Violin%20Concertos%2FCD01%20Vivaldi%20%26%20Bach%2FViolin%20Concertos%20CD1.cue&metadata=false
Feb 25 21:27:12 volumio volumio[1092]: info: URI /mnt/NAS/飞牛/500GWD/fn86_Music/002.纯音乐/05-Great Violin Concertos/CD01 Vivaldi & Bach/Violin Concertos CD1.cue
Feb 25 21:27:12 volumio volumio[1092]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Feb 25 21:27:12 volumio volumio[1092]: Error: Unable to resolve or reject the same promise twice
Feb 25 21:27:12 volumio volumio[1092]: at Promise.resolve (/volumio/node_modules/kew/kew.js:140:43)
Feb 25 21:27:12 volumio volumio[1092]: at /volumio/app/plugins/music_service/mpd/index.js:2569:21
Feb 25 21:27:12 volumio volumio[1092]: at MpdClient.handleMessage (/volumio/app/plugins/music_service/mpd/lib/mpd.js:77:3)
Feb 25 21:27:12 volumio volumio[1092]: at MpdClient.receive (/volumio/app/plugins/music_service/mpd/lib/mpd.js:68:12)
Feb 25 21:27:12 volumio volumio[1092]: at Socket. (/volumio/app/plugins/music_service/mpd/lib/mpd.js:43:12)
Feb 25 21:27:12 volumio volumio[1092]: at Socket.emit (node:events:514:28)
Feb 25 21:27:12 volumio volumio[1092]: at addChunk (node:internal/streams/readable:343:12)
Feb 25 21:27:12 volumio volumio[1092]: at readableAddChunk (node:internal/streams/readable:312:11)
Feb 25 21:27:12 volumio volumio[1092]: at Readable.push (node:internal/streams/readable:253:10)
Feb 25 21:27:12 volumio volumio[1092]: at Pipe.onStreamRead (node:internal/stream_base_commons:190:23)
Feb 25 21:27:12 volumio volumio[1092]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Feb 25 21:27:12 volumio sudo[27092]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-02-25 21:26'
Feb 25 21:27:12 volumio sudo[27092]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
PRETTY_NAME="Debian GNU/Linux 12 (bookworm)"
NAME="Debian GNU/Linux"
VERSION_ID="12"
VERSION="12 (bookworm)"
VERSION_CODENAME=bookworm
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="b05a530ca81d05eb9a84d0acf82089f0a60b8ee6"
VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd"
VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2"
VOLUMIO_BE_VERSION="4ad85e2147d972f0b838d33c21382d2d813b2ae8"
VOLUMIO_ARCH="x64"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Thu Dec 25 09:38:19 UTC 2025"
VOLUMIO_VERSION="4.084"
VOLUMIO_HARDWARE="x86_amd64"
VOLUMIO_DEVICENAME="x86_64"
VOLUMIO_HASH="00e933ebe3692ad8aea9910d2289bf23"