-- Logs begin at Sun 2025-04-13 14:00:47 UTC, end at Mon 2025-04-14 13:32:19 UTC. -- Apr 14 13:31:19 volumio volumio[1132]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Apr 14 13:31:19 volumio volumio[1132]: { Error: connect ETIMEDOUT 103.228.130.27:443 Apr 14 13:31:19 volumio volumio[1132]: at Object._errnoException (util.js:1022:11) Apr 14 13:31:19 volumio volumio[1132]: at _exceptionWithHostPort (util.js:1044:20) Apr 14 13:31:19 volumio volumio[1132]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1198:14) Apr 14 13:31:19 volumio volumio[1132]: code: 'ETIMEDOUT', Apr 14 13:31:19 volumio volumio[1132]: errno: 'ETIMEDOUT', Apr 14 13:31:19 volumio volumio[1132]: syscall: 'connect', Apr 14 13:31:19 volumio volumio[1132]: address: '103.228.130.27', Apr 14 13:31:19 volumio volumio[1132]: port: 443 } Apr 14 13:31:19 volumio volumio[1132]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Apr 14 13:31:20 volumio sudo[3162]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-04-14 13:30 Apr 14 13:31:20 volumio sudo[3162]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 14 13:31:20 volumio sudo[3162]: pam_unix(sudo:session): session closed for user root Apr 14 13:31:24 volumio volumio-remote-updater[638]: [2025-04-14 13:31:24] [error] handle_read_frame error: websocketpp.transport:7 (End of File) Apr 14 13:31:24 volumio volumio-remote-updater[638]: [2025-04-14 13:31:24] [disconnect] Disconnect close local:[1006,End of File] remote:[1006] Apr 14 13:31:24 volumio systemd[1]: volumio.service: main process exited, code=exited, status=1/FAILURE Apr 14 13:31:24 volumio systemd[1]: Unit volumio.service entered failed state. Apr 14 13:31:24 volumio systemd[1]: Starting dynamicswap service... Apr 14 13:31:24 volumio systemd[1]: Started dynamicswap service. Apr 14 13:31:24 volumio systemd[1]: volumio.service holdoff time over, scheduling restart. Apr 14 13:31:24 volumio systemd[1]: Starting dynamicswap service... Apr 14 13:31:24 volumio systemd[1]: Started dynamicswap service. Apr 14 13:31:24 volumio systemd[1]: Stopping Volumio Backend Module... Apr 14 13:31:24 volumio systemd[1]: Starting Volumio Backend Module... Apr 14 13:31:24 volumio systemd[1]: Started Volumio Backend Module. Apr 14 13:31:25 volumio volumio[3188]: info: ------------------------------------------- Apr 14 13:31:25 volumio volumio[3188]: info: ----- Volumio2 ---- Apr 14 13:31:25 volumio volumio[3188]: info: ------------------------------------------- Apr 14 13:31:25 volumio volumio[3188]: info: ----- System startup ---- Apr 14 13:31:25 volumio volumio[3188]: info: ------------------------------------------- Apr 14 13:31:25 volumio volumio[3188]: info: MYVOLUMIO Environment detected Apr 14 13:31:26 volumio volumio[3188]: info: Plugin folders cleanup Apr 14 13:31:26 volumio volumio[3188]: info: Scanning into folder /volumio/app/plugins/ Apr 14 13:31:26 volumio volumio[3188]: info: Scanning category audio_interface Apr 14 13:31:26 volumio volumio[3188]: info: Scanning category miscellanea Apr 14 13:31:26 volumio volumio[3188]: info: Scanning category music_service Apr 14 13:31:26 volumio volumio[3188]: info: Scanning category plugins.json Apr 14 13:31:26 volumio volumio[3188]: info: Scanning category system_controller Apr 14 13:31:26 volumio volumio[3188]: info: Scanning category user_interface Apr 14 13:31:26 volumio volumio[3188]: info: Scanning into folder /data/plugins/ Apr 14 13:31:26 volumio volumio[3188]: info: Scanning category miscellanea Apr 14 13:31:26 volumio volumio[3188]: info: Plugin folders cleanup completed Apr 14 13:31:26 volumio volumio[3188]: info: ------------------------------------------- Apr 14 13:31:26 volumio volumio[3188]: info: ----- Core plugins startup ---- Apr 14 13:31:26 volumio volumio[3188]: info: ------------------------------------------- Apr 14 13:31:26 volumio volumio[3188]: info: Loading plugins from folder /volumio/app/plugins/ Apr 14 13:31:26 volumio volumio[3188]: info: Adding plugin upnp to MyMusic Plugins Apr 14 13:31:26 volumio volumio[3188]: info: Adding plugin airplay_emulation to MyMusic Plugins Apr 14 13:31:26 volumio volumio[3188]: info: Adding plugin upnp_browser to MyMusic Plugins Apr 14 13:31:26 volumio volumio[3188]: info: Loading plugins from folder /data/plugins/ Apr 14 13:31:26 volumio volumio[3188]: info: Loading plugin "system"... Apr 14 13:31:26 volumio volumio[3188]: info: Loading plugin "appearance"... Apr 14 13:31:27 volumio volumio[3188]: info: Loading plugin "network"... Apr 14 13:31:27 volumio volumio[3188]: info: Refreshing Cached IP Addresses Apr 14 13:31:27 volumio sudo[3214]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Apr 14 13:31:27 volumio volumio[3188]: info: Loading plugin "touch_display"... Apr 14 13:31:27 volumio sudo[3214]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 14 13:31:27 volumio sudo[3214]: pam_unix(sudo:session): session closed for user root Apr 14 13:31:27 volumio sudo[3217]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Apr 14 13:31:27 volumio sudo[3217]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 14 13:31:27 volumio sudo[3217]: pam_unix(sudo:session): session closed for user root Apr 14 13:31:27 volumio volumio[3188]: info: Applying required configuration parameters for plugin touch_display Apr 14 13:31:27 volumio volumio[3188]: info: Loading plugin "services"... Apr 14 13:31:27 volumio volumio[3188]: info: Loading plugin "alsa_controller"... Apr 14 13:31:27 volumio volumio[3188]: info: Loading plugin "wizard"... Apr 14 13:31:27 volumio volumio[3188]: info: Loading plugin "volumio_command_line_client"... Apr 14 13:31:27 volumio volumio[3188]: info: Loading plugin "upnp"... Apr 14 13:31:27 volumio volumio[3188]: info: [1744637487687] Starting Upmpd Daemon Apr 14 13:31:27 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Apr 14 13:31:27 volumio volumio[3188]: info: Loading plugin "my_music"... Apr 14 13:31:27 volumio volumio[3188]: info: Loading plugin "mpd"... Apr 14 13:31:27 volumio volumio[3188]: info: Loading plugin "upnp_browser"... Apr 14 13:31:28 volumio volumio[3188]: info: Loading plugin "networkfs"... Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Apr 14 13:31:28 volumio volumio[3188]: info: Loading plugin "alarm-clock"... Apr 14 13:31:28 volumio volumio[3188]: info: Loading plugin "airplay_emulation"... Apr 14 13:31:28 volumio volumio[3188]: info: Starting Shairport Sync Apr 14 13:31:28 volumio volumio[3188]: info: Loading plugin "last_100"... Apr 14 13:31:28 volumio volumio[3188]: info: Loading plugin "webradio"... Apr 14 13:31:28 volumio volumio[3188]: info: Loading plugin "i2s_dacs"... Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 14 13:31:28 volumio volumio[3188]: info: Loading plugin "volumiodiscovery"... Apr 14 13:31:28 volumio volumio[3188]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Apr 14 13:31:28 volumio node[3188]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Apr 14 13:31:28 volumio node[3188]: *** WARNING *** Please fix your application to use the native API of Avahi! Apr 14 13:31:28 volumio node[3188]: *** WARNING *** For more information see Apr 14 13:31:28 volumio node[3188]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Apr 14 13:31:28 volumio node[3188]: *** WARNING *** Please fix your application to use the native API of Avahi! Apr 14 13:31:28 volumio node[3188]: *** WARNING *** For more information see Apr 14 13:31:28 volumio volumio[3188]: *** WARNING *** Please fix your application to use the native API of Avahi! Apr 14 13:31:28 volumio volumio[3188]: *** WARNING *** For more information see Apr 14 13:31:28 volumio volumio[3188]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Apr 14 13:31:28 volumio volumio[3188]: *** WARNING *** Please fix your application to use the native API of Avahi! Apr 14 13:31:28 volumio volumio[3188]: *** WARNING *** For more information see Apr 14 13:31:28 volumio volumio[3188]: info: Applying required configuration parameters for plugin volumiodiscovery Apr 14 13:31:28 volumio volumio[3188]: Discovery: StartAdv! undefined Apr 14 13:31:28 volumio volumio[3188]: Discovery: Started advertising... Volumio - undefined Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Apr 14 13:31:28 volumio volumio[3188]: info: Plugin now_playing is not enabled Apr 14 13:31:28 volumio volumio[3188]: info: Loading plugin "outputs"... Apr 14 13:31:28 volumio volumio[3188]: info: Loading plugin "albumart"... Apr 14 13:31:28 volumio volumio[3188]: info: Plugin example_plugin is not enabled Apr 14 13:31:28 volumio volumio[3188]: info: Loading plugin "inputs"... Apr 14 13:31:28 volumio volumio[3188]: info: Loading plugin "updater_comm"... Apr 14 13:31:28 volumio volumio[3188]: info: Plugin mpdemulation is not enabled Apr 14 13:31:28 volumio volumio[3188]: info: Loading plugin "rest_api"... Apr 14 13:31:28 volumio volumio[3188]: info: Loading plugin "websocket"... Apr 14 13:31:28 volumio volumio[3188]: info: ___________ START PLUGINS ___________ Apr 14 13:31:28 volumio volumio[3188]: info: Loading i18n strings for locale zh Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Apr 14 13:31:28 volumio volumio[3188]: info: [1744637488707] CoreMusicLibrary::Adding element Media Servers Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Apr 14 13:31:28 volumio sudo[3249]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl daemon-reload Apr 14 13:31:28 volumio sudo[3249]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 14 13:31:28 volumio systemd[1]: Reloading. Apr 14 13:31:28 volumio volumio[3188]: Forking 3 albumart workers Apr 14 13:31:28 volumio volumio[3188]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Apr 14 13:31:28 volumio systemd[1]: [/lib/systemd/system/mpd.service:18] Unknown lvalue 'ProtectKernelTunables' in section 'Service' Apr 14 13:31:28 volumio systemd[1]: [/lib/systemd/system/mpd.service:19] Unknown lvalue 'ProtectControlGroups' in section 'Service' Apr 14 13:31:28 volumio systemd[1]: [/lib/systemd/system/mpd.service:20] Unknown lvalue 'ProtectKernelModules' in section 'Service' Apr 14 13:31:28 volumio systemd[1]: [/lib/systemd/system/mpd.service:23] Unknown lvalue 'RestrictNamespaces' in section 'Service' Apr 14 13:31:28 volumio volumio[3188]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Apr 14 13:31:28 volumio volumio[3188]: info: [1744637488869] CoreMusicLibrary::Adding element Last_100 Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Apr 14 13:31:28 volumio volumio[3188]: info: [1744637488875] CoreMusicLibrary::Adding element Webradio Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Apr 14 13:31:28 volumio volumio[3188]: info: ------------------------------------------- Apr 14 13:31:28 volumio sudo[3249]: pam_unix(sudo:session): session closed for user root Apr 14 13:31:28 volumio volumio[3188]: info: ----- MyVolumio plugins startup ---- Apr 14 13:31:28 volumio volumio[3188]: info: ------------------------------------------- Apr 14 13:31:28 volumio volumio[3188]: info: [MyVolumio PluginManager] Fetching plans data.... Apr 14 13:31:28 volumio volumio[3188]: info: Loading i18n strings for locale zh Apr 14 13:31:28 volumio volumio[3188]: Updating browse sources language Apr 14 13:31:28 volumio volumio[3188]: Cannot find translation for sourceMedia Servers Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::initPlayerControls Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getAlsaCards Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 14 13:31:28 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 14 13:31:29 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 14 13:31:29 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 14 13:31:29 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Apr 14 13:31:29 volumio volumio[3188]: info: BOOT COMPLETED Apr 14 13:31:29 volumio volumio[3188]: [Metrics] CommandRouter: 3s 483.32ms Apr 14 13:31:29 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 14 13:31:29 volumio volumio[3188]: aplay: main:722: audio open error: Device or resource busy Apr 14 13:31:29 volumio volumio[3188]: Cannot play startup sound Apr 14 13:31:29 volumio volumio[3188]: info: CoreCommandRouter::Close All Modals sent Apr 14 13:31:29 volumio volumio[3188]: info: CoreCommandRouter::Close All Modals sent Apr 14 13:31:29 volumio volumio[3188]: Express server listening on port 3000 Apr 14 13:31:29 volumio volumio[3188]: [Metrics] WebUI: 3s 826.77ms Apr 14 13:31:29 volumio volumio[3188]: Volumio Calling Home Apr 14 13:31:29 volumio volumio[3188]: info: CoreStateMachine::resetVolumioState Apr 14 13:31:29 volumio volumio[3188]: info: CoreStateMachine::getcurrentVolume Apr 14 13:31:29 volumio volumio[3188]: info: CoreCommandRouter::volumioRetrievevolume Apr 14 13:31:29 volumio volumio-remote-updater[638]: [2025-04-14 13:31:29] [connect] Successful connection Apr 14 13:31:29 volumio volumio[3188]: Starting albumart workers Apr 14 13:31:29 volumio volumio[3188]: Starting albumart workers Apr 14 13:31:29 volumio volumio[3188]: info: Setting Device type: Raspberry PI Apr 14 13:31:29 volumio volumio[3188]: info: touch_display: systemctl daemon-reload succeeded. Apr 14 13:31:29 volumio volumio[3188]: Starting albumart workers Apr 14 13:31:29 volumio volumio[3188]: info: MPD running with PID716 Apr 14 13:31:29 volumio volumio[3188]: ,establishing connection Apr 14 13:31:29 volumio sudo[3305]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start volumio-kiosk.service Apr 14 13:31:29 volumio sudo[3305]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 14 13:31:29 volumio systemd[1]: Started Volumio Kiosk. Apr 14 13:31:29 volumio sudo[3305]: pam_unix(sudo:session): session closed for user root Apr 14 13:31:29 volumio volumio-remote-updater[638]: [2025-04-14 13:31:29] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.5.1" /socket.io/?EIO=4&transport=websocket&t=1744637489 101 Apr 14 13:31:29 volumio volumio[3188]: info: VolumeController:: Volume=100 Mute =false Apr 14 13:31:29 volumio volumio[3188]: info: CoreStateMachine::pushState Apr 14 13:31:29 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:29 volumio volumio[3188]: info: CoreCommandRouter::volumioPushState Apr 14 13:31:29 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 14 13:31:29 volumio volumio[3188]: info: CoreStateMachine::updateTrackBlock Apr 14 13:31:29 volumio volumio[3188]: info: CorePlayQueue::getTrackBlock Apr 14 13:31:29 volumio volumio[3188]: info: CoreCommandRouter::volumioRetrievevolume Apr 14 13:31:29 volumio volumio[3188]: info: touch_display: systemctl start volumio-kiosk.service succeeded. Apr 14 13:31:29 volumio volumio[3188]: info: touch_display: Volumio Kiosk started Apr 14 13:31:29 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 14 13:31:29 volumio volumio[3188]: info: CoreCommandRouter::volumioGetState Apr 14 13:31:29 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:29 volumio volumio[3188]: info: Reloading queue from file Apr 14 13:31:29 volumio volumio[3188]: error: updateQueue error: null Apr 14 13:31:30 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkAudioDeviceAvailable Apr 14 13:31:30 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Apr 14 13:31:30 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: system , versionChangeDetect Apr 14 13:31:30 volumio volumio[3188]: info: CoreStateMachine::setRepeat false single undefined Apr 14 13:31:30 volumio volumio[3188]: info: CoreStateMachine::pushState Apr 14 13:31:30 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:30 volumio volumio[3188]: info: CoreCommandRouter::volumioPushState Apr 14 13:31:30 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 14 13:31:30 volumio volumio[3188]: info: CoreStateMachine::setRandom undefined Apr 14 13:31:30 volumio volumio[3188]: info: CoreStateMachine::pushState Apr 14 13:31:30 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:30 volumio volumio[3188]: info: CoreCommandRouter::volumioPushState Apr 14 13:31:30 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 14 13:31:30 volumio volumio[3188]: info: touch_display: Using Xserver unix domain socket /tmp/.X11-unix/X0 Apr 14 13:31:30 volumio volumio[3188]: info: CoreCommandRouter::volumioGetState Apr 14 13:31:30 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:30 volumio volumio[3188]: info: VolumeController:: Volume=100 Mute =false Apr 14 13:31:30 volumio volumio[3188]: info: CoreStateMachine::pushState Apr 14 13:31:30 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:30 volumio volumio[3188]: info: CoreCommandRouter::volumioPushState Apr 14 13:31:30 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 14 13:31:30 volumio volumio[3188]: info: Starting Shairport Sync Apr 14 13:31:30 volumio volumio[3188]: info: Starting Shairport Sync Apr 14 13:31:30 volumio sudo[3345]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Apr 14 13:31:30 volumio sudo[3345]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 14 13:31:30 volumio sudo[3347]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Apr 14 13:31:30 volumio systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Apr 14 13:31:30 volumio sudo[3347]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 14 13:31:30 volumio shairport-sync[1326]: {"time":1744636902345,"response":"startAirplayPlayback Success"} Apr 14 13:31:30 volumio systemd[1]: Starting Shairport Sync - AirPlay Audio Receiver... Apr 14 13:31:30 volumio systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Apr 14 13:31:30 volumio sudo[3345]: pam_unix(sudo:session): session closed for user root Apr 14 13:31:30 volumio volumio[3188]: info: touch_display: Using Xserver unix domain socket /tmp/.X11-unix/X0 Apr 14 13:31:30 volumio volumio[3188]: info: touch_display: Raspberry Pi Foundation touch screen detected. Apr 14 13:31:30 volumio volumio[3188]: info: touch_display: Backlight module of a Raspberry Pi Foundation touch screen detected. Apr 14 13:31:30 volumio volumio[3188]: info: touch_display: Setting screensaver timeout to 120 seconds. Apr 14 13:31:30 volumio sudo[3373]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/sed -i -e /Option "TransformationMatrix"/d /etc/X11/xorg.conf.d/95-touch_display-plugin.conf Apr 14 13:31:30 volumio sudo[3373]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 14 13:31:30 volumio volumio[3188]: info: Shairport-Sync Started Apr 14 13:31:30 volumio systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Apr 14 13:31:30 volumio volumio[3188]: Error adding Membership: Error: addMembership EINVAL Apr 14 13:31:30 volumio systemd[1]: Starting Shairport Sync - AirPlay Audio Receiver... Apr 14 13:31:30 volumio sudo[3373]: pam_unix(sudo:session): session closed for user root Apr 14 13:31:30 volumio systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Apr 14 13:31:30 volumio sudo[3347]: pam_unix(sudo:session): session closed for user root Apr 14 13:31:30 volumio volumio[3188]: info: CoreCommandRouter::volumioGetState Apr 14 13:31:30 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:30 volumio volumio[3188]: info: Shairport-Sync Started Apr 14 13:31:30 volumio volumio[3188]: info: touch_display: Touchscreen transformation matrix removed. Apr 14 13:31:30 volumio sudo[3399]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod a+w /sys/devices/platform/rpi_backlight/backlight/rpi_backlight/brightness Apr 14 13:31:30 volumio sudo[3399]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 14 13:31:30 volumio sudo[3399]: pam_unix(sudo:session): session closed for user root Apr 14 13:31:30 volumio volumio[3188]: info: touch_display: File permissions for backlight brightness control set. Apr 14 13:31:31 volumio volumio[3188]: info: CoreCommandRouter::volumioGetState Apr 14 13:31:31 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:32 volumio volumio[3188]: info: CoreCommandRouter::volumioGetState Apr 14 13:31:32 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:32 volumio volumio[3188]: An internal error occurred while serving an albumart. Details: Error: ENOENT: no such file or directory, stat '/data/albumart/web/%E8%94%A1%E7%90%B4/%E6%B0%91%E6%AD%8C%E8%94%A1%E7%90%B4/16fd929d-e188-4d3e-95f9-50859f4b6207.jpg' Apr 14 13:31:32 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Apr 14 13:31:32 volumio volumio[3188]: info: CoreCommandRouter::volumioGetVisibleSources Apr 14 13:31:32 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Apr 14 13:31:32 volumio volumio[3188]: info: Listing playlists Apr 14 13:31:32 volumio volumio[3188]: Discovery: adding 2af75933-02d1-438a-a787-9576259bacaa Apr 14 13:31:32 volumio volumio[3188]: info: mDNS: Found device Volumio Apr 14 13:31:32 volumio volumio[3188]: info: CoreCommandRouter::volumioGetState Apr 14 13:31:32 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:32 volumio volumio[3188]: info: Volumio called home Apr 14 13:31:33 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 14 13:31:33 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Apr 14 13:31:37 volumio sudo[3424]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Apr 14 13:31:37 volumio sudo[3424]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 14 13:31:37 volumio sudo[3424]: pam_unix(sudo:session): session closed for user root Apr 14 13:31:37 volumio sudo[3427]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Apr 14 13:31:37 volumio sudo[3427]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 14 13:31:37 volumio sudo[3427]: pam_unix(sudo:session): session closed for user root Apr 14 13:31:37 volumio sudo[3435]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service Apr 14 13:31:37 volumio sudo[3435]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 14 13:31:37 volumio systemd[1]: Started UPnP Renderer front-end to MPD. Apr 14 13:31:37 volumio sudo[3435]: pam_unix(sudo:session): session closed for user root Apr 14 13:31:37 volumio volumio[3188]: info: Upmpdcli Daemon Started Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan premium Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan premium Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan premium Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan premium Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan premium Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan premium Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan premium Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin tidal to plan premium Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan premium Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan premium Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan superstar Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin multiroom to plan superstar Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin metavolumio to plan superstar Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan superstar Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan superstar Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin smart_inputs to plan superstar Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin hi_res_audio to plan superstar Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin tidal to plan superstar Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan superstar Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan superstar Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin bluetooth to plan virtuoso Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin manifestui to plan virtuoso Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin cd_controller to plan virtuoso Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin tidal to plan virtuoso Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin qobuz to plan virtuoso Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Adding plugin tidalconnect to plan virtuoso Apr 14 13:31:39 volumio volumio[3188]: info: Adding plugin bluetooth to MyMusic Plugins Apr 14 13:31:39 volumio volumio[3188]: info: Adding plugin cd_controller to MyMusic Plugins Apr 14 13:31:39 volumio volumio[3188]: info: Adding plugin smart_inputs to MyMusic Plugins Apr 14 13:31:39 volumio volumio[3188]: info: Adding plugin tidalconnect to MyMusic Plugins Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Loading plugin "my_volumio"... Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Loading plugin "streaming_services"... Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] MyVolumio plugin successfully loaded Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Starting plugin system_controller.my_volumio Apr 14 13:31:39 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 14 13:31:39 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 14 13:31:39 volumio volumio[3188]: info: Starting MyVolumio Remote Streaming Endpoints Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Streaming Services plugin successfully loaded Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] Starting plugin music_service.streaming_services Apr 14 13:31:39 volumio volumio[3188]: info: Streaming services startup Apr 14 13:31:39 volumio volumio[3188]: info: Starting Streaming Daemon Apr 14 13:31:39 volumio sudo[3453]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Apr 14 13:31:39 volumio sudo[3453]: pam_unix(sudo:session): session opened for user root by (uid=0) Apr 14 13:31:39 volumio systemd[1]: Stopping Volumio Streaming Daemon... Apr 14 13:31:39 volumio volumio[3188]: info: MyVolumio not started Apr 14 13:31:39 volumio volumio[3188]: info: Initializing device activation check Apr 14 13:31:39 volumio systemd[1]: Starting Volumio Streaming Daemon... Apr 14 13:31:39 volumio systemd[1]: Started Volumio Streaming Daemon. Apr 14 13:31:39 volumio volumio[3188]: info: [MyVolumio PluginManager] MyVolumio plugin successfully started Apr 14 13:31:39 volumio sudo[3453]: pam_unix(sudo:session): session closed for user root Apr 14 13:31:39 volumio volumio-streaming-daemon[3463]: ############################ Apr 14 13:31:39 volumio volumio-streaming-daemon[3463]: # Volumio Streaming Daemon # Apr 14 13:31:39 volumio volumio-streaming-daemon[3463]: # Running on port 7777 # Apr 14 13:31:39 volumio volumio-streaming-daemon[3463]: ############################ Apr 14 13:31:39 volumio volumio-streaming-daemon[3463]: Environment: production Apr 14 13:31:40 volumio volumio[3188]: info: CoreCommandRouter::servicePushState Apr 14 13:31:40 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:40 volumio volumio[3188]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current mpd Received airplay_emulation Apr 14 13:31:40 volumio volumio[3188]: info: CoreCommandRouter::servicePushState Apr 14 13:31:40 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:40 volumio volumio[3188]: info: Received update from a service different from the one supposed to be playing music. Skipping notification.Current mpd Received airplay_emulation Apr 14 13:31:40 volumio shairport-sync[3383]: Failed to create secure directory (/home/shairport-sync/.config/pulse): No such file or directory Apr 14 13:31:40 volumio kernel: pcm512x 1-004d: No SCLK, using BCLK: -2 Apr 14 13:31:40 volumio shairport-sync[3383]: % Total % Received % Xferd Average Speed Time Time Time Current Apr 14 13:31:40 volumio shairport-sync[3383]: Dload Upload Total Spent Left Speed Apr 14 13:31:40 volumio shairport-sync[3383]: 0 0 0 0 0 0 0 0 --:--:-- --:--:-- --:--:-- 0 % Total % Received % Xferd Average Speed Time Time Time Current Apr 14 13:31:40 volumio shairport-sync[3383]: Dload Upload Total Spent Left Speed Apr 14 13:31:40 volumio volumio[3188]: info: Apr 14 13:31:40 volumio volumio[3188]: ---------------------------- Client requests Start Airplay PlaybackRoutine Apr 14 13:31:40 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: airplay_emulation , startAirplayPlayback Apr 14 13:31:40 volumio volumio[3188]: info: Airplay playback start Apr 14 13:31:40 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:40 volumio volumio[3188]: info: CoreCommandRouter::volumioStop Apr 14 13:31:40 volumio volumio[3188]: info: CoreStateMachine::stop Apr 14 13:31:40 volumio volumio[3188]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 14 13:31:40 volumio volumio[3188]: UNSET VOLATILE Apr 14 13:31:40 volumio volumio[3188]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 14 13:31:40 volumio shairport-sync[3383]: [155B blob data] Apr 14 13:31:40 volumio volumio[3188]: info: Airplay started streaming, receiving metadatas Apr 14 13:31:40 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:40 volumio volumio[3188]: info: CoreCommandRouter::volumioStop Apr 14 13:31:40 volumio volumio[3188]: info: CoreStateMachine::stop Apr 14 13:31:40 volumio volumio[3188]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 14 13:31:40 volumio volumio[3188]: UNSET VOLATILE Apr 14 13:31:40 volumio volumio[3188]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 14 13:31:40 volumio volumio[3188]: info: Airplay started streaming, receiving metadatas Apr 14 13:31:40 volumio volumio[3188]: info: CorePlayQueue::getTrack 0 Apr 14 13:31:40 volumio volumio[3188]: info: CoreCommandRouter::volumioStop Apr 14 13:31:40 volumio volumio[3188]: info: CoreStateMachine::stop Apr 14 13:31:40 volumio volumio[3188]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 14 13:31:40 volumio volumio[3188]: UNSET VOLATILE Apr 14 13:31:40 volumio volumio[3188]: info: CoreStateMachine::setConsumeUpdateService undefined Apr 14 13:31:40 volumio volumio[3188]: info: Apr 14 13:31:40 volumio volumio[3188]: ---------------------------- Client requests AirplayActive Apr 14 13:31:40 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: airplay_emulation , setAirplayActive Apr 14 13:31:40 volumio shairport-sync[3383]: [143B blob data] Apr 14 13:31:40 volumio kernel: pcm512x 1-004d: No SCLK, using BCLK: -2 Apr 14 13:31:40 volumio kernel: pcm512x 1-004d: No SCLK, using BCLK: -2 Apr 14 13:31:41 volumio volumio[3188]: info: CoreCommandRouter::servicePushState Apr 14 13:31:41 volumio volumio[3188]: info: CoreStateMachine::pushState Apr 14 13:31:41 volumio volumio[3188]: info: CoreCommandRouter::volumioPushState Apr 14 13:31:41 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 14 13:31:41 volumio volumio[3188]: info: CoreCommandRouter::servicePushState Apr 14 13:31:41 volumio volumio[3188]: info: CoreStateMachine::pushState Apr 14 13:31:41 volumio volumio[3188]: info: CoreCommandRouter::volumioPushState Apr 14 13:31:41 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 14 13:31:41 volumio volumio[3188]: info: CoreCommandRouter::servicePushState Apr 14 13:31:41 volumio volumio[3188]: info: CoreStateMachine::pushState Apr 14 13:31:41 volumio volumio[3188]: info: CoreCommandRouter::volumioPushState Apr 14 13:31:41 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 14 13:31:41 volumio volumio[3188]: info: touch_display: Setting screensaver timeout to 0 seconds. Apr 14 13:31:42 volumio volumio-streaming-daemon[3463]: Environment: production Apr 14 13:31:42 volumio volumio[3188]: info: Fetching Streaming Services browse cache Apr 14 13:31:42 volumio volumio[3188]: info: CoreCommandRouter::servicePushState Apr 14 13:31:42 volumio volumio[3188]: info: CoreStateMachine::pushState Apr 14 13:31:42 volumio volumio[3188]: info: CoreCommandRouter::volumioPushState Apr 14 13:31:42 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 14 13:31:42 volumio volumio[3188]: info: CoreCommandRouter::servicePushState Apr 14 13:31:42 volumio volumio[3188]: info: CoreStateMachine::pushState Apr 14 13:31:42 volumio volumio[3188]: info: CoreCommandRouter::volumioPushState Apr 14 13:31:42 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 14 13:31:42 volumio volumio[3188]: info: CoreCommandRouter::servicePushState Apr 14 13:31:42 volumio volumio[3188]: info: CoreStateMachine::pushState Apr 14 13:31:42 volumio volumio[3188]: info: CoreCommandRouter::volumioPushState Apr 14 13:31:42 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 14 13:31:42 volumio volumio[3188]: info: CoreCommandRouter::servicePushState Apr 14 13:31:42 volumio volumio[3188]: info: CoreStateMachine::pushState Apr 14 13:31:42 volumio volumio[3188]: info: CoreCommandRouter::volumioPushState Apr 14 13:31:42 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Apr 14 13:31:58 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Apr 14 13:31:58 volumio volumio[3188]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Apr 14 13:32:19 volumio volumio[3188]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Apr 14 13:32:19 volumio volumio[3188]: { Error: connect ETIMEDOUT 104.16.252.55:80 Apr 14 13:32:19 volumio volumio[3188]: at Object._errnoException (util.js:1022:11) Apr 14 13:32:19 volumio volumio[3188]: at _exceptionWithHostPort (util.js:1044:20) Apr 14 13:32:19 volumio volumio[3188]: at TCPConnectWrap.afterConnect [as oncomplete] (net.js:1198:14) Apr 14 13:32:19 volumio volumio[3188]: code: 'ETIMEDOUT', Apr 14 13:32:19 volumio volumio[3188]: errno: 'ETIMEDOUT', Apr 14 13:32:19 volumio volumio[3188]: syscall: 'connect', Apr 14 13:32:19 volumio volumio[3188]: address: '104.16.252.55', Apr 14 13:32:19 volumio volumio[3188]: port: 80 } Apr 14 13:32:19 volumio volumio[3188]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Apr 14 13:32:19 volumio sudo[3599]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-04-14 13:31 Apr 14 13:32:19 volumio sudo[3599]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Raspbian GNU/Linux 8 (jessie)" NAME="Raspbian GNU/Linux" VERSION_ID="8" VERSION="8 (jessie)" 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="14acf028cf46278bd3fd3dd02523424a9bc825bf" VOLUMIO_FE_VERSION="74f64fbba9dc8053dc27ed7125863d6ad6533965" VOLUMIO_BE_VERSION="0a6008ded215bf284d5d4cd9c4df3333cb320899" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Sat Apr 24 17:39:58 CEST 2021" VOLUMIO_VERSION="2.882" VOLUMIO_HARDWARE="pi" VOLUMIO_HASH="1a98a01eef5aa5927a5874c2d3c1b0dc"