-- Logs begin at Sat 2025-02-22 17:39:39 CST, end at Sat 2025-02-22 17:51:20 CST. --
Feb 22 17:50:11 volumio volumio[816]: info: Preload queue cleared
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::volumioReplaceandPlayItems
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::ClearQueue
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::stop
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::setConsumeUpdateService undefined
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::clearPlayQueue
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::saveQueue
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::volumioPushQueue
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::addQueueItems
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::addQueueItems
Feb 22 17:50:11 volumio volumio[816]: info: Preload queue cleared
Feb 22 17:50:11 volumio volumio[816]: info: Adding Item to queue: music-library/USB/我的1T/å大夜晚å¬çš„æŒæ›²/Jiafeijiaer_Juanlian.ape
Feb 22 17:50:11 volumio volumio[816]: info: Using cached record of: music-library/USB/我的1T/å大夜晚å¬çš„æŒæ›²/Jiafeijiaer_Juanlian.ape
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::volumioPushQueue
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::saveQueue
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::updateTrackBlock
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::getTrackBlock
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::volumioPlay
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::play index 0
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::setConsumeUpdateService undefined
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::stop
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::setConsumeUpdateService undefined
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::play index undefined
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::setConsumeUpdateService undefined
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::startPlaybackTimer
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::clearAddPlayTracks USB/我的1T/å大夜晚å¬çš„æŒæ›²/Jiafeijiaer_Juanlian.ape
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::sendMpdCommand stop
Feb 22 17:50:11 volumio volumio[816]: info: sendMpdCommand stop took 4 milliseconds
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::sendMpdCommand clear
Feb 22 17:50:11 volumio volumio[816]: info:
Feb 22 17:50:11 volumio volumio[816]: ---------------------------- MPD announces system playlist update
Feb 22 17:50:11 volumio volumio[816]: info: Ignoring MPD Status Update
Feb 22 17:50:11 volumio volumio[816]: info: sendMpdCommand clear took 4 milliseconds
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::sendMpdCommand add "USB/我的1T/å大夜晚å¬çš„æŒæ›²/Jiafeijiaer_Juanlian.ape"
Feb 22 17:50:11 volumio volumio[816]: info:
Feb 22 17:50:11 volumio volumio[816]: ---------------------------- MPD announces system playlist update
Feb 22 17:50:11 volumio volumio[816]: info: Ignoring MPD Status Update
Feb 22 17:50:11 volumio volumio[816]: error: updateQueue error: null
Feb 22 17:50:11 volumio volumio[816]: info:
Feb 22 17:50:11 volumio volumio[816]: ---------------------------- MPD announces system playlist update
Feb 22 17:50:11 volumio volumio[816]: info: Ignoring MPD Status Update
Feb 22 17:50:11 volumio volumio[816]: info: ------------------------------ 11ms
Feb 22 17:50:11 volumio volumio[816]: info: sendMpdCommand add "USB/我的1T/å大夜晚å¬çš„æŒæ›²/Jiafeijiaer_Juanlian.ape" took 7 milliseconds
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::sendMpdCommand play
Feb 22 17:50:11 volumio volumio[816]: info:
Feb 22 17:50:11 volumio volumio[816]: ---------------------------- MPD announces system playlist update
Feb 22 17:50:11 volumio volumio[816]: info: Ignoring MPD Status Update
Feb 22 17:50:11 volumio volumio[816]: info: ------------------------------ 13ms
Feb 22 17:50:11 volumio volumio[816]: info: ------------------------------ 296ms
Feb 22 17:50:11 volumio volumio[816]: info: sendMpdCommand play took 294 milliseconds
Feb 22 17:50:11 volumio volumio[816]: info: ------------------------------ 294ms
Feb 22 17:50:11 volumio volumio[816]: info:
Feb 22 17:50:11 volumio volumio[816]: ---------------------------- MPD announces state update: player
Feb 22 17:50:11 volumio volumio[816]: info: ControllerMpd::getState
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::sendMpdCommand status
Feb 22 17:50:11 volumio volumio[816]: info:
Feb 22 17:50:11 volumio volumio[816]: ---------------------------- MPD announces state update: player
Feb 22 17:50:11 volumio volumio[816]: info: ControllerMpd::getState
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::sendMpdCommand status
Feb 22 17:50:11 volumio volumio[816]: info:
Feb 22 17:50:11 volumio volumio[816]: ---------------------------- MPD announces state update: player
Feb 22 17:50:11 volumio volumio[816]: info: sendMpdCommand status took 116 milliseconds
Feb 22 17:50:11 volumio volumio[816]: info: sendMpdCommand status took 114 milliseconds
Feb 22 17:50:11 volumio volumio[816]: info: ControllerMpd::getState
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::sendMpdCommand status
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::parseState
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::parseState
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Feb 22 17:50:11 volumio volumio[816]: info:
Feb 22 17:50:11 volumio volumio[816]: ---------------------------- MPD announces state update: player
Feb 22 17:50:11 volumio volumio[816]: info: ControllerMpd::getState
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::sendMpdCommand status
Feb 22 17:50:11 volumio volumio[816]: info: sendMpdCommand status took 12 milliseconds
Feb 22 17:50:11 volumio volumio[816]: info: sendMpdCommand playlistinfo took 12 milliseconds
Feb 22 17:50:11 volumio volumio[816]: info: sendMpdCommand playlistinfo took 11 milliseconds
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::parseState
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::parseTrackInfo
Feb 22 17:50:11 volumio volumio[816]: info: ControllerMpd::pushState
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::servicePushState
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:11 volumio volumio[816]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":234,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"眷æ‹","artist":" ä¼½è²çˆè€Œ","album":"云儿","uri":"USB/我的1T/å大夜晚å¬çš„æŒæ›²/Jiafeijiaer_Juanlian.ape","trackType":"ape"}
Feb 22 17:50:11 volumio volumio[816]: verbose: CURRENT POSITION 0
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::syncState stateService play
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::syncState currentStatus stop
Feb 22 17:50:11 volumio volumio[816]: info: ControllerMpd::pushState
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::servicePushState
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:11 volumio volumio[816]: verbose: STATE SERVICE {"status":"play","position":0,"seek":0,"duration":234,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"眷æ‹","artist":" ä¼½è²çˆè€Œ","album":"云儿","uri":"USB/我的1T/å大夜晚å¬çš„æŒæ›²/Jiafeijiaer_Juanlian.ape","trackType":"ape"}
Feb 22 17:50:11 volumio volumio[816]: verbose: CURRENT POSITION 0
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::syncState stateService play
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::syncState currentStatus play
Feb 22 17:50:11 volumio volumio[816]: info: Received an update from plugin. extracting info from payload
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::pushState
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::volumioPushState
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::pushState
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::volumioPushState
Feb 22 17:50:11 volumio volumio[816]: info: ------------------------------ 164ms
Feb 22 17:50:11 volumio volumio[816]: info: ------------------------------ 173ms
Feb 22 17:50:11 volumio volumio[816]: info: sendMpdCommand status took 46 milliseconds
Feb 22 17:50:11 volumio volumio[816]: info: sendMpdCommand playlistinfo took 43 milliseconds
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::parseState
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::parseTrackInfo
Feb 22 17:50:11 volumio volumio[816]: info: ControllerMpd::pushState
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::servicePushState
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:11 volumio volumio[816]: verbose: STATE SERVICE {"status":"play","position":0,"seek":614,"duration":234,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"眷æ‹","artist":" ä¼½è²çˆè€Œ","album":"云儿","uri":"USB/我的1T/å大夜晚å¬çš„æŒæ›²/Jiafeijiaer_Juanlian.ape","trackType":"ape"}
Feb 22 17:50:11 volumio volumio[816]: verbose: CURRENT POSITION 0
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::syncState stateService play
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::syncState currentStatus play
Feb 22 17:50:11 volumio volumio[816]: info: Received an update from plugin. extracting info from payload
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::pushState
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::volumioPushState
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::pushState
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::volumioPushState
Feb 22 17:50:11 volumio volumio[816]: info: ------------------------------ 109ms
Feb 22 17:50:11 volumio volumio[816]: info: sendMpdCommand playlistinfo took 61 milliseconds
Feb 22 17:50:11 volumio volumio[816]: verbose: ControllerMpd::parseTrackInfo
Feb 22 17:50:11 volumio volumio[816]: info: ControllerMpd::pushState
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::servicePushState
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:11 volumio volumio[816]: verbose: STATE SERVICE {"status":"play","position":0,"seek":614,"duration":234,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"眷æ‹","artist":" ä¼½è²çˆè€Œ","album":"云儿","uri":"USB/我的1T/å大夜晚å¬çš„æŒæ›²/Jiafeijiaer_Juanlian.ape","trackType":"ape"}
Feb 22 17:50:11 volumio volumio[816]: verbose: CURRENT POSITION 0
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::syncState stateService play
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::syncState currentStatus play
Feb 22 17:50:11 volumio volumio[816]: info: Received an update from plugin. extracting info from payload
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::pushState
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::volumioPushState
Feb 22 17:50:11 volumio volumio[816]: info: CoreStateMachine::pushState
Feb 22 17:50:11 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:11 volumio volumio[816]: info: CoreCommandRouter::volumioPushState
Feb 22 17:50:11 volumio volumio[816]: info: ------------------------------ 169ms
Feb 22 17:50:13 volumio ntpd[1301]: 193.182.111.12 local addr 192.168.2.19 ->
Feb 22 17:50:19 volumio volumio[816]: info: VolumeController::SetAlsaVolume57
Feb 22 17:50:19 volumio volumio[816]: info: CoreStateMachine::pushState
Feb 22 17:50:19 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:19 volumio volumio[816]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Feb 22 17:50:19 volumio volumio[816]: info: CoreCommandRouter::volumioPushState
Feb 22 17:50:19 volumio volumio[816]: info: VolumeController::SetAlsaVolume61
Feb 22 17:50:19 volumio volumio[816]: info: CoreStateMachine::pushState
Feb 22 17:50:19 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:19 volumio volumio[816]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Feb 22 17:50:19 volumio volumio[816]: info: CoreCommandRouter::volumioPushState
Feb 22 17:50:20 volumio volumio[816]: info: VolumeController::SetAlsaVolume60
Feb 22 17:50:20 volumio volumio[816]: info: CoreStateMachine::pushState
Feb 22 17:50:20 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:20 volumio volumio[816]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Feb 22 17:50:20 volumio volumio[816]: info: CoreCommandRouter::volumioPushState
Feb 22 17:50:20 volumio volumio[816]: info: VolumeController::SetAlsaVolume59
Feb 22 17:50:20 volumio volumio[816]: info: CoreStateMachine::pushState
Feb 22 17:50:20 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:20 volumio volumio[816]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Feb 22 17:50:20 volumio volumio[816]: info: CoreCommandRouter::volumioPushState
Feb 22 17:50:21 volumio volumio[816]: info: VolumeController::SetAlsaVolume58
Feb 22 17:50:21 volumio volumio[816]: info: CoreStateMachine::pushState
Feb 22 17:50:21 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:21 volumio volumio[816]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Feb 22 17:50:21 volumio volumio[816]: info: CoreCommandRouter::volumioPushState
Feb 22 17:50:21 volumio nmbd[754]: [2025/02/22 17:50:21.390282, 0] ../source3/nmbd/nmbd_namequery.c:109(query_name_response)
Feb 22 17:50:21 volumio nmbd[754]: query_name_response: Multiple (2) responses received for a query on subnet 192.168.2.19 for name WORKGROUP<1d>.
Feb 22 17:50:21 volumio nmbd[754]: This response was from IP 192.168.2.79, reporting an IP address of 192.168.2.79.
Feb 22 17:50:24 volumio volumio[816]: info: VolumeController::SetAlsaVolume54
Feb 22 17:50:24 volumio volumio[816]: info: CoreStateMachine::pushState
Feb 22 17:50:24 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:50:24 volumio volumio[816]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Feb 22 17:50:24 volumio volumio[816]: info: CoreCommandRouter::volumioPushState
Feb 22 17:51:06 volumio volumio[816]: info: VolumeController::SetAlsaVolume47
Feb 22 17:51:06 volumio volumio[816]: info: CoreStateMachine::pushState
Feb 22 17:51:06 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:51:06 volumio volumio[816]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Feb 22 17:51:06 volumio volumio[816]: info: CoreCommandRouter::volumioPushState
Feb 22 17:51:07 volumio volumio[816]: info: VolumeController::SetAlsaVolume46
Feb 22 17:51:07 volumio volumio[816]: info: CoreStateMachine::pushState
Feb 22 17:51:07 volumio volumio[816]: info: CorePlayQueue::getTrack 0
Feb 22 17:51:07 volumio volumio[816]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Feb 22 17:51:07 volumio volumio[816]: info: CoreCommandRouter::volumioPushState
Feb 22 17:51:19 volumio volumio[816]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Feb 22 17:51:19 volumio volumio[816]: Error: connect ETIMEDOUT 74.86.12.172:80
Feb 22 17:51:19 volumio volumio[816]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1159:16) {
Feb 22 17:51:19 volumio volumio[816]: errno: -110,
Feb 22 17:51:19 volumio volumio[816]: code: 'ETIMEDOUT',
Feb 22 17:51:19 volumio volumio[816]: syscall: 'connect',
Feb 22 17:51:19 volumio volumio[816]: address: '74.86.12.172',
Feb 22 17:51:19 volumio volumio[816]: port: 80
Feb 22 17:51:19 volumio volumio[816]: }
Feb 22 17:51:19 volumio volumio[816]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Feb 22 17:51:20 volumio sudo[3899]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-02-22 17:50
Feb 22 17:51:20 volumio sudo[3899]: 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="70bcab5180cf11352f5a5197ade215ea8ee93db0"
VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6"
VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a"
VOLUMIO_BE_VERSION="678d37490b3eb2102ce7c6d7a6dc3cf042ff2347"
VOLUMIO_ARCH="x64"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Fri 08 Nov 2024 07:25:16 PM CET"
VOLUMIO_VERSION="3.779"
VOLUMIO_HARDWARE="x86_amd64"
VOLUMIO_DEVICENAME="x86_64"
VOLUMIO_HASH="66c567362bdbb3dc1644a18f7879afe7"