-- Logs begin at Mon 2025-12-22 05:11:54 UTC, end at Mon 2025-12-22 05:17:59 UTC. -- Dec 22 05:17:48 volumio systemd[1]: Time has been changed Dec 22 05:17:48 volumio volumio[4980]: info: [1766380668785] Starting Upmpd Daemon Dec 22 05:17:48 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Dec 22 05:17:48 volumio volumio[4980]: info: Loading plugin "my_music"... Dec 22 05:17:48 volumio volumio[4980]: info: Loading plugin "mpd"... Dec 22 05:17:49 volumio volumio[4980]: info: Loading plugin "upnp_browser"... Dec 22 05:17:49 volumio volumio[4980]: info: Loading plugin "networkfs"... Dec 22 05:17:49 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Dec 22 05:17:49 volumio volumio[4980]: info: Loading plugin "alarm-clock"... Dec 22 05:17:50 volumio volumio[4980]: info: Loading plugin "airplay_emulation"... Dec 22 05:17:50 volumio volumio[4980]: info: Starting Shairport Sync Dec 22 05:17:50 volumio volumio[4980]: info: Loading plugin "last_100"... Dec 22 05:17:50 volumio volumio[4980]: info: Loading plugin "webradio"... Dec 22 05:17:50 volumio volumio[4980]: info: Loading plugin "i2s_dacs"... Dec 22 05:17:50 volumio volumio[4980]: info: I2S DAC not set, start Auto-detection Dec 22 05:17:50 volumio volumio[4980]: info: Loading plugin "volumiodiscovery"... Dec 22 05:17:50 volumio volumio[4980]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Dec 22 05:17:50 volumio node[4980]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Dec 22 05:17:50 volumio node[4980]: *** WARNING *** Please fix your application to use the native API of Avahi! Dec 22 05:17:50 volumio node[4980]: *** WARNING *** For more information see Dec 22 05:17:50 volumio node[4980]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Dec 22 05:17:50 volumio node[4980]: *** WARNING *** Please fix your application to use the native API of Avahi! Dec 22 05:17:50 volumio node[4980]: *** WARNING *** For more information see Dec 22 05:17:50 volumio volumio[4980]: *** WARNING *** Please fix your application to use the native API of Avahi! Dec 22 05:17:50 volumio volumio[4980]: *** WARNING *** For more information see Dec 22 05:17:50 volumio volumio[4980]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Dec 22 05:17:50 volumio volumio[4980]: *** WARNING *** Please fix your application to use the native API of Avahi! Dec 22 05:17:50 volumio volumio[4980]: *** WARNING *** For more information see Dec 22 05:17:50 volumio volumio[4980]: info: Applying required configuration parameters for plugin volumiodiscovery Dec 22 05:17:50 volumio volumio[4980]: Discovery: StartAdv! undefined Dec 22 05:17:50 volumio volumio[4980]: Discovery: Started advertising... Volumio - undefined Dec 22 05:17:50 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Dec 22 05:17:50 volumio volumio[4980]: info: Loading plugin "outputs"... Dec 22 05:17:50 volumio volumio[4980]: info: Loading plugin "albumart"... Dec 22 05:17:50 volumio volumio[4980]: info: Plugin example_plugin is not enabled Dec 22 05:17:50 volumio volumio[4980]: info: Loading plugin "inputs"... Dec 22 05:17:50 volumio volumio[4980]: info: Loading plugin "updater_comm"... Dec 22 05:17:50 volumio volumio[4980]: info: Plugin mpdemulation is not enabled Dec 22 05:17:50 volumio volumio[4980]: info: Loading plugin "rest_api"... Dec 22 05:17:50 volumio volumio[4980]: info: Loading plugin "websocket"... Dec 22 05:17:50 volumio volumio[4980]: info: ___________ START PLUGINS ___________ Dec 22 05:17:50 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 22 05:17:50 volumio volumio[4980]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Dec 22 05:17:50 volumio volumio[4980]: info: [1766380670790] CoreMusicLibrary::Adding element Media Servers Dec 22 05:17:50 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 22 05:17:50 volumio volumio[4980]: Forking 3 albumart workers Dec 22 05:17:50 volumio volumio[4980]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Dec 22 05:17:50 volumio volumio[4980]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Dec 22 05:17:50 volumio volumio[4980]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Dec 22 05:17:50 volumio volumio[4980]: info: [1766380670922] CoreMusicLibrary::Adding element Last_100 Dec 22 05:17:50 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 22 05:17:50 volumio volumio[4980]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Dec 22 05:17:50 volumio volumio[4980]: info: [1766380670927] CoreMusicLibrary::Adding element Webradio Dec 22 05:17:50 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 22 05:17:50 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Dec 22 05:17:50 volumio volumio[4980]: info: ------------------------------------------- Dec 22 05:17:50 volumio volumio[4980]: info: ----- MyVolumio plugins startup ---- Dec 22 05:17:50 volumio volumio[4980]: info: ------------------------------------------- Dec 22 05:17:50 volumio volumio[4980]: info: [MyVolumio PluginManager] Fetching plans data.... Dec 22 05:17:50 volumio volumio[4980]: info: Loading i18n strings for locale zh Dec 22 05:17:50 volumio volumio[4980]: Updating browse sources language Dec 22 05:17:50 volumio volumio[4980]: Cannot find translation for sourceMedia Servers Dec 22 05:17:50 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Dec 22 05:17:50 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 22 05:17:50 volumio volumio[4980]: info: CoreCommandRouter::initPlayerControls Dec 22 05:17:51 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 22 05:17:51 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getAlsaCards Dec 22 05:17:51 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 22 05:17:51 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 22 05:17:51 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 22 05:17:51 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 22 05:17:51 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Dec 22 05:17:51 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Dec 22 05:17:51 volumio volumio[4980]: info: BOOT COMPLETED Dec 22 05:17:51 volumio volumio[4980]: [Metrics] CommandRouter: 5s 78.63ms Dec 22 05:17:51 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 22 05:17:51 volumio volumio-remote-updater[4582]: [2025-12-22 05:17:51] [connect] Successful connection Dec 22 05:17:51 volumio volumio[4980]: Starting albumart workers Dec 22 05:17:51 volumio volumio[4980]: Starting albumart workers Dec 22 05:17:51 volumio volumio[4980]: Starting albumart workers Dec 22 05:17:56 volumio volumio[4980]: Playing WAVE '/volumio/app/startup.wav' : Signed 16 bit Little Endian, Rate 44100 Hz, Stereo Dec 22 05:17:56 volumio volumio[4980]: info: CoreCommandRouter::Close All Modals sent Dec 22 05:17:56 volumio volumio[4980]: info: CoreCommandRouter::Close All Modals sent Dec 22 05:17:56 volumio volumio[4980]: Express server listening on port 3000 Dec 22 05:17:56 volumio volumio[4980]: [Metrics] WebUI: 11s 110.49ms Dec 22 05:17:56 volumio volumio[4980]: Volumio Calling Home Dec 22 05:17:56 volumio volumio[4980]: info: CoreStateMachine::resetVolumioState Dec 22 05:17:56 volumio volumio[4980]: info: CoreStateMachine::getcurrentVolume Dec 22 05:17:56 volumio volumio[4980]: info: CoreCommandRouter::volumioRetrievevolume Dec 22 05:17:56 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Dec 22 05:17:56 volumio volumio[4980]: error: Cannot read config.txt file: Error: ENOENT: no such file or directory, open '/boot/config.txt' Dec 22 05:17:56 volumio volumio[4980]: error: Cannot get ALSA Volume: Error: Alsa Mixer Error: amixer: Unable to find simple control '',0 Dec 22 05:17:56 volumio volumio[4980]: info: Setting Device type: Amlogic Dec 22 05:17:56 volumio volumio[4980]: info: MPD running with PID4676 Dec 22 05:17:56 volumio volumio[4980]: ,establishing connection Dec 22 05:17:56 volumio sudo[5125]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/sbin/i2cdetect -y 1 Dec 22 05:17:56 volumio sudo[5125]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 22 05:17:56 volumio sudo[5125]: pam_unix(sudo:session): session closed for user root Dec 22 05:17:56 volumio volumio[4980]: info: VolumeController:: Volume=undefined Mute =false Dec 22 05:17:56 volumio volumio[4980]: info: CoreStateMachine::pushState Dec 22 05:17:56 volumio volumio[4980]: info: CorePlayQueue::getTrack 0 Dec 22 05:17:56 volumio volumio[4980]: info: CoreCommandRouter::volumioPushState Dec 22 05:17:56 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Dec 22 05:17:56 volumio volumio[4980]: info: CoreStateMachine::updateTrackBlock Dec 22 05:17:56 volumio volumio[4980]: info: CorePlayQueue::getTrackBlock Dec 22 05:17:56 volumio volumio[4980]: info: CoreCommandRouter::volumioRetrievevolume Dec 22 05:17:56 volumio volumio[4980]: info: Dec 22 05:17:56 volumio volumio[4980]: ---------------------------- Client requests Volume 40 Dec 22 05:17:56 volumio volumio[4980]: info: VolumeController::SetAlsaVolume40 Dec 22 05:17:56 volumio volumio[4980]: info: CoreStateMachine::pushState Dec 22 05:17:56 volumio volumio[4980]: info: CorePlayQueue::getTrack 0 Dec 22 05:17:56 volumio volumio[4980]: info: CoreCommandRouter::volumioPushState Dec 22 05:17:56 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Dec 22 05:17:57 volumio volumio[4980]: info: Cannot read I2C interface or I2C interface not presentError: Command failed: /usr/bin/sudo /usr/sbin/i2cdetect -y 1 Dec 22 05:17:57 volumio volumio[4980]: Error: Could not open file `/dev/i2c-1' or `/dev/i2c/1': No such file or directory Dec 22 05:17:57 volumio volumio[4980]: info: Cannot read play queue from file Dec 22 05:17:57 volumio volumio[4980]: error: updateQueue error: null Dec 22 05:17:57 volumio volumio[4980]: error: Cannot set ALSA Volume: Error: Alsa Mixer Error: amixer: Unable to find simple control '',0 Dec 22 05:17:57 volumio volumio[4980]: info: Setting volume on startup at 40 Dec 22 05:17:57 volumio volumio[4980]: error: Cannot get ALSA Volume: Error: Alsa Mixer Error: amixer: Unable to find simple control '',0 Dec 22 05:17:57 volumio volumio[4980]: info: CoreStateMachine::setRepeat null single undefined Dec 22 05:17:57 volumio volumio[4980]: info: CoreStateMachine::pushState Dec 22 05:17:57 volumio volumio[4980]: info: CorePlayQueue::getTrack 0 Dec 22 05:17:57 volumio volumio[4980]: info: CoreCommandRouter::volumioPushState Dec 22 05:17:57 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Dec 22 05:17:57 volumio volumio[4980]: info: CoreStateMachine::setRandom null Dec 22 05:17:57 volumio volumio[4980]: info: CoreStateMachine::pushState Dec 22 05:17:57 volumio volumio[4980]: info: CorePlayQueue::getTrack 0 Dec 22 05:17:57 volumio volumio[4980]: info: CoreCommandRouter::volumioPushState Dec 22 05:17:57 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Dec 22 05:17:57 volumio volumio[4980]: info: VolumeController:: Volume=undefined Mute =false Dec 22 05:17:57 volumio volumio[4980]: info: CoreStateMachine::pushState Dec 22 05:17:57 volumio volumio[4980]: info: CorePlayQueue::getTrack 0 Dec 22 05:17:57 volumio volumio[4980]: info: CoreCommandRouter::volumioPushState Dec 22 05:17:57 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Dec 22 05:17:57 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkAudioDeviceAvailable Dec 22 05:17:57 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Dec 22 05:17:57 volumio volumio[4980]: info: CoreCommandRouter::executeOnPlugin: system , versionChangeDetect Dec 22 05:17:57 volumio volumio[4980]: info: Starting Shairport Sync Dec 22 05:17:57 volumio volumio[4980]: info: Starting Shairport Sync Dec 22 05:17:57 volumio volumio[4980]: Discovery: adding 615c1aea-7cf0-4356-8fea-05f612ac1962 Dec 22 05:17:57 volumio volumio[4980]: info: mDNS: Found device Volumio Dec 22 05:17:57 volumio sudo[5135]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Dec 22 05:17:57 volumio volumio[4980]: info: CoreCommandRouter::volumioGetState Dec 22 05:17:57 volumio volumio[4980]: info: CorePlayQueue::getTrack 0 Dec 22 05:17:57 volumio sudo[5135]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 22 05:17:57 volumio sudo[5137]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Dec 22 05:17:57 volumio sudo[5137]: pam_unix(sudo:session): session opened for user root by (uid=0) Dec 22 05:17:57 volumio systemd[1]: Starting Shairport Sync - AirPlay Audio Receiver... Dec 22 05:17:57 volumio systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Dec 22 05:17:57 volumio sudo[5135]: pam_unix(sudo:session): session closed for user root Dec 22 05:17:57 volumio sudo[5137]: pam_unix(sudo:session): session closed for user root Dec 22 05:17:57 volumio volumio[4980]: info: Shairport-Sync Started Dec 22 05:17:57 volumio volumio[4980]: Error adding Membership: Error: addMembership EINVAL Dec 22 05:17:57 volumio volumio[4980]: info: Shairport-Sync Started Dec 22 05:17:57 volumio volumio[4980]: Discovery: this is already registered, 615c1aea-7cf0-4356-8fea-05f612ac1962 Dec 22 05:17:57 volumio volumio[4980]: info: mDNS: Found device Volumio Dec 22 05:17:57 volumio volumio[4980]: info: CoreCommandRouter::volumioGetState Dec 22 05:17:57 volumio volumio[4980]: info: CorePlayQueue::getTrack 0 Dec 22 05:17:57 volumio volumio[4980]: info: CoreCommandRouter::volumioGetState Dec 22 05:17:57 volumio volumio[4980]: info: CorePlayQueue::getTrack 0 Dec 22 05:17:58 volumio volumio[4980]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Dec 22 05:17:58 volumio volumio[4980]: { Error: connect ECONNREFUSED 162.125.80.5:443 Dec 22 05:17:58 volumio volumio[4980]: at Object._errnoException (util.js:1022:11) Dec 22 05:17:58 volumio volumio[4980]: at _exceptionWithHostPort (util.js:1044:20) Dec 22 05:17:58 volumio volumio[4980]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1198:14) Dec 22 05:17:58 volumio volumio[4980]: code: 'ECONNREFUSED', Dec 22 05:17:58 volumio volumio[4980]: errno: 'ECONNREFUSED', Dec 22 05:17:58 volumio volumio[4980]: syscall: 'connect', Dec 22 05:17:58 volumio volumio[4980]: address: '162.125.80.5', Dec 22 05:17:58 volumio volumio[4980]: port: 443 } Dec 22 05:17:58 volumio volumio[4980]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Dec 22 05:17:59 volumio sudo[5160]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-12-22 05:16 Dec 22 05:17:59 volumio sudo[5160]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Debian GNU/Linux 8 (jessie)" NAME="Debian GNU/Linux" VERSION_ID="8" VERSION="8 (jessie)" ID=debian HOME_URL="http://www.debian.org/" SUPPORT_URL="http://www.debian.org/support" BUG_REPORT_URL="https://bugs.debian.org/" VOLUMIO_BUILD_VERSION="168ba7444df98cd868db72f24faec0b6346489cc" VOLUMIO_FE_VERSION="847a48ecf32d35cc502a0053d585d1a69236e391" VOLUMIO_BE_VERSION="99dfb342fe07851f1e26bd1d8046d0234eda91dd" VOLUMIO_ARCH="armv7" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Fri Dec 11 15:53:56 CET 2020" VOLUMIO_VERSION="2.857" VOLUMIO_HARDWARE="aml9xxxarmv7" VOLUMIO_HASH="5e595833ee6075a27fef1ba35f928abb"