-- Logs begin at Thu 2019-02-14 12:11:59 EET, end at Wed 2026-02-25 13:19:52 EET. --
Feb 25 13:19:38 volumio systemd-timedated[923]: Changed local time to Wed Feb 25 13:19:38 2026
Feb 25 13:19:38 volumio sudo[921]: pam_unix(sudo:session): session closed for user root
Feb 25 13:19:38 volumio volumio-time-update[522]: volumio-time-update-util: System time updated successfully.
Feb 25 13:19:38 volumio systemd[1]: Starting Daily apt download activities...
Feb 25 13:19:38 volumio systemd[1]: Started Volumio Time Update Utility.
Feb 25 13:19:38 volumio volumio[884]: info: -------------------------------------------
Feb 25 13:19:38 volumio volumio[884]: info: ----- Volumio3 ----
Feb 25 13:19:38 volumio volumio[884]: info: -------------------------------------------
Feb 25 13:19:38 volumio volumio[884]: info: ----- System startup ----
Feb 25 13:19:38 volumio volumio[884]: info: -------------------------------------------
Feb 25 13:19:40 volumio volumio[884]: info: MYVOLUMIO Environment detected
Feb 25 13:19:40 volumio volumio[884]: info: Plugin folders cleanup
Feb 25 13:19:40 volumio volumio[884]: info: Scanning into folder /volumio/app/plugins/
Feb 25 13:19:40 volumio volumio[884]: info: Scanning category audio_interface
Feb 25 13:19:40 volumio volumio[884]: info: Scanning category miscellanea
Feb 25 13:19:40 volumio volumio[884]: info: Scanning category music_service
Feb 25 13:19:40 volumio volumio[884]: info: Scanning category plugins.json
Feb 25 13:19:40 volumio volumio[884]: info: Scanning category system_controller
Feb 25 13:19:40 volumio volumio[884]: info: Scanning category user_interface
Feb 25 13:19:40 volumio volumio[884]: info: Scanning into folder /data/plugins/
Feb 25 13:19:40 volumio volumio[884]: info: Scanning category system_hardware
Feb 25 13:19:40 volumio volumio[884]: info: Plugin folders cleanup completed
Feb 25 13:19:40 volumio volumio[884]: info: -------------------------------------------
Feb 25 13:19:40 volumio volumio[884]: info: ----- Core plugins startup ----
Feb 25 13:19:40 volumio volumio[884]: info: -------------------------------------------
Feb 25 13:19:40 volumio volumio[884]: info: Loading plugins from folder /volumio/app/plugins/
Feb 25 13:19:40 volumio volumio[884]: info: Adding plugin upnp to MyMusic Plugins
Feb 25 13:19:40 volumio volumio[884]: info: Adding plugin airplay_emulation to MyMusic Plugins
Feb 25 13:19:40 volumio volumio[884]: info: Adding plugin upnp_browser to MyMusic Plugins
Feb 25 13:19:40 volumio volumio[884]: info: Loading plugins from folder /data/plugins/
Feb 25 13:19:40 volumio volumio[884]: info: Loading plugin "system"...
Feb 25 13:19:41 volumio volumio[884]: info: Loading plugin "appearance"...
Feb 25 13:19:42 volumio systemd[1]: apt-daily.service: Succeeded.
Feb 25 13:19:42 volumio systemd[1]: Started Daily apt download activities.
Feb 25 13:19:42 volumio systemd[1]: Starting Daily apt upgrade and clean activities...
Feb 25 13:19:43 volumio volumio[884]: info: Loading plugin "network"...
Feb 25 13:19:43 volumio volumio[884]: info: Refreshing Cached IP Addresses
Feb 25 13:19:43 volumio volumio[884]: info: Loading plugin "services"...
Feb 25 13:19:43 volumio volumio[884]: info: Loading plugin "alsa_controller"...
Feb 25 13:19:43 volumio sudo[1008]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0
Feb 25 13:19:43 volumio sudo[1010]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0
Feb 25 13:19:43 volumio sudo[1008]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:43 volumio sudo[1010]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:43 volumio sudo[1010]: pam_unix(sudo:session): session closed for user root
Feb 25 13:19:43 volumio sudo[1013]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan
Feb 25 13:19:43 volumio sudo[1013]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:43 volumio sudo[1008]: pam_unix(sudo:session): session closed for user root
Feb 25 13:19:43 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Feb 25 13:19:43 volumio volumio[884]: info: Loading plugin "wizard"...
Feb 25 13:19:43 volumio volumio[884]: info: Loading plugin "networkfs"...
Feb 25 13:19:43 volumio volumio[884]: info: Starting Udev Watcher for removable devices
Feb 25 13:19:43 volumio volumio[884]: info: Ignoring mount for partition: boot
Feb 25 13:19:43 volumio volumio[884]: info: Ignoring mount for partition: volumio
Feb 25 13:19:43 volumio volumio[884]: info: Ignoring mount for partition: volumio_data
Feb 25 13:19:43 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback
Feb 25 13:19:43 volumio volumio[884]: info: Loading plugin "volumio_command_line_client"...
Feb 25 13:19:43 volumio volumio[884]: info: Loading plugin "upnp"...
Feb 25 13:19:43 volumio volumio[884]: info: [1772018383587] Starting Upmpd Daemon
Feb 25 13:19:43 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback
Feb 25 13:19:43 volumio volumio[884]: info: Loading plugin "my_music"...
Feb 25 13:19:43 volumio volumio[884]: info: Loading plugin "mpd"...
Feb 25 13:19:44 volumio sudo[1013]: pam_unix(sudo:session): session closed for user root
Feb 25 13:19:44 volumio volumio[884]: info: Loading plugin "upnp_browser"...
Feb 25 13:19:44 volumio systemd[1]: apt-daily-upgrade.service: Succeeded.
Feb 25 13:19:44 volumio systemd[1]: Started Daily apt upgrade and clean activities.
Feb 25 13:19:44 volumio volumio-remote-updater[521]: [2026-02-25 13:19:44] [connect] Successful connection
Feb 25 13:19:44 volumio volumio[884]: info: Starting UPNP Browser
Feb 25 13:19:44 volumio volumio[884]: info: Loading plugin "alarm-clock"...
Feb 25 13:19:45 volumio volumio[884]: info: Loading plugin "airplay_emulation"...
Feb 25 13:19:45 volumio volumio[884]: info: Starting Shairport Sync
Feb 25 13:19:45 volumio volumio[884]: info: Loading plugin "last_100"...
Feb 25 13:19:45 volumio volumio[884]: info: Loading plugin "webradio"...
Feb 25 13:19:45 volumio volumio[884]: info: Loading plugin "i2s_dacs"...
Feb 25 13:19:45 volumio volumio[884]: info: I2S DAC not set, start Auto-detection
Feb 25 13:19:45 volumio volumio[884]: info: Loading plugin "volumiodiscovery"...
Feb 25 13:19:45 volumio volumio[884]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi.
Feb 25 13:19:45 volumio volumio[884]: *** WARNING *** Please fix your application to use the native API of Avahi!
Feb 25 13:19:45 volumio volumio[884]: *** WARNING *** For more information see
Feb 25 13:19:45 volumio volumio[884]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi.
Feb 25 13:19:45 volumio node[884]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi.
Feb 25 13:19:45 volumio volumio[884]: *** WARNING *** Please fix your application to use the native API of Avahi!
Feb 25 13:19:45 volumio volumio[884]: *** WARNING *** For more information see
Feb 25 13:19:45 volumio node[884]: *** WARNING *** Please fix your application to use the native API of Avahi!
Feb 25 13:19:45 volumio node[884]: *** WARNING *** For more information see
Feb 25 13:19:45 volumio node[884]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi.
Feb 25 13:19:45 volumio node[884]: *** WARNING *** Please fix your application to use the native API of Avahi!
Feb 25 13:19:45 volumio node[884]: *** WARNING *** For more information see
Feb 25 13:19:45 volumio volumio[884]: info: Applying required configuration parameters for plugin volumiodiscovery
Feb 25 13:19:45 volumio volumio[884]: info: Discovery: Started advertising with name: Volumio
Feb 25 13:19:45 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback
Feb 25 13:19:45 volumio volumio[884]: info: Loading plugin "gpio-buttons"...
Feb 25 13:19:46 volumio volumio[884]: info: GPIO-Buttons initialized
Feb 25 13:19:46 volumio volumio[884]: info: Loading plugin "outputs"...
Feb 25 13:19:46 volumio volumio[884]: info: Loading plugin "albumart"...
Feb 25 13:19:46 volumio volumio[884]: info: Plugin example_plugin is not enabled
Feb 25 13:19:46 volumio volumio[884]: info: Loading plugin "inputs"...
Feb 25 13:19:46 volumio volumio[884]: info: Loading plugin "updater_comm"...
Feb 25 13:19:46 volumio volumio[884]: info: Plugin mpdemulation is not enabled
Feb 25 13:19:46 volumio volumio[884]: info: Loading plugin "rest_api"...
Feb 25 13:19:46 volumio volumio[884]: info: Loading plugin "websocket"...
Feb 25 13:19:46 volumio volumio[884]: info: Starting Socket.io Server version 2.3.0
Feb 25 13:19:46 volumio volumio[884]: info: Loading plugin "rotaryencoder2"...
Feb 25 13:19:46 volumio volumio[884]: Forking 3 albumart workers
Feb 25 13:19:47 volumio volumio[884]: info: Loading i18n strings for locale en
Feb 25 13:19:47 volumio volumio[884]: Updating browse sources language
Feb 25 13:19:47 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::initPlayerControls
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Feb 25 13:19:48 volumio volumio[884]: Express server listening on port 3000
Feb 25 13:19:48 volumio volumio[884]: [Metrics] WebUI: 10s 520.90ms
Feb 25 13:19:48 volumio volumio[884]: info: CoreStateMachine::resetVolumioState
Feb 25 13:19:48 volumio volumio[884]: info: CoreStateMachine::getcurrentVolume
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioRetrievevolume
Feb 25 13:19:48 volumio volumio[884]: Starting albumart workers
Feb 25 13:19:48 volumio volumio[884]: Starting albumart workers
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 25 13:19:48 volumio volumio[884]: info: Volumio Network Manager: Network status updated: 2
Feb 25 13:19:48 volumio volumio[884]: Starting albumart workers
Feb 25 13:19:48 volumio volumio-remote-updater[521]: [2026-02-25 13:19:48] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=4&transport=websocket&t=1772018384 101
Feb 25 13:19:48 volumio volumio[884]: verbose: New Socket.io Connection to 127.0.0.1:3000 from 127.0.0.1 UA: WebSocket++/0.8.2 Engine version: 4 Transport: websocket Total Clients: 1
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetState
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreStateMachine::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetState
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreStateMachine::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetState
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreStateMachine::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetState
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreStateMachine::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetState
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreStateMachine::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetState
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreStateMachine::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetState
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreStateMachine::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetState
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreStateMachine::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getQueue
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioGetState
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:48 volumio volumio[884]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 2
Feb 25 13:19:48 volumio volumio[884]: info: VolumeController:: Volume=13 Mute =false
Feb 25 13:19:48 volumio volumio[884]: info: CoreStateMachine::pushState
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioPushState
Feb 25 13:19:48 volumio volumio[884]: info: CoreStateMachine::updateTrackBlock
Feb 25 13:19:48 volumio volumio[884]: info: CorePlayQueue::getTrackBlock
Feb 25 13:19:48 volumio volumio[884]: info: CoreCommandRouter::volumioRetrievevolume
Feb 25 13:19:49 volumio volumio[884]: info: Reloading queue from file
Feb 25 13:19:49 volumio volumio[884]: info: CoreStateMachine::setRepeat null single undefined
Feb 25 13:19:49 volumio volumio[884]: info: CoreStateMachine::pushState
Feb 25 13:19:49 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::volumioPushState
Feb 25 13:19:49 volumio volumio[884]: info: CoreStateMachine::setRandom false
Feb 25 13:19:49 volumio volumio[884]: info: CoreStateMachine::pushState
Feb 25 13:19:49 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::volumioPushState
Feb 25 13:19:49 volumio volumio[884]: info: Setting Device type: Raspberry PI
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::volumioGetQueue
Feb 25 13:19:49 volumio volumio[884]: info: CoreStateMachine::getQueue
Feb 25 13:19:49 volumio volumio[884]: info: CorePlayQueue::getQueue
Feb 25 13:19:49 volumio volumio[884]: info: Completed loading Core Plugins
Feb 25 13:19:49 volumio volumio[884]: info: Preparing to generate the ALSA configuration file
Feb 25 13:19:49 volumio volumio[884]: info: USB Boot Capable - Checking Install to Disk functions for: bootusb
Feb 25 13:19:49 volumio volumio[884]: info: USB Boot Capable - System SBC Revision found in cpuinfo: 902120
Feb 25 13:19:49 volumio volumio[884]: info: USB Boot Capable - Found matching device in SBC capable list: Raspberry PI
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::volumioGetState
Feb 25 13:19:49 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:49 volumio volumio[884]: info: Discovery: Browse raised the following error Error: getaddrinfo -3007
Feb 25 13:19:49 volumio volumio[884]: info: VolumeController:: Volume=13 Mute =false
Feb 25 13:19:49 volumio volumio[884]: info: CoreStateMachine::pushState
Feb 25 13:19:49 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::volumioPushState
Feb 25 13:19:49 volumio volumio[884]: info: Asound.conf file unchanged, so no further update is needed
Feb 25 13:19:49 volumio volumio[884]: info: Output device has changed, restarting MPD
Feb 25 13:19:49 volumio volumio[884]: info: Output device has changed, restarting Shairport Sync
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 25 13:19:49 volumio sudo[1136]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service
Feb 25 13:19:49 volumio sudo[1136]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:49 volumio sudo[1134]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf
Feb 25 13:19:49 volumio sudo[1134]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:49 volumio sudo[1134]: pam_unix(sudo:session): session closed for user root
Feb 25 13:19:49 volumio volumio[884]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0
Feb 25 13:19:49 volumio volumio[884]: info: ___________ START PLUGINS ___________
Feb 25 13:19:49 volumio volumio[884]: info: ControllerMpd::onStart: Initializing MPD
Feb 25 13:19:49 volumio volumio[884]: info: Creating MPD Configuration file
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object]
Feb 25 13:19:49 volumio volumio[884]: info: [1772018389582] CoreMusicLibrary::Adding element Media Servers
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Feb 25 13:19:49 volumio sudo[1144]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf
Feb 25 13:19:49 volumio sudo[1144]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:49 volumio volumio[884]: info: UPNP Browser: Client initialized successfully
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 25 13:19:49 volumio sudo[1144]: pam_unix(sudo:session): session closed for user root
Feb 25 13:19:49 volumio sudo[1146]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service
Feb 25 13:19:49 volumio sudo[1146]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:49 volumio systemd[1]: Listening on mpd.socket.
Feb 25 13:19:49 volumio systemd[1]: Starting Music Player Daemon...
Feb 25 13:19:49 volumio systemd[1]: mpd.service: Control process exited, code=killed, status=15/TERM
Feb 25 13:19:49 volumio systemd[1]: mpd.service: Succeeded.
Feb 25 13:19:49 volumio systemd[1]: Stopped Music Player Daemon.
Feb 25 13:19:49 volumio systemd[1]: Starting Music Player Daemon...
Feb 25 13:19:49 volumio volumio[884]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 25 13:19:49 volumio volumio[884]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object]
Feb 25 13:19:49 volumio volumio[884]: info: [1772018389731] CoreMusicLibrary::Adding element Last_100
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Feb 25 13:19:49 volumio systemd[1]: systemd-fsckd.service: Succeeded.
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object]
Feb 25 13:19:49 volumio volumio[884]: info: [1772018389742] CoreMusicLibrary::Adding element Webradio
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Feb 25 13:19:49 volumio volumio[884]: info: Initializing BBC Radios
Feb 25 13:19:49 volumio volumio[884]: /usr/bin/md5sum: /sys/class/net/eth0/address: No such file or directory
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 25 13:19:49 volumio sudo[1153]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log
Feb 25 13:19:49 volumio sudo[1153]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Feb 25 13:19:49 volumio sudo[1153]: /bin/chown: cannot access '/var/log/mpd.log': No such file or directory
Feb 25 13:19:49 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 25 13:19:49 volumio sudo[1153]: pam_unix(sudo:session): session closed for user root
Feb 25 13:19:49 volumio volumio[884]: info: GPIO-Buttons: Reading config and creating triggers...
Feb 25 13:19:49 volumio volumio[884]: info: GPIO-Buttons: playPause on pin 533
Feb 25 13:19:49 volumio volumio[884]: info: GPIO-Buttons: previous on pin 528
Feb 25 13:19:49 volumio volumio[884]: info: GPIO-Buttons: next on pin 532
Feb 25 13:19:50 volumio volumio[884]: info: Volumio Calling Home
Feb 25 13:19:50 volumio sudo[1195]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/dtoverlay -l
Feb 25 13:19:50 volumio sudo[1195]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:50 volumio volumio[884]: info: GPIO-Buttons started
Feb 25 13:19:50 volumio sudo[1195]: pam_unix(sudo:session): session closed for user root
Feb 25 13:19:50 volumio volumio[884]: info: MPD Permissions set
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::volumioGetQueue
Feb 25 13:19:50 volumio volumio[884]: info: CoreStateMachine::getQueue
Feb 25 13:19:50 volumio volumio[884]: info: CorePlayQueue::getQueue
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::volumioGetState
Feb 25 13:19:50 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:50 volumio sudo[1201]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/dtoverlay rotary-encoder pin_a=17 pin_b=27 relative_axis=true steps-per-period=2
Feb 25 13:19:50 volumio sudo[1201]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:50 volumio volumio[884]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 3
Feb 25 13:19:50 volumio volumio[884]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 4
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio kernel: rotary-encoder rotary@11: gray
Feb 25 13:19:50 volumio kernel: input: rotary@11 as /devices/platform/rotary@11/input/input1
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 25 13:19:50 volumio sudo[1201]: pam_unix(sudo:session): session closed for user root
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::volumioGetQueue
Feb 25 13:19:50 volumio volumio[884]: info: CoreStateMachine::getQueue
Feb 25 13:19:50 volumio volumio[884]: info: CorePlayQueue::getQueue
Feb 25 13:19:50 volumio systemd-udevd[1215]: Process '/usr/sbin/th-cmd --socket /var/run/thd.socket --passfd --udev' failed with exit code 1.
Feb 25 13:19:50 volumio volumio[884]: info: Volumio called home
Feb 25 13:19:50 volumio volumio[884]: info: Starting Shairport Sync
Feb 25 13:19:50 volumio volumio[884]: info: Starting Shairport Sync
Feb 25 13:19:50 volumio volumio[884]: info: Starting Shairport Sync
Feb 25 13:19:50 volumio sudo[1223]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync
Feb 25 13:19:50 volumio sudo[1223]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:50 volumio sudo[1225]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync
Feb 25 13:19:50 volumio sudo[1227]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync
Feb 25 13:19:50 volumio sudo[1227]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:50 volumio sudo[1225]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:50 volumio sudo[1233]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/dtoverlay gpio-key gpio=22 active_low=true gpio_pull=up keycode=20
Feb 25 13:19:50 volumio sudo[1233]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::volumioGetState
Feb 25 13:19:50 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:50 volumio volumio[884]: info: CoreCommandRouter::volumioGetState
Feb 25 13:19:50 volumio volumio[884]: info: CorePlayQueue::getTrack 0
Feb 25 13:19:50 volumio systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver...
Feb 25 13:19:50 volumio sudo[1233]: pam_unix(sudo:session): session closed for user root
Feb 25 13:19:50 volumio systemd[1]: shairport-sync.service: Succeeded.
Feb 25 13:19:50 volumio systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver.
Feb 25 13:19:50 volumio kernel: input: button@16 as /devices/platform/button@16/input/input2
Feb 25 13:19:51 volumio systemd[1]: Started Shairport Sync - AirPlay Audio Receiver.
Feb 25 13:19:51 volumio sudo[1225]: pam_unix(sudo:session): session closed for user root
Feb 25 13:19:51 volumio sudo[1227]: pam_unix(sudo:session): session closed for user root
Feb 25 13:19:51 volumio sudo[1223]: pam_unix(sudo:session): session closed for user root
Feb 25 13:19:51 volumio volumio[884]: info: Shairport-Sync Started
Feb 25 13:19:51 volumio volumio[884]: Error adding Membership: Error: addMembership EINVAL
Feb 25 13:19:51 volumio volumio[884]: info: Shairport-Sync Started
Feb 25 13:19:51 volumio volumio[884]: info: Shairport-Sync Started
Feb 25 13:19:51 volumio volumio[884]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Feb 25 13:19:51 volumio volumio[884]: Error: Unable to resolve or reject the same promise twice
Feb 25 13:19:51 volumio volumio[884]: at Promise.resolve (/data/plugins/system_hardware/rotaryencoder2/node_modules/kew/kew.js:140:43)
Feb 25 13:19:51 volumio volumio[884]: at /data/plugins/system_hardware/rotaryencoder2/index.js:999:23
Feb 25 13:19:51 volumio volumio[884]: at FSReqCallback.oncomplete (fs.js:171:23)
Feb 25 13:19:51 volumio volumio[884]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Feb 25 13:19:51 volumio sudo[1249]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/usr/bin/dtoverlay -l
Feb 25 13:19:51 volumio sudo[1249]: pam_unix(sudo:session): session opened for user root by (uid=0)
Feb 25 13:19:51 volumio systemd-udevd[1215]: Process '/usr/sbin/th-cmd --socket /var/run/thd.socket --passfd --udev' failed with exit code 1.
Feb 25 13:19:51 volumio sudo[1249]: pam_unix(sudo:session): session closed for user root
Feb 25 13:19:52 volumio sudo[1260]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2026-02-25 13:18
Feb 25 13:19:52 volumio sudo[1260]: 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="49c352e1d55e9b76c3bd7b0e3940507619bf455a"
VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd"
VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2"
VOLUMIO_BE_VERSION="1d32690fc900ac8c739e7eabd35ed0f570899eb8"
VOLUMIO_ARCH="arm"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Fri 19 Dec 2025 02:07:26 PM CET"
VOLUMIO_VERSION="3.887"
VOLUMIO_HARDWARE="pi"
VOLUMIO_DEVICENAME="Raspberry Pi"
VOLUMIO_HASH="8f8c1d964af93dfdda0f02ac4140eec2"