-- Logs begin at Wed 2025-12-10 05:38:28 CST, end at Sun 2025-12-21 22:42:26 CST. --
Dec 21 22:42:05 volumio volumio[1139]: verbose: New Socket.io Connection to 172.18.9.119:3000 from 172.18.9.116 UA: Dart/3.9 (dart:io) Engine version: 3 Transport: websocket Total Clients: 4
Dec 21 22:42:05 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Dec 21 22:42:05 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Dec 21 22:42:05 volumio volumio[1139]: info: Discovery: Getting this device information
Dec 21 22:42:05 volumio volumio[1139]: info: CoreCommandRouter::volumioGetState
Dec 21 22:42:05 volumio volumio[1139]: info: CorePlayQueue::getTrack 0
Dec 21 22:42:05 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Dec 21 22:42:05 volumio volumio[1139]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E9%99%B6%E5%96%86/%E6%B5%81%E6%B2%99%20(Reimagined)/4d4321d5-a84d-4597-9df5-bd1d497e94c3.jpg'
Dec 21 22:42:06 volumio volumio[1139]: verbose: New Socket.io Connection to 172.18.9.119 from 172.18.9.116 UA: Mozilla/5.0 (Linux; Android 16; V2405A Build/BQ2A.250705.001-BP2A.250605.031.A3_V000L1; wv) AppleWebKit/537.36 (KHTML, like Gecko) Version/4.0 Chrome/142.0.7444.174 Mobile Safari/537.36 Engine version: 3 Transport: polling Total Clients: 5
Dec 21 22:42:06 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Dec 21 22:42:06 volumio volumio[1139]: info: CoreCommandRouter::volumioGetVisibleSources
Dec 21 22:42:06 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Dec 21 22:42:06 volumio volumio[1139]: info: CoreCommandRouter::volumioGetState
Dec 21 22:42:06 volumio volumio[1139]: info: CorePlayQueue::getTrack 0
Dec 21 22:42:06 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback
Dec 21 22:42:06 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom
Dec 21 22:42:06 volumio volumio[1139]: info: Received Get System Info
Dec 21 22:42:06 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Dec 21 22:42:06 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Dec 21 22:42:06 volumio volumio[1139]: info: Discovery: Getting this device information
Dec 21 22:42:06 volumio volumio[1139]: info: CoreCommandRouter::volumioGetState
Dec 21 22:42:06 volumio volumio[1139]: info: CorePlayQueue::getTrack 0
Dec 21 22:42:06 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Dec 21 22:42:06 volumio volumio[1139]: info: CoreCommandRouter::volumioGetState
Dec 21 22:42:06 volumio volumio[1139]: info: CorePlayQueue::getTrack 0
Dec 21 22:42:06 volumio volumio[1139]: info: Listing playlists
Dec 21 22:42:06 volumio volumio[1139]: info: CoreCommandRouter::volumioGetQueue
Dec 21 22:42:06 volumio volumio[1139]: info: CoreStateMachine::getQueue
Dec 21 22:42:06 volumio volumio[1139]: info: CorePlayQueue::getQueue
Dec 21 22:42:06 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: updater_comm , getUpdateMessageCache
Dec 21 22:42:07 volumio volumio[1139]: info: CoreCommandRouter::volumioPause
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::pause
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::stPlaybackTimer
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::servicePause
Dec 21 22:42:07 volumio volumio[1139]: info: CorePlayQueue::getTrack 0
Dec 21 22:42:07 volumio volumio[1139]: info: CoreCommandRouter::servicePause
Dec 21 22:42:07 volumio volumio[1139]: info: ControllerMpd::pause
Dec 21 22:42:07 volumio volumio[1139]: verbose: ControllerMpd::sendMpdCommand pause
Dec 21 22:42:07 volumio volumio[1139]: info: sendMpdCommand pause took 2 milliseconds
Dec 21 22:42:07 volumio volumio[1139]: info:
Dec 21 22:42:07 volumio volumio[1139]: ---------------------------- MPD announces state update: player
Dec 21 22:42:07 volumio volumio[1139]: info: ControllerMpd::getState
Dec 21 22:42:07 volumio volumio[1139]: verbose: ControllerMpd::sendMpdCommand status
Dec 21 22:42:07 volumio volumio[1139]: info:
Dec 21 22:42:07 volumio volumio[1139]: ---------------------------- MPD announces state update: player
Dec 21 22:42:07 volumio volumio[1139]: info: ControllerMpd::getState
Dec 21 22:42:07 volumio volumio[1139]: verbose: ControllerMpd::sendMpdCommand status
Dec 21 22:42:07 volumio volumio[1139]: info:
Dec 21 22:42:07 volumio volumio[1139]: ---------------------------- MPD announces state update: player
Dec 21 22:42:07 volumio volumio[1139]: info: ControllerMpd::getState
Dec 21 22:42:07 volumio volumio[1139]: verbose: ControllerMpd::sendMpdCommand status
Dec 21 22:42:07 volumio volumio[1139]: info: sendMpdCommand status took 1 milliseconds
Dec 21 22:42:07 volumio volumio[1139]: info: sendMpdCommand status took 1 milliseconds
Dec 21 22:42:07 volumio volumio[1139]: info: sendMpdCommand status took 0 milliseconds
Dec 21 22:42:07 volumio volumio[1139]: verbose: ControllerMpd::parseState
Dec 21 22:42:07 volumio volumio[1139]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Dec 21 22:42:07 volumio volumio[1139]: verbose: ControllerMpd::parseState
Dec 21 22:42:07 volumio volumio[1139]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Dec 21 22:42:07 volumio volumio[1139]: verbose: ControllerMpd::parseState
Dec 21 22:42:07 volumio volumio[1139]: verbose: ControllerMpd::sendMpdCommand playlistinfo
Dec 21 22:42:07 volumio volumio[1139]: info: sendMpdCommand playlistinfo took 1 milliseconds
Dec 21 22:42:07 volumio volumio[1139]: info: sendMpdCommand playlistinfo took 1 milliseconds
Dec 21 22:42:07 volumio volumio[1139]: info: sendMpdCommand playlistinfo took 1 milliseconds
Dec 21 22:42:07 volumio volumio[1139]: verbose: ControllerMpd::parseTrackInfo
Dec 21 22:42:07 volumio volumio[1139]: verbose: ControllerMpd::parseTrackInfo
Dec 21 22:42:07 volumio volumio[1139]: verbose: ControllerMpd::parseTrackInfo
Dec 21 22:42:07 volumio volumio[1139]: info: ControllerMpd::pushState
Dec 21 22:42:07 volumio volumio[1139]: info: CoreCommandRouter::servicePushState
Dec 21 22:42:07 volumio volumio[1139]: info: CorePlayQueue::getTrack 0
Dec 21 22:42:07 volumio volumio[1139]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":117464,"duration":291,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"931 Kbps","isStreaming":false,"title":"流沙 (Reimagined)","artist":"陶喆","album":"流沙 (Reimagined)","uri":"NAS/NAS/Lossless/陶喆/陶喆-流沙 (Reimagined).flac","trackType":"flac"}
Dec 21 22:42:07 volumio volumio[1139]: verbose: CURRENT POSITION 0
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::syncState stateService pause
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::syncState currentStatus pause
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::pushState
Dec 21 22:42:07 volumio volumio[1139]: info: CorePlayQueue::getTrack 0
Dec 21 22:42:07 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Dec 21 22:42:07 volumio volumio[1139]: info: CoreCommandRouter::volumioPushState
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::stPlaybackTimer
Dec 21 22:42:07 volumio volumio[1139]: info: ControllerMpd::pushState
Dec 21 22:42:07 volumio volumio[1139]: info: CoreCommandRouter::servicePushState
Dec 21 22:42:07 volumio volumio[1139]: info: CorePlayQueue::getTrack 0
Dec 21 22:42:07 volumio volumio[1139]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":117464,"duration":291,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"931 Kbps","isStreaming":false,"title":"流沙 (Reimagined)","artist":"陶喆","album":"流沙 (Reimagined)","uri":"NAS/NAS/Lossless/陶喆/陶喆-流沙 (Reimagined).flac","trackType":"flac"}
Dec 21 22:42:07 volumio volumio[1139]: verbose: CURRENT POSITION 0
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::syncState stateService pause
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::syncState currentStatus pause
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::pushState
Dec 21 22:42:07 volumio volumio[1139]: info: CorePlayQueue::getTrack 0
Dec 21 22:42:07 volumio volumio[1139]: info: CoreCommandRouter::volumioPushState
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::stPlaybackTimer
Dec 21 22:42:07 volumio volumio[1139]: info: ControllerMpd::pushState
Dec 21 22:42:07 volumio volumio[1139]: info: CoreCommandRouter::servicePushState
Dec 21 22:42:07 volumio volumio[1139]: info: CorePlayQueue::getTrack 0
Dec 21 22:42:07 volumio volumio[1139]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":117464,"duration":291,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"931 Kbps","isStreaming":false,"title":"流沙 (Reimagined)","artist":"陶喆","album":"流沙 (Reimagined)","uri":"NAS/NAS/Lossless/陶喆/陶喆-流沙 (Reimagined).flac","trackType":"flac"}
Dec 21 22:42:07 volumio volumio[1139]: verbose: CURRENT POSITION 0
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::syncState stateService pause
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::syncState currentStatus pause
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::pushState
Dec 21 22:42:07 volumio volumio[1139]: info: CorePlayQueue::getTrack 0
Dec 21 22:42:07 volumio volumio[1139]: info: CoreCommandRouter::volumioPushState
Dec 21 22:42:07 volumio volumio[1139]: info: CoreStateMachine::stPlaybackTimer
Dec 21 22:42:07 volumio volumio[1139]: info: ------------------------------ 6ms
Dec 21 22:42:07 volumio volumio[1139]: info: ------------------------------ 6ms
Dec 21 22:42:07 volumio volumio[1139]: info: ------------------------------ 5ms
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::getUIConfigOnPlugin
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::getUIConfigOnPlugin
Dec 21 22:42:08 volumio volumio[1139]: info: Retrieving Cloud Streaming UI
Dec 21 22:42:08 volumio volumio[1139]: info: Getting Tidal Cloud Configuration
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::getUIConfigOnPlugin
Dec 21 22:42:08 volumio volumio[1139]: info: Getting Qobuz Cloud Configuration
Dec 21 22:42:08 volumio volumio[1139]: info: Asking plugin for UI Config
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::getUIConfigOnPlugin
Dec 21 22:42:08 volumio volumio[1139]: info: Getting Spotify Cloud Configuration
Dec 21 22:42:08 volumio volumio[1139]: info: Asking plugin for UI Config
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::getUIConfigOnPlugin
Dec 21 22:42:08 volumio volumio[1139]: info: Saving Spotify Acccount
Dec 21 22:42:08 volumio volumio[1139]: info: Got Tidal Cloud Configuration
Dec 21 22:42:08 volumio volumio[1139]: info: Got it
Dec 21 22:42:08 volumio volumio[1139]: info: Got it
Dec 21 22:42:08 volumio volumio[1139]: error: Could not retrieve Spotify Config from plugin Spotify: no section found
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::getUIConfigOnPlugin
Dec 21 22:42:08 volumio volumio[1139]: error: Error retrieving Highresaudio conf: TypeError: Cannot read property 'onSave' of undefined
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: albumart , getConfigParam
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::volumioGetBrowseSources
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::volumioGetBrowseSources
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::volumioGetBrowseSources
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStats
Dec 21 22:42:08 volumio volumio[1139]: info: CoreCommandRouter::executeOnPlugin: networkfs , listShares
Dec 21 22:42:26 volumio volumio[1139]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Dec 21 22:42:26 volumio volumio[1139]: Error: connect ETIMEDOUT 157.240.12.35:443
Dec 21 22:42:26 volumio volumio[1139]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1146:16) {
Dec 21 22:42:26 volumio volumio[1139]: errno: -110,
Dec 21 22:42:26 volumio volumio[1139]: code: 'ETIMEDOUT',
Dec 21 22:42:26 volumio volumio[1139]: syscall: 'connect',
Dec 21 22:42:26 volumio volumio[1139]: address: '157.240.12.35',
Dec 21 22:42:26 volumio volumio[1139]: port: 443
Dec 21 22:42:26 volumio volumio[1139]: }
Dec 21 22:42:26 volumio volumio[1139]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Dec 21 22:42:26 volumio sudo[7912]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-12-21 22:41
Dec 21 22:42:26 volumio sudo[7912]: 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="cc50ad4a2058d01de272214eb33827883bd2b7d8"
VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd"
VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2"
VOLUMIO_BE_VERSION="502750e5d54ecf269d25125b622bfabc030fb553"
VOLUMIO_ARCH="arm"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Wed 12 Nov 2025 06:58:02 PM CET"
VOLUMIO_VERSION="3.874"
VOLUMIO_HARDWARE="pi"
VOLUMIO_DEVICENAME="Raspberry Pi"
VOLUMIO_HASH="4ae6504ed6f22e44c01a6e93b16badbd"