-- Logs begin at Thu 2019-02-14 11:11:59 CET, end at Wed 2025-09-17 20:48:09 CEST. -- Sep 17 20:47:00 raspberrypi volumio[16901]: info: MYVOLUMIO Environment detected Sep 17 20:47:00 raspberrypi volumio[16901]: info: Plugin folders cleanup Sep 17 20:47:00 raspberrypi volumio[16901]: info: Scanning into folder /volumio/app/plugins/ Sep 17 20:47:00 raspberrypi volumio[16901]: info: Scanning category audio_interface Sep 17 20:47:00 raspberrypi volumio[16901]: info: Scanning category miscellanea Sep 17 20:47:00 raspberrypi volumio[16901]: info: Scanning category music_service Sep 17 20:47:00 raspberrypi volumio[16901]: info: Scanning category plugins.json Sep 17 20:47:00 raspberrypi volumio[16901]: info: Scanning category system_controller Sep 17 20:47:00 raspberrypi volumio[16901]: info: Scanning category user_interface Sep 17 20:47:00 raspberrypi volumio[16901]: info: Scanning into folder /data/plugins/ Sep 17 20:47:00 raspberrypi volumio[16901]: info: Scanning category audio_interface Sep 17 20:47:00 raspberrypi volumio[16901]: info: Scanning category music_service Sep 17 20:47:00 raspberrypi volumio[16901]: info: Plugin folders cleanup completed Sep 17 20:47:00 raspberrypi volumio[16901]: info: ------------------------------------------- Sep 17 20:47:00 raspberrypi volumio[16901]: info: ----- Core plugins startup ---- Sep 17 20:47:00 raspberrypi volumio[16901]: info: ------------------------------------------- Sep 17 20:47:00 raspberrypi volumio[16901]: info: Loading plugins from folder /volumio/app/plugins/ Sep 17 20:47:00 raspberrypi volumio[16901]: info: Adding plugin upnp to MyMusic Plugins Sep 17 20:47:00 raspberrypi volumio[16901]: info: Adding plugin airplay_emulation to MyMusic Plugins Sep 17 20:47:00 raspberrypi volumio[16901]: info: Adding plugin upnp_browser to MyMusic Plugins Sep 17 20:47:00 raspberrypi volumio[16901]: info: Loading plugins from folder /data/plugins/ Sep 17 20:47:00 raspberrypi volumio[16901]: info: Loading plugin "system"... Sep 17 20:47:00 raspberrypi volumio[16901]: info: Loading plugin "appearance"... Sep 17 20:47:01 raspberrypi volumio[16921]: Traceback (most recent call last): Sep 17 20:47:01 raspberrypi volumio[16921]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:01 raspberrypi volumio[16921]: from camilladsp import CamillaConnection Sep 17 20:47:01 raspberrypi volumio[16921]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:01 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:01 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:01 raspberrypi volumio[16901]: info: Loading plugin "network"... Sep 17 20:47:01 raspberrypi volumio[16901]: info: Refreshing Cached IP Addresses Sep 17 20:47:01 raspberrypi sudo[16929]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Sep 17 20:47:01 raspberrypi sudo[16929]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:02 raspberrypi sudo[16929]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:02 raspberrypi sudo[16931]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Sep 17 20:47:02 raspberrypi sudo[16931]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:02 raspberrypi sudo[16931]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:02 raspberrypi volumio[16901]: info: Loading plugin "services"... Sep 17 20:47:02 raspberrypi volumio[16901]: info: Loading plugin "alsa_controller"... Sep 17 20:47:02 raspberrypi sudo[16940]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Sep 17 20:47:02 raspberrypi sudo[16940]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:02 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:47:02 raspberrypi volumio[16901]: info: Loading plugin "wizard"... Sep 17 20:47:02 raspberrypi volumio[16901]: info: Loading plugin "networkfs"... Sep 17 20:47:02 raspberrypi volumio[16901]: info: Cannot mount NAS Music at system boot, trial number 1 ,retrying in 5 seconds Sep 17 20:47:02 raspberrypi volumio[16901]: info: Starting Udev Watcher for removable devices Sep 17 20:47:02 raspberrypi volumio[16901]: info: Ignoring mount for partition: boot Sep 17 20:47:02 raspberrypi volumio[16901]: info: Ignoring mount for partition: volumio Sep 17 20:47:02 raspberrypi volumio[16901]: info: Ignoring mount for partition: volumio_data Sep 17 20:47:02 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:02 raspberrypi volumio[16901]: info: Loading plugin "volumio_command_line_client"... Sep 17 20:47:02 raspberrypi volumio[16901]: info: Loading plugin "upnp"... Sep 17 20:47:02 raspberrypi volumio[16901]: info: [1758134822249] Starting Upmpd Daemon Sep 17 20:47:02 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:02 raspberrypi volumio[16901]: info: Loading plugin "my_music"... Sep 17 20:47:02 raspberrypi volumio[16901]: info: Loading plugin "mpd"... Sep 17 20:47:02 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:02] [connect] Successful connection Sep 17 20:47:02 raspberrypi volumio[16901]: info: Loading plugin "upnp_browser"... Sep 17 20:47:02 raspberrypi volumio[16901]: info: Loading plugin "alarm-clock"... Sep 17 20:47:03 raspberrypi sudo[16940]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:03 raspberrypi volumio[16901]: info: Loading plugin "airplay_emulation"... Sep 17 20:47:03 raspberrypi volumio[16901]: info: Starting Shairport Sync Sep 17 20:47:03 raspberrypi volumio[16901]: info: Loading plugin "last_100"... Sep 17 20:47:03 raspberrypi volumio[16901]: info: Loading plugin "webradio"... Sep 17 20:47:03 raspberrypi volumio[16901]: info: Loading plugin "i2s_dacs"... Sep 17 20:47:03 raspberrypi volumio[16901]: info: I2S DAC not set, start Auto-detection Sep 17 20:47:03 raspberrypi volumio[16901]: info: Loading plugin "volumiodiscovery"... Sep 17 20:47:03 raspberrypi volumio[16901]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:03 raspberrypi volumio[16901]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:03 raspberrypi volumio[16901]: *** WARNING *** For more information see Sep 17 20:47:03 raspberrypi node[16901]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:03 raspberrypi volumio[16901]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:03 raspberrypi volumio[16901]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:03 raspberrypi volumio[16901]: *** WARNING *** For more information see Sep 17 20:47:03 raspberrypi node[16901]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:03 raspberrypi node[16901]: *** WARNING *** For more information see Sep 17 20:47:03 raspberrypi node[16901]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:03 raspberrypi node[16901]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:03 raspberrypi node[16901]: *** WARNING *** For more information see Sep 17 20:47:03 raspberrypi volumio[16901]: info: Applying required configuration parameters for plugin volumiodiscovery Sep 17 20:47:03 raspberrypi volumio[16901]: info: Discovery: Started advertising with name: raspberrypi Sep 17 20:47:03 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:03 raspberrypi volumio[16901]: info: Loading plugin "spop"... Sep 17 20:47:03 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:03 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 241. Sep 17 20:47:03 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:03 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:04 raspberrypi volumio[16901]: info: Loading plugin "outputs"... Sep 17 20:47:04 raspberrypi volumio[16901]: info: Loading plugin "albumart"... Sep 17 20:47:04 raspberrypi volumio[16901]: info: Plugin example_plugin is not enabled Sep 17 20:47:04 raspberrypi volumio[16901]: info: Loading plugin "inputs"... Sep 17 20:47:04 raspberrypi volumio[16901]: info: Loading plugin "updater_comm"... Sep 17 20:47:05 raspberrypi volumio[16901]: info: Plugin mpdemulation is not enabled Sep 17 20:47:05 raspberrypi volumio[16901]: info: Loading plugin "rest_api"... Sep 17 20:47:05 raspberrypi volumio[16901]: info: Loading plugin "websocket"... Sep 17 20:47:05 raspberrypi volumio[16901]: info: Starting Socket.io Server version 2.3.0 Sep 17 20:47:05 raspberrypi volumio[16901]: info: Loading plugin "fusiondsp"... Sep 17 20:47:05 raspberrypi volumio[16958]: Traceback (most recent call last): Sep 17 20:47:05 raspberrypi volumio[16958]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:05 raspberrypi volumio[16958]: from camilladsp import CamillaConnection Sep 17 20:47:05 raspberrypi volumio[16958]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:05 raspberrypi volumio[16901]: Forking 3 albumart workers Sep 17 20:47:05 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:05 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:05 raspberrypi volumio[16901]: info: Applying required configuration parameters for plugin fusiondsp Sep 17 20:47:05 raspberrypi volumio[16901]: info: Loading i18n strings for locale pl Sep 17 20:47:05 raspberrypi volumio[16901]: Updating browse sources language Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreCommandRouter::initPlayerControls Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 17 20:47:05 raspberrypi volumio[16901]: Express server listening on port 3000 Sep 17 20:47:05 raspberrypi volumio[16901]: [Metrics] WebUI: 6s 721.23ms Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreStateMachine::resetVolumioState Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreStateMachine::getcurrentVolume Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioRetrievevolume Sep 17 20:47:05 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:05 raspberrypi volumio[16901]: info: Volumio Network Manager: Network status updated: 3 Sep 17 20:47:06 raspberrypi volumio[16901]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 1 Sep 17 20:47:06 raspberrypi volumio[16901]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 2 Sep 17 20:47:06 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:06] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=4&transport=websocket&t=1758134822 101 Sep 17 20:47:06 raspberrypi volumio[16901]: 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: 3 Sep 17 20:47:06 raspberrypi volumio[16901]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 4 Sep 17 20:47:06 raspberrypi volumio[16901]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 5 Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:06 raspberrypi volumio[16901]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:47:06 raspberrypi volumio[16901]: Starting albumart workers Sep 17 20:47:06 raspberrypi volumio[16901]: info: Reloading queue from file Sep 17 20:47:06 raspberrypi volumio[16901]: Starting albumart workers Sep 17 20:47:06 raspberrypi volumio[16901]: info: Received Get System Info Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Sep 17 20:47:06 raspberrypi volumio[16901]: info: Discovery: Getting this device information Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:06 raspberrypi volumio[16901]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:06 raspberrypi volumio[16901]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:06 raspberrypi volumio[16901]: Starting albumart workers Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioGetVisibleSources Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:06 raspberrypi volumio[16901]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioGetQueue Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreStateMachine::getQueue Sep 17 20:47:06 raspberrypi volumio[16901]: info: CorePlayQueue::getQueue Sep 17 20:47:06 raspberrypi volumio[16901]: info: Listing playlists Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Sep 17 20:47:06 raspberrypi volumio[16901]: info: Received Get System Info Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Sep 17 20:47:06 raspberrypi volumio[16901]: info: Discovery: Getting this device information Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:06 raspberrypi volumio[16901]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:06 raspberrypi volumio[16901]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:06 raspberrypi volumio[16901]: info: VolumeController:: Volume=0 Mute =false Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreStateMachine::pushState Sep 17 20:47:06 raspberrypi volumio[16901]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreStateMachine::updateTrackBlock Sep 17 20:47:06 raspberrypi volumio[16901]: info: CorePlayQueue::getTrackBlock Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioRetrievevolume Sep 17 20:47:06 raspberrypi volumio[16901]: info: Setting Device type: Raspberry PI Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreStateMachine::setRepeat false single undefined Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreStateMachine::pushState Sep 17 20:47:06 raspberrypi volumio[16901]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreStateMachine::setRandom null Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreStateMachine::pushState Sep 17 20:47:06 raspberrypi volumio[16901]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:06 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:06 raspberrypi volumio[16901]: info: Completed loading Core Plugins Sep 17 20:47:06 raspberrypi volumio[16901]: info: Preparing to generate the ALSA configuration file Sep 17 20:47:07 raspberrypi volumio[16901]: info: Discovery: adding 1092a755-1821-4e66-be8c-eba752f9503e Sep 17 20:47:07 raspberrypi volumio[16901]: info: Discovery: Found device raspberrypi Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:07 raspberrypi volumio[16901]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:07 raspberrypi volumio[16901]: info: Discovery: this is already registered, 1092a755-1821-4e66-be8c-eba752f9503e Sep 17 20:47:07 raspberrypi volumio[16901]: info: Discovery: Found device raspberrypi Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:07 raspberrypi volumio[16901]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:07 raspberrypi volumio[16901]: info: The plugin fusiondsp has an ALSA contribution file volumioDsp.postDsp.10.conf Sep 17 20:47:07 raspberrypi volumio[16901]: info: Reading ALSA contributions from plugins. Sep 17 20:47:07 raspberrypi volumio[16901]: info: VolumeController:: Volume=0 Mute =false Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreStateMachine::pushState Sep 17 20:47:07 raspberrypi volumio[16901]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:07 raspberrypi volumio[16901]: info: Asound.conf file unchanged, so no further update is needed Sep 17 20:47:07 raspberrypi volumio[16901]: info: Output device has changed, restarting MPD Sep 17 20:47:07 raspberrypi volumio[16901]: info: Output device has changed, restarting Shairport Sync Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:07 raspberrypi sudo[17001]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Sep 17 20:47:07 raspberrypi sudo[17001]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:07 raspberrypi sudo[17003]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Sep 17 20:47:07 raspberrypi sudo[17003]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:07 raspberrypi sudo[17001]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:07 raspberrypi systemd[1]: Stopping Music Player Daemon... Sep 17 20:47:07 raspberrypi volumio[16901]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 17 20:47:07 raspberrypi volumio[16901]: info: ___________ START PLUGINS ___________ Sep 17 20:47:07 raspberrypi volumio[16901]: info: ControllerMpd::onStart: Initializing MPD Sep 17 20:47:07 raspberrypi volumio[16901]: info: Creating MPD Configuration file Sep 17 20:47:07 raspberrypi systemd[1]: mpd.service: Succeeded. Sep 17 20:47:07 raspberrypi systemd[1]: Stopped Music Player Daemon. Sep 17 20:47:07 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:07 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 242. Sep 17 20:47:07 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:07 raspberrypi sudo[17011]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Sep 17 20:47:07 raspberrypi sudo[17011]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:07 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:07 raspberrypi sudo[17011]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 17 20:47:07 raspberrypi volumio[16901]: info: [1758134827417] CoreMusicLibrary::Adding element Serwery Mediów Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:07 raspberrypi systemd[1]: Starting Music Player Daemon... Sep 17 20:47:07 raspberrypi sudo[17018]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Sep 17 20:47:07 raspberrypi sudo[17018]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:07 raspberrypi systemd[1]: mpd.service: Control process exited, code=killed, status=15/TERM Sep 17 20:47:07 raspberrypi systemd[1]: mpd.service: Succeeded. Sep 17 20:47:07 raspberrypi systemd[1]: Stopped Music Player Daemon. Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:07 raspberrypi systemd[1]: Starting Music Player Daemon... Sep 17 20:47:07 raspberrypi volumio[16901]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:07 raspberrypi volumio[16901]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 17 20:47:07 raspberrypi volumio[16901]: info: [1758134827807] CoreMusicLibrary::Adding element Last_100 Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 17 20:47:07 raspberrypi volumio[16901]: info: [1758134827817] CoreMusicLibrary::Adding element Webradio Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:47:07 raspberrypi volumio[16901]: info: Initializing BBC Radios Sep 17 20:47:07 raspberrypi sudo[17033]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Sep 17 20:47:07 raspberrypi sudo[17033]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:07 raspberrypi sudo[17033]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:07 raspberrypi volumio[16901]: info: Creating Spotify config file Sep 17 20:47:07 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:07 raspberrypi volumio[16901]: info: Loading i18n strings for locale pl Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , updateALSAConfigFile Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: FusionDsp - mixtype--------------------- Hardware Sep 17 20:47:08 raspberrypi volumio[16901]: info: Volumio Calling Home Sep 17 20:47:08 raspberrypi volumio[16901]: info: Preparing to generate the ALSA configuration file Sep 17 20:47:08 raspberrypi volumio[16901]: info: Cannot mount NAS Music at system boot, trial number 2 ,retrying in 5 seconds Sep 17 20:47:08 raspberrypi volumio[16901]: info: The plugin fusiondsp has an ALSA contribution file volumioDsp.postDsp.10.conf Sep 17 20:47:08 raspberrypi volumio[16901]: info: Reading ALSA contributions from plugins. Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:08 raspberrypi volumio[16901]: info: MPD Permissions set Sep 17 20:47:08 raspberrypi volumio[16901]: info: Spotify config file written Sep 17 20:47:08 raspberrypi volumio[16901]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 6 Sep 17 20:47:08 raspberrypi volumio[16901]: info: Volumio called home Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi sudo[17066]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart go-librespot-daemon.service Sep 17 20:47:08 raspberrypi sudo[17066]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi systemd[1]: Stopping go-librespot Daemon... Sep 17 20:47:08 raspberrypi systemd[1]: go-librespot-daemon.service: Main process exited, code=killed, status=15/TERM Sep 17 20:47:08 raspberrypi systemd[1]: go-librespot-daemon.service: Succeeded. Sep 17 20:47:08 raspberrypi systemd[1]: Stopped go-librespot Daemon. Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:08 raspberrypi volumio[16901]: info: No need to fix Spotify hosts Sep 17 20:47:08 raspberrypi systemd[1]: Started go-librespot Daemon. Sep 17 20:47:08 raspberrypi go-librespot[17072]: go-librespot daemon starting... Sep 17 20:47:08 raspberrypi sudo[17066]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:08 raspberrypi go-librespot[17072]: time="2025-09-17T20:47:08+02:00" level=info msg="running go-librespot 0.3.2" Sep 17 20:47:08 raspberrypi go-librespot[17072]: time="2025-09-17T20:47:08+02:00" level=debug msg="app state loaded" Sep 17 20:47:08 raspberrypi go-librespot[17072]: time="2025-09-17T20:47:08+02:00" level=debug msg="stored credentials not found" Sep 17 20:47:08 raspberrypi go-librespot[17072]: time="2025-09-17T20:47:08+02:00" level=info msg="api server listening on 127.0.0.1:9879" Sep 17 20:47:08 raspberrypi volumio[16901]: info: FusionDsp - Sep 17 20:47:09 raspberrypi go-librespot[17072]: time="2025-09-17T20:47:09+02:00" level=debug msg="fetched new accesspoints: [ap-gew4.spotify.com:4070 ap-gew4.spotify.com:443 ap-gew4.spotify.com:80 ap-guc3.spotify.com:4070 ap-gue1.spotify.com:443 ap-gew1.spotify.com:80]" Sep 17 20:47:09 raspberrypi go-librespot[17072]: time="2025-09-17T20:47:09+02:00" level=debug msg="fetched new dealers: [gew4-dealer.spotify.com:443 guc3-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew1-dealer.spotify.com:443]" Sep 17 20:47:09 raspberrypi go-librespot[17072]: time="2025-09-17T20:47:09+02:00" level=debug msg="fetched new spclients: [gew4-spclient.spotify.com:443 guc3-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew1-spclient.spotify.com:443]" Sep 17 20:47:09 raspberrypi go-librespot[17072]: time="2025-09-17T20:47:09+02:00" level=info msg="zeroconf server listening on port 46561" Sep 17 20:47:09 raspberrypi volumio[16901]: info: FusionDsp - Sep 17 20:47:09 raspberrypi volumio[17010]: Traceback (most recent call last): Sep 17 20:47:09 raspberrypi volumio[17010]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:09 raspberrypi volumio[17010]: from camilladsp import CamillaConnection Sep 17 20:47:09 raspberrypi volumio[17010]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:09 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:09 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:09 raspberrypi volumio[16901]: info: FusionDsp - Sep 17 20:47:09 raspberrypi volumio[16901]: info: FusionDsp - Sep 17 20:47:10 raspberrypi mpd[17052]: Sep 17 20:47 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Sep 17 20:47:10 raspberrypi systemd[1]: Started Music Player Daemon. Sep 17 20:47:10 raspberrypi sudo[17003]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:10 raspberrypi sudo[17018]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:10 raspberrypi volumio[16901]: /usr/bin/mkfifo: cannot create fifo '/tmp/fusiondspfifo': File exists Sep 17 20:47:10 raspberrypi volumio[16901]: error: FusionDsp - ----failed to create fusiondspfifo :Error: Command failed: /bin/touch /tmp/fusiondsp_stream_params.log && /bin/chmod 666 /tmp/fusiondsp_stream_params.log && /bin/touch /tmp/camilladsp.log && /bin/chmod 666 /tmp/camilladsp.log && /usr/bin/mkfifo -m 646 /tmp/fusiondspfifo Sep 17 20:47:10 raspberrypi volumio[16901]: /usr/bin/mkfifo: cannot create fifo '/tmp/fusiondspfifo': File exists Sep 17 20:47:10 raspberrypi volumio[16901]: info: camilladsp service started and running in background, instance 1 Sep 17 20:47:10 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:10 raspberrypi volumio[16901]: /bin/sh: 1: /data/plugins/audio_interface/fusiondsp/hw_params: not found Sep 17 20:47:10 raspberrypi volumio[16901]: error: FusionDsp - ----Hw detection failed :Error: Command failed: /data/plugins/audio_interface/fusiondsp/hw_params volumioHw >/data/configuration/audio_interface/fusiondsp/hwinfo.json Sep 17 20:47:10 raspberrypi volumio[16901]: /bin/sh: 1: /data/plugins/audio_interface/fusiondsp/hw_params: not found Sep 17 20:47:10 raspberrypi volumio[16901]: info: FusionDsp loaded Sep 17 20:47:10 raspberrypi volumio[16901]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 17 20:47:10 raspberrypi sudo[17099]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start fusiondsp.service Sep 17 20:47:10 raspberrypi sudo[17099]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:10 raspberrypi volumio[16901]: info: FusionDsp - Reporting Fusion DSP Enabled Sep 17 20:47:10 raspberrypi volumio[16901]: info: Adding Signal Path Element [object Object] Sep 17 20:47:10 raspberrypi volumio[16901]: info: Adding fusiondspeq DSP Signal Path Element Sep 17 20:47:10 raspberrypi volumio[16901]: info: FusionDsp - ---- installed callbackRead Sep 17 20:47:10 raspberrypi volumio[16901]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Sep 17 20:47:10 raspberrypi volumio[16901]: Error: spawn /data/plugins/audio_interface/fusiondsp/camilladsp ENOENT Sep 17 20:47:10 raspberrypi volumio[16901]: at Process.ChildProcess._handle.onexit (internal/child_process.js:269:19) Sep 17 20:47:10 raspberrypi volumio[16901]: at onErrorNT (internal/child_process.js:465:16) Sep 17 20:47:10 raspberrypi volumio[16901]: at processTicksAndRejections (internal/process/task_queues.js:80:21) Sep 17 20:47:10 raspberrypi volumio[16901]: at runNextTicks (internal/process/task_queues.js:62:3) Sep 17 20:47:10 raspberrypi volumio[16901]: at listOnTimeout (internal/timers.js:523:9) Sep 17 20:47:10 raspberrypi volumio[16901]: at processTimers (internal/timers.js:497:7) { Sep 17 20:47:10 raspberrypi volumio[16901]: errno: -2, Sep 17 20:47:10 raspberrypi volumio[16901]: code: 'ENOENT', Sep 17 20:47:10 raspberrypi volumio[16901]: syscall: 'spawn /data/plugins/audio_interface/fusiondsp/camilladsp', Sep 17 20:47:10 raspberrypi volumio[16901]: path: '/data/plugins/audio_interface/fusiondsp/camilladsp', Sep 17 20:47:10 raspberrypi volumio[16901]: spawnargs: [ Sep 17 20:47:10 raspberrypi volumio[16901]: '-p', Sep 17 20:47:10 raspberrypi volumio[16901]: 9876, Sep 17 20:47:10 raspberrypi volumio[16901]: '-o', Sep 17 20:47:10 raspberrypi volumio[16901]: '/tmp/camilladsp.log', Sep 17 20:47:10 raspberrypi volumio[16901]: '-l', Sep 17 20:47:10 raspberrypi volumio[16901]: 'warn', Sep 17 20:47:10 raspberrypi volumio[16901]: '/data/configuration/audio_interface/fusiondsp/camilladsp.yml' Sep 17 20:47:10 raspberrypi volumio[16901]: ] Sep 17 20:47:10 raspberrypi volumio[16901]: } Sep 17 20:47:10 raspberrypi volumio[16901]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Sep 17 20:47:11 raspberrypi sudo[17110]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-09-17 20:46 Sep 17 20:47:11 raspberrypi sudo[17110]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:11 raspberrypi sudo[17110]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:11 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:11] [error] handle_read_frame error: websocketpp.transport:7 (End of File) Sep 17 20:47:11 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:11] [disconnect] Disconnect close local:[1006,End of File] remote:[1006] Sep 17 20:47:11 raspberrypi systemd[1]: volumio.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:11 raspberrypi sudo[17099]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:11 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:11 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 243. Sep 17 20:47:11 raspberrypi systemd[1]: volumio.service: Failed with result 'exit-code'. Sep 17 20:47:11 raspberrypi systemd[1]: Started dynamicswap service. Sep 17 20:47:11 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:11 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:11 raspberrypi systemd[1]: dynamicswap.service: Succeeded. Sep 17 20:47:11 raspberrypi systemd[1]: volumio.service: Service RestartSec=100ms expired, scheduling restart. Sep 17 20:47:11 raspberrypi systemd[1]: volumio.service: Scheduled restart job, restart counter is at 67. Sep 17 20:47:12 raspberrypi systemd[1]: Started dynamicswap service. Sep 17 20:47:12 raspberrypi systemd[1]: Stopped Volumio Backend Module. Sep 17 20:47:12 raspberrypi systemd[1]: Started Volumio Backend Module. Sep 17 20:47:12 raspberrypi systemd[1]: dynamicswap.service: Succeeded. Sep 17 20:47:12 raspberrypi volumio[17115]: Traceback (most recent call last): Sep 17 20:47:12 raspberrypi volumio[17115]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:12 raspberrypi volumio[17115]: from camilladsp import CamillaConnection Sep 17 20:47:12 raspberrypi volumio[17115]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:13 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:13 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:14 raspberrypi volumio[17122]: info: ------------------------------------------- Sep 17 20:47:14 raspberrypi volumio[17122]: info: ----- Volumio3 ---- Sep 17 20:47:14 raspberrypi volumio[17122]: info: ------------------------------------------- Sep 17 20:47:14 raspberrypi volumio[17122]: info: ----- System startup ---- Sep 17 20:47:14 raspberrypi volumio[17122]: info: ------------------------------------------- Sep 17 20:47:14 raspberrypi volumio[17122]: info: MYVOLUMIO Environment detected Sep 17 20:47:15 raspberrypi volumio[17122]: info: Plugin folders cleanup Sep 17 20:47:15 raspberrypi volumio[17122]: info: Scanning into folder /volumio/app/plugins/ Sep 17 20:47:15 raspberrypi volumio[17122]: info: Scanning category audio_interface Sep 17 20:47:15 raspberrypi volumio[17122]: info: Scanning category miscellanea Sep 17 20:47:15 raspberrypi volumio[17122]: info: Scanning category music_service Sep 17 20:47:15 raspberrypi volumio[17122]: info: Scanning category plugins.json Sep 17 20:47:15 raspberrypi volumio[17122]: info: Scanning category system_controller Sep 17 20:47:15 raspberrypi volumio[17122]: info: Scanning category user_interface Sep 17 20:47:15 raspberrypi volumio[17122]: info: Scanning into folder /data/plugins/ Sep 17 20:47:15 raspberrypi volumio[17122]: info: Scanning category audio_interface Sep 17 20:47:15 raspberrypi volumio[17122]: info: Scanning category music_service Sep 17 20:47:15 raspberrypi volumio[17122]: info: Plugin folders cleanup completed Sep 17 20:47:15 raspberrypi volumio[17122]: info: ------------------------------------------- Sep 17 20:47:15 raspberrypi volumio[17122]: info: ----- Core plugins startup ---- Sep 17 20:47:15 raspberrypi volumio[17122]: info: ------------------------------------------- Sep 17 20:47:15 raspberrypi volumio[17122]: info: Loading plugins from folder /volumio/app/plugins/ Sep 17 20:47:15 raspberrypi volumio[17122]: info: Adding plugin upnp to MyMusic Plugins Sep 17 20:47:15 raspberrypi volumio[17122]: info: Adding plugin airplay_emulation to MyMusic Plugins Sep 17 20:47:15 raspberrypi volumio[17122]: info: Adding plugin upnp_browser to MyMusic Plugins Sep 17 20:47:15 raspberrypi volumio[17122]: info: Loading plugins from folder /data/plugins/ Sep 17 20:47:15 raspberrypi volumio[17122]: info: Loading plugin "system"... Sep 17 20:47:15 raspberrypi volumio[17122]: info: Loading plugin "appearance"... Sep 17 20:47:15 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:15 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 244. Sep 17 20:47:15 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:15 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:16 raspberrypi volumio[17122]: info: Loading plugin "network"... Sep 17 20:47:16 raspberrypi volumio[17122]: info: Refreshing Cached IP Addresses Sep 17 20:47:16 raspberrypi sudo[17150]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Sep 17 20:47:16 raspberrypi sudo[17150]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:16 raspberrypi sudo[17150]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:16 raspberrypi sudo[17152]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Sep 17 20:47:16 raspberrypi sudo[17152]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:16 raspberrypi sudo[17152]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:16 raspberrypi volumio[17122]: info: Loading plugin "services"... Sep 17 20:47:16 raspberrypi volumio[17122]: info: Loading plugin "alsa_controller"... Sep 17 20:47:16 raspberrypi sudo[17161]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Sep 17 20:47:16 raspberrypi sudo[17161]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:16 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:47:16 raspberrypi volumio[17122]: info: Loading plugin "wizard"... Sep 17 20:47:16 raspberrypi volumio[17122]: info: Loading plugin "networkfs"... Sep 17 20:47:16 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:16] [connect] Successful connection Sep 17 20:47:16 raspberrypi volumio[17122]: info: Cannot mount NAS Music at system boot, trial number 1 ,retrying in 5 seconds Sep 17 20:47:16 raspberrypi volumio[17122]: info: Starting Udev Watcher for removable devices Sep 17 20:47:16 raspberrypi volumio[17148]: Traceback (most recent call last): Sep 17 20:47:16 raspberrypi volumio[17148]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:16 raspberrypi volumio[17148]: from camilladsp import CamillaConnection Sep 17 20:47:16 raspberrypi volumio[17148]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:16 raspberrypi volumio[17122]: info: Ignoring mount for partition: boot Sep 17 20:47:16 raspberrypi volumio[17122]: info: Ignoring mount for partition: volumio Sep 17 20:47:16 raspberrypi volumio[17122]: info: Ignoring mount for partition: volumio_data Sep 17 20:47:16 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:16 raspberrypi volumio[17122]: info: Loading plugin "volumio_command_line_client"... Sep 17 20:47:16 raspberrypi volumio[17122]: info: Loading plugin "upnp"... Sep 17 20:47:16 raspberrypi volumio[17122]: info: [1758134836641] Starting Upmpd Daemon Sep 17 20:47:16 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:16 raspberrypi volumio[17122]: info: Loading plugin "my_music"... Sep 17 20:47:16 raspberrypi volumio[17122]: info: Loading plugin "mpd"... Sep 17 20:47:16 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:16 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:17 raspberrypi volumio[17122]: info: Loading plugin "upnp_browser"... Sep 17 20:47:17 raspberrypi sudo[17161]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:17 raspberrypi volumio[17122]: info: Loading plugin "alarm-clock"... Sep 17 20:47:17 raspberrypi volumio[17122]: info: Loading plugin "airplay_emulation"... Sep 17 20:47:17 raspberrypi volumio[17122]: info: Starting Shairport Sync Sep 17 20:47:17 raspberrypi volumio[17122]: info: Loading plugin "last_100"... Sep 17 20:47:17 raspberrypi volumio[17122]: info: Loading plugin "webradio"... Sep 17 20:47:17 raspberrypi volumio[17122]: info: Loading plugin "i2s_dacs"... Sep 17 20:47:17 raspberrypi volumio[17122]: info: I2S DAC not set, start Auto-detection Sep 17 20:47:17 raspberrypi volumio[17122]: info: Loading plugin "volumiodiscovery"... Sep 17 20:47:17 raspberrypi volumio[17122]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:17 raspberrypi volumio[17122]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:17 raspberrypi volumio[17122]: *** WARNING *** For more information see Sep 17 20:47:17 raspberrypi node[17122]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:17 raspberrypi volumio[17122]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:17 raspberrypi volumio[17122]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:17 raspberrypi volumio[17122]: *** WARNING *** For more information see Sep 17 20:47:17 raspberrypi node[17122]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:17 raspberrypi node[17122]: *** WARNING *** For more information see Sep 17 20:47:17 raspberrypi node[17122]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:17 raspberrypi node[17122]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:17 raspberrypi node[17122]: *** WARNING *** For more information see Sep 17 20:47:17 raspberrypi volumio[17122]: info: Applying required configuration parameters for plugin volumiodiscovery Sep 17 20:47:17 raspberrypi volumio[17122]: info: Discovery: Started advertising with name: raspberrypi Sep 17 20:47:17 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:17 raspberrypi volumio[17122]: info: Loading plugin "spop"... Sep 17 20:47:18 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:18 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 245. Sep 17 20:47:18 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:19 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:19 raspberrypi volumio[17122]: info: Loading plugin "outputs"... Sep 17 20:47:19 raspberrypi volumio[17122]: info: Loading plugin "albumart"... Sep 17 20:47:19 raspberrypi volumio[17122]: info: Plugin example_plugin is not enabled Sep 17 20:47:19 raspberrypi volumio[17122]: info: Loading plugin "inputs"... Sep 17 20:47:19 raspberrypi volumio[17122]: info: Loading plugin "updater_comm"... Sep 17 20:47:19 raspberrypi volumio[17122]: info: Plugin mpdemulation is not enabled Sep 17 20:47:19 raspberrypi volumio[17122]: info: Loading plugin "rest_api"... Sep 17 20:47:19 raspberrypi volumio[17122]: info: Loading plugin "websocket"... Sep 17 20:47:19 raspberrypi volumio[17122]: info: Starting Socket.io Server version 2.3.0 Sep 17 20:47:19 raspberrypi volumio[17122]: info: Loading plugin "fusiondsp"... Sep 17 20:47:19 raspberrypi volumio[17122]: Forking 3 albumart workers Sep 17 20:47:19 raspberrypi volumio[17122]: info: Applying required configuration parameters for plugin fusiondsp Sep 17 20:47:20 raspberrypi volumio[17122]: info: Loading i18n strings for locale pl Sep 17 20:47:20 raspberrypi volumio[17122]: Updating browse sources language Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreCommandRouter::initPlayerControls Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 17 20:47:20 raspberrypi volumio[17122]: Express server listening on port 3000 Sep 17 20:47:20 raspberrypi volumio[17122]: [Metrics] WebUI: 6s 930.06ms Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreStateMachine::resetVolumioState Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreStateMachine::getcurrentVolume Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioRetrievevolume Sep 17 20:47:20 raspberrypi volumio[17179]: Traceback (most recent call last): Sep 17 20:47:20 raspberrypi volumio[17179]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:20 raspberrypi volumio[17179]: from camilladsp import CamillaConnection Sep 17 20:47:20 raspberrypi volumio[17179]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:20 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:20 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:20 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:20 raspberrypi volumio[17122]: info: Volumio Network Manager: Network status updated: 3 Sep 17 20:47:20 raspberrypi volumio[17122]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 1 Sep 17 20:47:20 raspberrypi volumio[17122]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 2 Sep 17 20:47:20 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:20] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=4&transport=websocket&t=1758134836 101 Sep 17 20:47:20 raspberrypi volumio[17122]: 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: 3 Sep 17 20:47:21 raspberrypi volumio[17122]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 4 Sep 17 20:47:21 raspberrypi volumio[17122]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 5 Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:21 raspberrypi volumio[17122]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:47:21 raspberrypi volumio[17122]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 6 Sep 17 20:47:21 raspberrypi volumio[17122]: Starting albumart workers Sep 17 20:47:21 raspberrypi volumio[17122]: Starting albumart workers Sep 17 20:47:21 raspberrypi volumio[17122]: info: Reloading queue from file Sep 17 20:47:21 raspberrypi volumio[17122]: info: VolumeController:: Volume=0 Mute =false Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreStateMachine::pushState Sep 17 20:47:21 raspberrypi volumio[17122]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreStateMachine::updateTrackBlock Sep 17 20:47:21 raspberrypi volumio[17122]: info: CorePlayQueue::getTrackBlock Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioRetrievevolume Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreStateMachine::setRepeat false single undefined Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreStateMachine::pushState Sep 17 20:47:21 raspberrypi volumio[17122]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreStateMachine::setRandom null Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreStateMachine::pushState Sep 17 20:47:21 raspberrypi volumio[17122]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:21 raspberrypi volumio[17122]: info: Setting Device type: Raspberry PI Sep 17 20:47:21 raspberrypi volumio[17122]: Starting albumart workers Sep 17 20:47:21 raspberrypi volumio[17122]: info: Received Get System Info Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Sep 17 20:47:21 raspberrypi volumio[17122]: info: Discovery: Getting this device information Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:21 raspberrypi volumio[17122]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:21 raspberrypi volumio[17122]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioGetVisibleSources Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:21 raspberrypi volumio[17122]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioGetQueue Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreStateMachine::getQueue Sep 17 20:47:21 raspberrypi volumio[17122]: info: CorePlayQueue::getQueue Sep 17 20:47:21 raspberrypi volumio[17122]: info: Listing playlists Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Sep 17 20:47:21 raspberrypi volumio[17122]: info: Received Get System Info Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Sep 17 20:47:21 raspberrypi volumio[17122]: info: Discovery: Getting this device information Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:21 raspberrypi volumio[17122]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:21 raspberrypi volumio[17122]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:21 raspberrypi volumio[17122]: info: Cannot mount NAS Music at system boot, trial number 2 ,retrying in 5 seconds Sep 17 20:47:21 raspberrypi volumio[17122]: info: Discovery: adding 1092a755-1821-4e66-be8c-eba752f9503e Sep 17 20:47:21 raspberrypi volumio[17122]: info: Discovery: Found device raspberrypi Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:21 raspberrypi volumio[17122]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:21 raspberrypi volumio[17122]: info: VolumeController:: Volume=0 Mute =false Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreStateMachine::pushState Sep 17 20:47:21 raspberrypi volumio[17122]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:21 raspberrypi volumio[17122]: info: Completed loading Core Plugins Sep 17 20:47:21 raspberrypi volumio[17122]: info: Preparing to generate the ALSA configuration file Sep 17 20:47:21 raspberrypi volumio[17122]: info: Discovery: this is already registered, 1092a755-1821-4e66-be8c-eba752f9503e Sep 17 20:47:21 raspberrypi volumio[17122]: info: Discovery: Found device raspberrypi Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:21 raspberrypi volumio[17122]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:21 raspberrypi volumio[17122]: info: The plugin fusiondsp has an ALSA contribution file volumioDsp.postDsp.10.conf Sep 17 20:47:21 raspberrypi volumio[17122]: info: Reading ALSA contributions from plugins. Sep 17 20:47:21 raspberrypi volumio[17122]: info: Asound.conf file unchanged, so no further update is needed Sep 17 20:47:21 raspberrypi volumio[17122]: info: Output device has changed, restarting MPD Sep 17 20:47:21 raspberrypi volumio[17122]: info: Output device has changed, restarting Shairport Sync Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:21 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:21 raspberrypi sudo[17222]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Sep 17 20:47:21 raspberrypi sudo[17222]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:21 raspberrypi sudo[17222]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:21 raspberrypi sudo[17224]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Sep 17 20:47:21 raspberrypi sudo[17224]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:21 raspberrypi systemd[1]: Stopping Music Player Daemon... Sep 17 20:47:21 raspberrypi volumio[17122]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 17 20:47:21 raspberrypi volumio[17122]: info: ___________ START PLUGINS ___________ Sep 17 20:47:22 raspberrypi volumio[17122]: info: ControllerMpd::onStart: Initializing MPD Sep 17 20:47:22 raspberrypi volumio[17122]: info: Creating MPD Configuration file Sep 17 20:47:22 raspberrypi systemd[1]: mpd.service: Succeeded. Sep 17 20:47:22 raspberrypi systemd[1]: Stopped Music Player Daemon. Sep 17 20:47:22 raspberrypi systemd[1]: Starting Music Player Daemon... Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 17 20:47:22 raspberrypi volumio[17122]: info: [1758134842119] CoreMusicLibrary::Adding element Serwery Mediów Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:22 raspberrypi sudo[17244]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Sep 17 20:47:22 raspberrypi sudo[17244]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:22 raspberrypi sudo[17236]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Sep 17 20:47:22 raspberrypi sudo[17236]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:22 raspberrypi systemd[1]: mpd.service: Control process exited, code=killed, status=15/TERM Sep 17 20:47:22 raspberrypi sudo[17236]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:22 raspberrypi systemd[1]: mpd.service: Succeeded. Sep 17 20:47:22 raspberrypi systemd[1]: Stopped Music Player Daemon. Sep 17 20:47:22 raspberrypi systemd[1]: Starting Music Player Daemon... Sep 17 20:47:22 raspberrypi volumio[17122]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:22 raspberrypi volumio[17122]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 17 20:47:22 raspberrypi volumio[17122]: info: [1758134842502] CoreMusicLibrary::Adding element Last_100 Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 17 20:47:22 raspberrypi volumio[17122]: info: [1758134842522] CoreMusicLibrary::Adding element Webradio Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:47:22 raspberrypi sudo[17268]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Sep 17 20:47:22 raspberrypi sudo[17268]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:22 raspberrypi volumio[17122]: info: Initializing BBC Radios Sep 17 20:47:22 raspberrypi sudo[17268]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:22 raspberrypi volumio[17122]: info: Creating Spotify config file Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:22 raspberrypi volumio[17122]: info: Loading i18n strings for locale pl Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , updateALSAConfigFile Sep 17 20:47:22 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:22 raspberrypi volumio[17122]: info: FusionDsp - mixtype--------------------- Hardware Sep 17 20:47:22 raspberrypi volumio[17122]: info: Volumio Calling Home Sep 17 20:47:22 raspberrypi volumio[17122]: info: Preparing to generate the ALSA configuration file Sep 17 20:47:22 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:22 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 246. Sep 17 20:47:22 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:23 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:23 raspberrypi volumio[17122]: info: The plugin fusiondsp has an ALSA contribution file volumioDsp.postDsp.10.conf Sep 17 20:47:23 raspberrypi volumio[17122]: info: Reading ALSA contributions from plugins. Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:23 raspberrypi volumio[17122]: info: MPD Permissions set Sep 17 20:47:23 raspberrypi volumio[17122]: info: MPD Permissions set Sep 17 20:47:23 raspberrypi volumio[17122]: info: Spotify config file written Sep 17 20:47:23 raspberrypi volumio[17122]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 7 Sep 17 20:47:23 raspberrypi sudo[17323]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart go-librespot-daemon.service Sep 17 20:47:23 raspberrypi volumio[17122]: info: Volumio called home Sep 17 20:47:23 raspberrypi sudo[17323]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:23 raspberrypi systemd[1]: Stopping go-librespot Daemon... Sep 17 20:47:23 raspberrypi systemd[1]: go-librespot-daemon.service: Main process exited, code=killed, status=15/TERM Sep 17 20:47:23 raspberrypi systemd[1]: go-librespot-daemon.service: Succeeded. Sep 17 20:47:23 raspberrypi systemd[1]: Stopped go-librespot Daemon. Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:23 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:23 raspberrypi volumio[17122]: info: No need to fix Spotify hosts Sep 17 20:47:23 raspberrypi systemd[1]: Started go-librespot Daemon. Sep 17 20:47:23 raspberrypi go-librespot[17329]: go-librespot daemon starting... Sep 17 20:47:23 raspberrypi sudo[17323]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:23 raspberrypi go-librespot[17329]: time="2025-09-17T20:47:23+02:00" level=info msg="running go-librespot 0.3.2" Sep 17 20:47:23 raspberrypi go-librespot[17329]: time="2025-09-17T20:47:23+02:00" level=debug msg="app state loaded" Sep 17 20:47:23 raspberrypi go-librespot[17329]: time="2025-09-17T20:47:23+02:00" level=debug msg="stored credentials not found" Sep 17 20:47:23 raspberrypi go-librespot[17329]: time="2025-09-17T20:47:23+02:00" level=info msg="api server listening on 127.0.0.1:9879" Sep 17 20:47:23 raspberrypi volumio[17122]: info: FusionDsp - Sep 17 20:47:23 raspberrypi go-librespot[17329]: time="2025-09-17T20:47:23+02:00" level=debug msg="fetched new accesspoints: [ap-gew4.spotify.com:4070 ap-gew4.spotify.com:443 ap-gew4.spotify.com:80 ap-guc3.spotify.com:4070 ap-gue1.spotify.com:443 ap-gae2.spotify.com:80]" Sep 17 20:47:23 raspberrypi go-librespot[17329]: time="2025-09-17T20:47:23+02:00" level=debug msg="fetched new dealers: [gew4-dealer.spotify.com:443 guc3-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gae2-dealer.spotify.com:443]" Sep 17 20:47:23 raspberrypi go-librespot[17329]: time="2025-09-17T20:47:23+02:00" level=debug msg="fetched new spclients: [gew4-spclient.spotify.com:443 guc3-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gae2-spclient.spotify.com:443]" Sep 17 20:47:23 raspberrypi go-librespot[17329]: time="2025-09-17T20:47:23+02:00" level=info msg="zeroconf server listening on port 44101" Sep 17 20:47:23 raspberrypi volumio[17122]: info: FusionDsp - Sep 17 20:47:24 raspberrypi volumio[17122]: info: FusionDsp - Sep 17 20:47:24 raspberrypi volumio[17122]: info: FusionDsp - Sep 17 20:47:24 raspberrypi volumio[17321]: Traceback (most recent call last): Sep 17 20:47:24 raspberrypi volumio[17321]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:24 raspberrypi volumio[17321]: from camilladsp import CamillaConnection Sep 17 20:47:24 raspberrypi volumio[17321]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:24 raspberrypi mpd[17307]: Sep 17 20:47 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Sep 17 20:47:24 raspberrypi volumio[17122]: /usr/bin/mkfifo: cannot create fifo '/tmp/fusiondspfifo': File exists Sep 17 20:47:24 raspberrypi volumio[17122]: error: FusionDsp - ----failed to create fusiondspfifo :Error: Command failed: /bin/touch /tmp/fusiondsp_stream_params.log && /bin/chmod 666 /tmp/fusiondsp_stream_params.log && /bin/touch /tmp/camilladsp.log && /bin/chmod 666 /tmp/camilladsp.log && /usr/bin/mkfifo -m 646 /tmp/fusiondspfifo Sep 17 20:47:24 raspberrypi volumio[17122]: /usr/bin/mkfifo: cannot create fifo '/tmp/fusiondspfifo': File exists Sep 17 20:47:24 raspberrypi volumio[17122]: info: camilladsp service started and running in background, instance 1 Sep 17 20:47:24 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:24 raspberrypi volumio[17122]: /bin/sh: 1: /data/plugins/audio_interface/fusiondsp/hw_params: not found Sep 17 20:47:24 raspberrypi volumio[17122]: error: FusionDsp - ----Hw detection failed :Error: Command failed: /data/plugins/audio_interface/fusiondsp/hw_params volumioHw >/data/configuration/audio_interface/fusiondsp/hwinfo.json Sep 17 20:47:24 raspberrypi volumio[17122]: /bin/sh: 1: /data/plugins/audio_interface/fusiondsp/hw_params: not found Sep 17 20:47:25 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:25 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:25 raspberrypi systemd[1]: Started Music Player Daemon. Sep 17 20:47:25 raspberrypi volumio[17122]: info: FusionDsp loaded Sep 17 20:47:25 raspberrypi sudo[17224]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:25 raspberrypi volumio[17122]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 17 20:47:25 raspberrypi sudo[17244]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:25 raspberrypi sudo[17354]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start fusiondsp.service Sep 17 20:47:25 raspberrypi sudo[17354]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:25 raspberrypi volumio[17122]: info: FusionDsp - Reporting Fusion DSP Enabled Sep 17 20:47:25 raspberrypi volumio[17122]: info: Adding Signal Path Element [object Object] Sep 17 20:47:25 raspberrypi volumio[17122]: info: Adding fusiondspeq DSP Signal Path Element Sep 17 20:47:25 raspberrypi volumio[17122]: info: FusionDsp - ---- installed callbackRead Sep 17 20:47:25 raspberrypi volumio[17122]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Sep 17 20:47:25 raspberrypi volumio[17122]: Error: spawn /data/plugins/audio_interface/fusiondsp/camilladsp ENOENT Sep 17 20:47:25 raspberrypi volumio[17122]: at Process.ChildProcess._handle.onexit (internal/child_process.js:269:19) Sep 17 20:47:25 raspberrypi volumio[17122]: at onErrorNT (internal/child_process.js:465:16) Sep 17 20:47:25 raspberrypi volumio[17122]: at processTicksAndRejections (internal/process/task_queues.js:80:21) Sep 17 20:47:25 raspberrypi volumio[17122]: at runNextTicks (internal/process/task_queues.js:62:3) Sep 17 20:47:25 raspberrypi volumio[17122]: at listOnTimeout (internal/timers.js:523:9) Sep 17 20:47:25 raspberrypi volumio[17122]: at processTimers (internal/timers.js:497:7) { Sep 17 20:47:25 raspberrypi volumio[17122]: errno: -2, Sep 17 20:47:25 raspberrypi volumio[17122]: code: 'ENOENT', Sep 17 20:47:25 raspberrypi volumio[17122]: syscall: 'spawn /data/plugins/audio_interface/fusiondsp/camilladsp', Sep 17 20:47:25 raspberrypi volumio[17122]: path: '/data/plugins/audio_interface/fusiondsp/camilladsp', Sep 17 20:47:25 raspberrypi volumio[17122]: spawnargs: [ Sep 17 20:47:25 raspberrypi volumio[17122]: '-p', Sep 17 20:47:25 raspberrypi volumio[17122]: 9876, Sep 17 20:47:25 raspberrypi volumio[17122]: '-o', Sep 17 20:47:25 raspberrypi volumio[17122]: '/tmp/camilladsp.log', Sep 17 20:47:25 raspberrypi volumio[17122]: '-l', Sep 17 20:47:25 raspberrypi volumio[17122]: 'warn', Sep 17 20:47:25 raspberrypi volumio[17122]: '/data/configuration/audio_interface/fusiondsp/camilladsp.yml' Sep 17 20:47:25 raspberrypi volumio[17122]: ] Sep 17 20:47:25 raspberrypi volumio[17122]: } Sep 17 20:47:25 raspberrypi volumio[17122]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Sep 17 20:47:25 raspberrypi sudo[17365]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-09-17 20:46 Sep 17 20:47:25 raspberrypi sudo[17365]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:26 raspberrypi sudo[17365]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:26 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:26] [error] handle_read_frame error: websocketpp.transport:7 (End of File) Sep 17 20:47:26 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:26] [disconnect] Disconnect close local:[1006,End of File] remote:[1006] Sep 17 20:47:26 raspberrypi systemd[1]: volumio.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:26 raspberrypi sudo[17354]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:26 raspberrypi systemd[1]: volumio.service: Failed with result 'exit-code'. Sep 17 20:47:26 raspberrypi systemd[1]: Started dynamicswap service. Sep 17 20:47:26 raspberrypi systemd[1]: dynamicswap.service: Succeeded. Sep 17 20:47:26 raspberrypi systemd[1]: volumio.service: Service RestartSec=100ms expired, scheduling restart. Sep 17 20:47:26 raspberrypi systemd[1]: volumio.service: Scheduled restart job, restart counter is at 68. Sep 17 20:47:26 raspberrypi systemd[1]: Started dynamicswap service. Sep 17 20:47:26 raspberrypi systemd[1]: Stopped Volumio Backend Module. Sep 17 20:47:26 raspberrypi systemd[1]: Started Volumio Backend Module. Sep 17 20:47:26 raspberrypi systemd[1]: dynamicswap.service: Succeeded. Sep 17 20:47:27 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:27 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 247. Sep 17 20:47:27 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:27 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:28 raspberrypi volumio[17388]: Traceback (most recent call last): Sep 17 20:47:28 raspberrypi volumio[17388]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:28 raspberrypi volumio[17388]: from camilladsp import CamillaConnection Sep 17 20:47:28 raspberrypi volumio[17388]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:28 raspberrypi volumio[17376]: info: ------------------------------------------- Sep 17 20:47:28 raspberrypi volumio[17376]: info: ----- Volumio3 ---- Sep 17 20:47:28 raspberrypi volumio[17376]: info: ------------------------------------------- Sep 17 20:47:28 raspberrypi volumio[17376]: info: ----- System startup ---- Sep 17 20:47:28 raspberrypi volumio[17376]: info: ------------------------------------------- Sep 17 20:47:28 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:28 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:29 raspberrypi volumio[17376]: info: MYVOLUMIO Environment detected Sep 17 20:47:29 raspberrypi volumio[17376]: info: Plugin folders cleanup Sep 17 20:47:29 raspberrypi volumio[17376]: info: Scanning into folder /volumio/app/plugins/ Sep 17 20:47:29 raspberrypi volumio[17376]: info: Scanning category audio_interface Sep 17 20:47:29 raspberrypi volumio[17376]: info: Scanning category miscellanea Sep 17 20:47:29 raspberrypi volumio[17376]: info: Scanning category music_service Sep 17 20:47:29 raspberrypi volumio[17376]: info: Scanning category plugins.json Sep 17 20:47:29 raspberrypi volumio[17376]: info: Scanning category system_controller Sep 17 20:47:29 raspberrypi volumio[17376]: info: Scanning category user_interface Sep 17 20:47:29 raspberrypi volumio[17376]: info: Scanning into folder /data/plugins/ Sep 17 20:47:29 raspberrypi volumio[17376]: info: Scanning category audio_interface Sep 17 20:47:29 raspberrypi volumio[17376]: info: Scanning category music_service Sep 17 20:47:29 raspberrypi volumio[17376]: info: Plugin folders cleanup completed Sep 17 20:47:29 raspberrypi volumio[17376]: info: ------------------------------------------- Sep 17 20:47:29 raspberrypi volumio[17376]: info: ----- Core plugins startup ---- Sep 17 20:47:29 raspberrypi volumio[17376]: info: ------------------------------------------- Sep 17 20:47:29 raspberrypi volumio[17376]: info: Loading plugins from folder /volumio/app/plugins/ Sep 17 20:47:29 raspberrypi volumio[17376]: info: Adding plugin upnp to MyMusic Plugins Sep 17 20:47:29 raspberrypi volumio[17376]: info: Adding plugin airplay_emulation to MyMusic Plugins Sep 17 20:47:29 raspberrypi volumio[17376]: info: Adding plugin upnp_browser to MyMusic Plugins Sep 17 20:47:29 raspberrypi volumio[17376]: info: Loading plugins from folder /data/plugins/ Sep 17 20:47:29 raspberrypi volumio[17376]: info: Loading plugin "system"... Sep 17 20:47:29 raspberrypi volumio[17376]: info: Loading plugin "appearance"... Sep 17 20:47:30 raspberrypi volumio[17376]: info: Loading plugin "network"... Sep 17 20:47:30 raspberrypi volumio[17376]: info: Refreshing Cached IP Addresses Sep 17 20:47:30 raspberrypi sudo[17406]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Sep 17 20:47:30 raspberrypi sudo[17406]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:30 raspberrypi sudo[17406]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:30 raspberrypi sudo[17408]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Sep 17 20:47:30 raspberrypi sudo[17408]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:30 raspberrypi sudo[17408]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:30 raspberrypi volumio[17376]: info: Loading plugin "services"... Sep 17 20:47:30 raspberrypi volumio[17376]: info: Loading plugin "alsa_controller"... Sep 17 20:47:30 raspberrypi sudo[17417]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Sep 17 20:47:30 raspberrypi sudo[17417]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:30 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:47:30 raspberrypi volumio[17376]: info: Loading plugin "wizard"... Sep 17 20:47:30 raspberrypi volumio[17376]: info: Loading plugin "networkfs"... Sep 17 20:47:30 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:30 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 248. Sep 17 20:47:30 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:30 raspberrypi volumio[17376]: info: Cannot mount NAS Music at system boot, trial number 1 ,retrying in 5 seconds Sep 17 20:47:30 raspberrypi volumio[17376]: info: Starting Udev Watcher for removable devices Sep 17 20:47:30 raspberrypi volumio[17376]: info: Ignoring mount for partition: boot Sep 17 20:47:30 raspberrypi volumio[17376]: info: Ignoring mount for partition: volumio Sep 17 20:47:30 raspberrypi volumio[17376]: info: Ignoring mount for partition: volumio_data Sep 17 20:47:30 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:30 raspberrypi volumio[17376]: info: Loading plugin "volumio_command_line_client"... Sep 17 20:47:30 raspberrypi volumio[17376]: info: Loading plugin "upnp"... Sep 17 20:47:30 raspberrypi volumio[17376]: info: [1758134850989] Starting Upmpd Daemon Sep 17 20:47:30 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:30 raspberrypi volumio[17376]: info: Loading plugin "my_music"... Sep 17 20:47:30 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:31 raspberrypi volumio[17376]: info: Loading plugin "mpd"... Sep 17 20:47:31 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:31] [connect] Successful connection Sep 17 20:47:31 raspberrypi volumio[17376]: info: Loading plugin "upnp_browser"... Sep 17 20:47:31 raspberrypi sudo[17417]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:31 raspberrypi volumio[17376]: info: Loading plugin "alarm-clock"... Sep 17 20:47:31 raspberrypi volumio[17376]: info: Loading plugin "airplay_emulation"... Sep 17 20:47:32 raspberrypi volumio[17376]: info: Starting Shairport Sync Sep 17 20:47:32 raspberrypi volumio[17376]: info: Loading plugin "last_100"... Sep 17 20:47:32 raspberrypi volumio[17376]: info: Loading plugin "webradio"... Sep 17 20:47:32 raspberrypi volumio[17376]: info: Loading plugin "i2s_dacs"... Sep 17 20:47:32 raspberrypi volumio[17376]: info: I2S DAC not set, start Auto-detection Sep 17 20:47:32 raspberrypi volumio[17376]: info: Loading plugin "volumiodiscovery"... Sep 17 20:47:32 raspberrypi volumio[17376]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:32 raspberrypi volumio[17376]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:32 raspberrypi volumio[17376]: *** WARNING *** For more information see Sep 17 20:47:32 raspberrypi node[17376]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:32 raspberrypi volumio[17376]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:32 raspberrypi volumio[17376]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:32 raspberrypi volumio[17376]: *** WARNING *** For more information see Sep 17 20:47:32 raspberrypi node[17376]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:32 raspberrypi node[17376]: *** WARNING *** For more information see Sep 17 20:47:32 raspberrypi node[17376]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:32 raspberrypi node[17376]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:32 raspberrypi node[17376]: *** WARNING *** For more information see Sep 17 20:47:32 raspberrypi volumio[17376]: info: Applying required configuration parameters for plugin volumiodiscovery Sep 17 20:47:32 raspberrypi volumio[17376]: info: Discovery: Started advertising with name: raspberrypi Sep 17 20:47:32 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:32 raspberrypi volumio[17376]: info: Loading plugin "spop"... Sep 17 20:47:32 raspberrypi volumio[17433]: Traceback (most recent call last): Sep 17 20:47:32 raspberrypi volumio[17433]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:32 raspberrypi volumio[17433]: from camilladsp import CamillaConnection Sep 17 20:47:32 raspberrypi volumio[17433]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:32 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:32 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:33 raspberrypi volumio[17376]: info: Loading plugin "outputs"... Sep 17 20:47:33 raspberrypi volumio[17376]: info: Loading plugin "albumart"... Sep 17 20:47:33 raspberrypi volumio[17376]: info: Plugin example_plugin is not enabled Sep 17 20:47:33 raspberrypi volumio[17376]: info: Loading plugin "inputs"... Sep 17 20:47:33 raspberrypi volumio[17376]: info: Loading plugin "updater_comm"... Sep 17 20:47:33 raspberrypi volumio[17376]: info: Plugin mpdemulation is not enabled Sep 17 20:47:33 raspberrypi volumio[17376]: info: Loading plugin "rest_api"... Sep 17 20:47:33 raspberrypi volumio[17376]: info: Loading plugin "websocket"... Sep 17 20:47:33 raspberrypi volumio[17376]: info: Starting Socket.io Server version 2.3.0 Sep 17 20:47:33 raspberrypi volumio[17376]: info: Loading plugin "fusiondsp"... Sep 17 20:47:34 raspberrypi volumio[17376]: Forking 3 albumart workers Sep 17 20:47:34 raspberrypi volumio[17376]: info: Applying required configuration parameters for plugin fusiondsp Sep 17 20:47:34 raspberrypi volumio[17376]: info: Loading i18n strings for locale pl Sep 17 20:47:34 raspberrypi volumio[17376]: Updating browse sources language Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreCommandRouter::initPlayerControls Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 17 20:47:34 raspberrypi volumio[17376]: Express server listening on port 3000 Sep 17 20:47:34 raspberrypi volumio[17376]: [Metrics] WebUI: 6s 738.01ms Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreStateMachine::resetVolumioState Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreStateMachine::getcurrentVolume Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioRetrievevolume Sep 17 20:47:34 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:34 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 249. Sep 17 20:47:34 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:34 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:34 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:34 raspberrypi volumio[17376]: info: Volumio Network Manager: Network status updated: 3 Sep 17 20:47:35 raspberrypi volumio[17376]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 1 Sep 17 20:47:35 raspberrypi volumio[17376]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 2 Sep 17 20:47:35 raspberrypi volumio[17376]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 3 Sep 17 20:47:35 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:35] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=4&transport=websocket&t=1758134851 101 Sep 17 20:47:35 raspberrypi volumio[17376]: 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: 4 Sep 17 20:47:35 raspberrypi volumio[17376]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 5 Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:35 raspberrypi volumio[17376]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:35 raspberrypi volumio[17376]: Starting albumart workers Sep 17 20:47:35 raspberrypi volumio[17376]: Starting albumart workers Sep 17 20:47:35 raspberrypi volumio[17376]: info: Reloading queue from file Sep 17 20:47:35 raspberrypi volumio[17376]: info: Received Get System Info Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Sep 17 20:47:35 raspberrypi volumio[17376]: info: Discovery: Getting this device information Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:35 raspberrypi volumio[17376]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:35 raspberrypi volumio[17376]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioGetVisibleSources Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:35 raspberrypi volumio[17376]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioGetQueue Sep 17 20:47:35 raspberrypi volumio[17376]: Starting albumart workers Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreStateMachine::getQueue Sep 17 20:47:35 raspberrypi volumio[17376]: info: CorePlayQueue::getQueue Sep 17 20:47:35 raspberrypi volumio[17376]: info: Listing playlists Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Sep 17 20:47:35 raspberrypi volumio[17376]: info: Received Get System Info Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Sep 17 20:47:35 raspberrypi volumio[17376]: info: Discovery: Getting this device information Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:35 raspberrypi volumio[17376]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:35 raspberrypi volumio[17376]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:35 raspberrypi volumio[17376]: info: VolumeController:: Volume=0 Mute =false Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreStateMachine::pushState Sep 17 20:47:35 raspberrypi volumio[17376]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreStateMachine::updateTrackBlock Sep 17 20:47:35 raspberrypi volumio[17376]: info: CorePlayQueue::getTrackBlock Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioRetrievevolume Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreStateMachine::setRepeat false single undefined Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreStateMachine::pushState Sep 17 20:47:35 raspberrypi volumio[17376]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreStateMachine::setRandom null Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreStateMachine::pushState Sep 17 20:47:35 raspberrypi volumio[17376]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:35 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:35 raspberrypi volumio[17376]: info: Setting Device type: Raspberry PI Sep 17 20:47:35 raspberrypi volumio[17376]: info: Listing playlists Sep 17 20:47:35 raspberrypi volumio[17376]: info: Listing playlists Sep 17 20:47:36 raspberrypi volumio[17376]: info: Cannot mount NAS Music at system boot, trial number 2 ,retrying in 5 seconds Sep 17 20:47:36 raspberrypi volumio[17376]: info: Discovery: adding 1092a755-1821-4e66-be8c-eba752f9503e Sep 17 20:47:36 raspberrypi volumio[17376]: info: Discovery: Found device raspberrypi Sep 17 20:47:36 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:36 raspberrypi volumio[17376]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:36 raspberrypi volumio[17376]: info: Discovery: this is already registered, 1092a755-1821-4e66-be8c-eba752f9503e Sep 17 20:47:36 raspberrypi volumio[17376]: info: Discovery: Found device raspberrypi Sep 17 20:47:36 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:36 raspberrypi volumio[17376]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:36 raspberrypi volumio[17376]: info: Completed loading Core Plugins Sep 17 20:47:36 raspberrypi volumio[17376]: info: Preparing to generate the ALSA configuration file Sep 17 20:47:36 raspberrypi volumio[17376]: info: VolumeController:: Volume=0 Mute =false Sep 17 20:47:36 raspberrypi volumio[17376]: info: CoreStateMachine::pushState Sep 17 20:47:36 raspberrypi volumio[17376]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:36 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:36 raspberrypi volumio[17376]: info: The plugin fusiondsp has an ALSA contribution file volumioDsp.postDsp.10.conf Sep 17 20:47:36 raspberrypi volumio[17376]: info: Reading ALSA contributions from plugins. Sep 17 20:47:36 raspberrypi volumio[17376]: info: Asound.conf file unchanged, so no further update is needed Sep 17 20:47:36 raspberrypi volumio[17376]: info: Output device has changed, restarting MPD Sep 17 20:47:36 raspberrypi volumio[17376]: info: Output device has changed, restarting Shairport Sync Sep 17 20:47:36 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:36 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:36 raspberrypi volumio[17469]: Traceback (most recent call last): Sep 17 20:47:36 raspberrypi volumio[17469]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:36 raspberrypi volumio[17469]: from camilladsp import CamillaConnection Sep 17 20:47:36 raspberrypi volumio[17469]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:36 raspberrypi sudo[17482]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Sep 17 20:47:36 raspberrypi sudo[17482]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:36 raspberrypi sudo[17480]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Sep 17 20:47:36 raspberrypi sudo[17480]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:36 raspberrypi systemd[1]: Stopping Music Player Daemon... Sep 17 20:47:36 raspberrypi sudo[17480]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:36 raspberrypi volumio[17376]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 17 20:47:36 raspberrypi volumio[17376]: info: ___________ START PLUGINS ___________ Sep 17 20:47:36 raspberrypi systemd[1]: mpd.service: Succeeded. Sep 17 20:47:36 raspberrypi systemd[1]: Stopped Music Player Daemon. Sep 17 20:47:36 raspberrypi volumio[17376]: info: ControllerMpd::onStart: Initializing MPD Sep 17 20:47:36 raspberrypi volumio[17376]: info: Creating MPD Configuration file Sep 17 20:47:36 raspberrypi systemd[1]: Starting Music Player Daemon... Sep 17 20:47:36 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 17 20:47:36 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 17 20:47:36 raspberrypi volumio[17376]: info: [1758134856739] CoreMusicLibrary::Adding element Serwery Mediów Sep 17 20:47:36 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:36 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:36 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:36 raspberrypi sudo[17500]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Sep 17 20:47:36 raspberrypi sudo[17500]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:36 raspberrypi sudo[17498]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Sep 17 20:47:36 raspberrypi sudo[17498]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:36 raspberrypi sudo[17498]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:36 raspberrypi systemd[1]: mpd.service: Control process exited, code=killed, status=15/TERM Sep 17 20:47:36 raspberrypi systemd[1]: mpd.service: Succeeded. Sep 17 20:47:36 raspberrypi systemd[1]: Stopped Music Player Daemon. Sep 17 20:47:36 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:36 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:36 raspberrypi systemd[1]: Starting Music Player Daemon... Sep 17 20:47:36 raspberrypi volumio[17376]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 17 20:47:36 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:36 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 17 20:47:37 raspberrypi volumio[17376]: info: [1758134857055] CoreMusicLibrary::Adding element Last_100 Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 17 20:47:37 raspberrypi volumio[17376]: info: [1758134857060] CoreMusicLibrary::Adding element Webradio Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:47:37 raspberrypi volumio[17376]: info: Initializing BBC Radios Sep 17 20:47:37 raspberrypi sudo[17511]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Sep 17 20:47:37 raspberrypi sudo[17511]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:37 raspberrypi sudo[17511]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: Creating Spotify config file Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: Loading i18n strings for locale pl Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , updateALSAConfigFile Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: FusionDsp - mixtype--------------------- Hardware Sep 17 20:47:37 raspberrypi volumio[17376]: info: Volumio Calling Home Sep 17 20:47:37 raspberrypi volumio[17376]: info: Preparing to generate the ALSA configuration file Sep 17 20:47:37 raspberrypi volumio[17376]: info: The plugin fusiondsp has an ALSA contribution file volumioDsp.postDsp.10.conf Sep 17 20:47:37 raspberrypi volumio[17376]: info: Reading ALSA contributions from plugins. Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:37 raspberrypi volumio[17376]: info: MPD Permissions set Sep 17 20:47:37 raspberrypi volumio[17376]: info: MPD Permissions set Sep 17 20:47:37 raspberrypi volumio[17376]: info: Spotify config file written Sep 17 20:47:37 raspberrypi volumio[17376]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 6 Sep 17 20:47:37 raspberrypi sudo[17542]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart go-librespot-daemon.service Sep 17 20:47:37 raspberrypi volumio[17376]: info: Volumio called home Sep 17 20:47:37 raspberrypi sudo[17542]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi systemd[1]: Stopping go-librespot Daemon... Sep 17 20:47:37 raspberrypi systemd[1]: go-librespot-daemon.service: Main process exited, code=killed, status=15/TERM Sep 17 20:47:37 raspberrypi systemd[1]: go-librespot-daemon.service: Succeeded. Sep 17 20:47:37 raspberrypi systemd[1]: Stopped go-librespot Daemon. Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:37 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:37 raspberrypi systemd[1]: Started go-librespot Daemon. Sep 17 20:47:37 raspberrypi go-librespot[17548]: go-librespot daemon starting... Sep 17 20:47:37 raspberrypi volumio[17376]: info: No need to fix Spotify hosts Sep 17 20:47:37 raspberrypi sudo[17542]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:37 raspberrypi go-librespot[17548]: time="2025-09-17T20:47:37+02:00" level=info msg="running go-librespot 0.3.2" Sep 17 20:47:37 raspberrypi go-librespot[17548]: time="2025-09-17T20:47:37+02:00" level=debug msg="app state loaded" Sep 17 20:47:37 raspberrypi go-librespot[17548]: time="2025-09-17T20:47:37+02:00" level=debug msg="stored credentials not found" Sep 17 20:47:37 raspberrypi go-librespot[17548]: time="2025-09-17T20:47:37+02:00" level=info msg="api server listening on 127.0.0.1:9879" Sep 17 20:47:37 raspberrypi volumio[17376]: info: FusionDsp - Sep 17 20:47:38 raspberrypi go-librespot[17548]: time="2025-09-17T20:47:38+02:00" level=debug msg="fetched new accesspoints: [ap-gew4.spotify.com:4070 ap-gew4.spotify.com:443 ap-gew4.spotify.com:80 ap-guc3.spotify.com:4070 ap-gew1.spotify.com:443 ap-gae2.spotify.com:80]" Sep 17 20:47:38 raspberrypi go-librespot[17548]: time="2025-09-17T20:47:38+02:00" level=debug msg="fetched new dealers: [gew4-dealer.spotify.com:443 guc3-dealer.spotify.com:443 gew1-dealer.spotify.com:443 gae2-dealer.spotify.com:443]" Sep 17 20:47:38 raspberrypi go-librespot[17548]: time="2025-09-17T20:47:38+02:00" level=debug msg="fetched new spclients: [gew4-spclient.spotify.com:443 guc3-spclient.spotify.com:443 gew1-spclient.spotify.com:443 gae2-spclient.spotify.com:443]" Sep 17 20:47:38 raspberrypi go-librespot[17548]: time="2025-09-17T20:47:38+02:00" level=info msg="zeroconf server listening on port 35603" Sep 17 20:47:38 raspberrypi volumio[17376]: info: FusionDsp - Sep 17 20:47:38 raspberrypi volumio[17376]: info: FusionDsp - Sep 17 20:47:38 raspberrypi volumio[17376]: info: FusionDsp - Sep 17 20:47:38 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:38 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 250. Sep 17 20:47:38 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:38 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:39 raspberrypi mpd[17522]: Sep 17 20:47 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Sep 17 20:47:39 raspberrypi systemd[1]: Started Music Player Daemon. Sep 17 20:47:39 raspberrypi sudo[17482]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:39 raspberrypi sudo[17500]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:39 raspberrypi volumio[17376]: /usr/bin/mkfifo: cannot create fifo '/tmp/fusiondspfifo': File exists Sep 17 20:47:39 raspberrypi volumio[17376]: error: FusionDsp - ----failed to create fusiondspfifo :Error: Command failed: /bin/touch /tmp/fusiondsp_stream_params.log && /bin/chmod 666 /tmp/fusiondsp_stream_params.log && /bin/touch /tmp/camilladsp.log && /bin/chmod 666 /tmp/camilladsp.log && /usr/bin/mkfifo -m 646 /tmp/fusiondspfifo Sep 17 20:47:39 raspberrypi volumio[17376]: /usr/bin/mkfifo: cannot create fifo '/tmp/fusiondspfifo': File exists Sep 17 20:47:39 raspberrypi volumio[17376]: info: camilladsp service started and running in background, instance 1 Sep 17 20:47:39 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:39 raspberrypi volumio[17376]: /bin/sh: 1: /data/plugins/audio_interface/fusiondsp/hw_params: not found Sep 17 20:47:39 raspberrypi volumio[17376]: error: FusionDsp - ----Hw detection failed :Error: Command failed: /data/plugins/audio_interface/fusiondsp/hw_params volumioHw >/data/configuration/audio_interface/fusiondsp/hwinfo.json Sep 17 20:47:39 raspberrypi volumio[17376]: /bin/sh: 1: /data/plugins/audio_interface/fusiondsp/hw_params: not found Sep 17 20:47:39 raspberrypi volumio[17376]: info: FusionDsp loaded Sep 17 20:47:39 raspberrypi volumio[17376]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 17 20:47:39 raspberrypi sudo[17574]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start fusiondsp.service Sep 17 20:47:39 raspberrypi sudo[17574]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:39 raspberrypi sudo[17574]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:39 raspberrypi volumio[17376]: info: FusionDsp - Reporting Fusion DSP Enabled Sep 17 20:47:39 raspberrypi volumio[17376]: info: Adding Signal Path Element [object Object] Sep 17 20:47:39 raspberrypi volumio[17376]: info: Adding fusiondspeq DSP Signal Path Element Sep 17 20:47:39 raspberrypi volumio[17376]: info: FusionDsp - ---- installed callbackRead Sep 17 20:47:39 raspberrypi volumio[17376]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Sep 17 20:47:39 raspberrypi volumio[17376]: Error: spawn /data/plugins/audio_interface/fusiondsp/camilladsp ENOENT Sep 17 20:47:39 raspberrypi volumio[17376]: at Process.ChildProcess._handle.onexit (internal/child_process.js:269:19) Sep 17 20:47:39 raspberrypi volumio[17376]: at onErrorNT (internal/child_process.js:465:16) Sep 17 20:47:39 raspberrypi volumio[17376]: at processTicksAndRejections (internal/process/task_queues.js:80:21) Sep 17 20:47:39 raspberrypi volumio[17376]: at runNextTicks (internal/process/task_queues.js:62:3) Sep 17 20:47:39 raspberrypi volumio[17376]: at listOnTimeout (internal/timers.js:523:9) Sep 17 20:47:39 raspberrypi volumio[17376]: at processTimers (internal/timers.js:497:7) { Sep 17 20:47:39 raspberrypi volumio[17376]: errno: -2, Sep 17 20:47:39 raspberrypi volumio[17376]: code: 'ENOENT', Sep 17 20:47:39 raspberrypi volumio[17376]: syscall: 'spawn /data/plugins/audio_interface/fusiondsp/camilladsp', Sep 17 20:47:39 raspberrypi volumio[17376]: path: '/data/plugins/audio_interface/fusiondsp/camilladsp', Sep 17 20:47:39 raspberrypi volumio[17376]: spawnargs: [ Sep 17 20:47:39 raspberrypi volumio[17376]: '-p', Sep 17 20:47:39 raspberrypi volumio[17376]: 9876, Sep 17 20:47:39 raspberrypi volumio[17376]: '-o', Sep 17 20:47:39 raspberrypi volumio[17376]: '/tmp/camilladsp.log', Sep 17 20:47:39 raspberrypi volumio[17376]: '-l', Sep 17 20:47:39 raspberrypi volumio[17376]: 'warn', Sep 17 20:47:39 raspberrypi volumio[17376]: '/data/configuration/audio_interface/fusiondsp/camilladsp.yml' Sep 17 20:47:39 raspberrypi volumio[17376]: ] Sep 17 20:47:39 raspberrypi volumio[17376]: } Sep 17 20:47:39 raspberrypi volumio[17376]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Sep 17 20:47:40 raspberrypi sudo[17585]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-09-17 20:46 Sep 17 20:47:40 raspberrypi sudo[17585]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:40 raspberrypi volumio[17560]: Traceback (most recent call last): Sep 17 20:47:40 raspberrypi volumio[17560]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:40 raspberrypi volumio[17560]: from camilladsp import CamillaConnection Sep 17 20:47:40 raspberrypi volumio[17560]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:40 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:40 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:40 raspberrypi sudo[17585]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:40 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:40] [error] handle_read_frame error: websocketpp.transport:7 (End of File) Sep 17 20:47:40 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:40] [disconnect] Disconnect close local:[1006,End of File] remote:[1006] Sep 17 20:47:40 raspberrypi systemd[1]: volumio.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:40 raspberrypi systemd[1]: volumio.service: Failed with result 'exit-code'. Sep 17 20:47:40 raspberrypi systemd[1]: Started dynamicswap service. Sep 17 20:47:40 raspberrypi systemd[1]: dynamicswap.service: Succeeded. Sep 17 20:47:41 raspberrypi systemd[1]: volumio.service: Service RestartSec=100ms expired, scheduling restart. Sep 17 20:47:41 raspberrypi systemd[1]: volumio.service: Scheduled restart job, restart counter is at 69. Sep 17 20:47:41 raspberrypi systemd[1]: Stopped Volumio Backend Module. Sep 17 20:47:41 raspberrypi systemd[1]: Started Volumio Backend Module. Sep 17 20:47:41 raspberrypi systemd[1]: Started dynamicswap service. Sep 17 20:47:41 raspberrypi systemd[1]: dynamicswap.service: Succeeded. Sep 17 20:47:42 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:42 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 251. Sep 17 20:47:42 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:43 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:43 raspberrypi volumio[17609]: info: ------------------------------------------- Sep 17 20:47:43 raspberrypi volumio[17609]: info: ----- Volumio3 ---- Sep 17 20:47:43 raspberrypi volumio[17609]: info: ------------------------------------------- Sep 17 20:47:43 raspberrypi volumio[17609]: info: ----- System startup ---- Sep 17 20:47:43 raspberrypi volumio[17609]: info: ------------------------------------------- Sep 17 20:47:44 raspberrypi volumio[17609]: info: MYVOLUMIO Environment detected Sep 17 20:47:44 raspberrypi volumio[17609]: info: Plugin folders cleanup Sep 17 20:47:44 raspberrypi volumio[17609]: info: Scanning into folder /volumio/app/plugins/ Sep 17 20:47:44 raspberrypi volumio[17609]: info: Scanning category audio_interface Sep 17 20:47:44 raspberrypi volumio[17609]: info: Scanning category miscellanea Sep 17 20:47:44 raspberrypi volumio[17609]: info: Scanning category music_service Sep 17 20:47:44 raspberrypi volumio[17609]: info: Scanning category plugins.json Sep 17 20:47:44 raspberrypi volumio[17609]: info: Scanning category system_controller Sep 17 20:47:44 raspberrypi volumio[17609]: info: Scanning category user_interface Sep 17 20:47:44 raspberrypi volumio[17609]: info: Scanning into folder /data/plugins/ Sep 17 20:47:44 raspberrypi volumio[17609]: info: Scanning category audio_interface Sep 17 20:47:44 raspberrypi volumio[17609]: info: Scanning category music_service Sep 17 20:47:44 raspberrypi volumio[17609]: info: Plugin folders cleanup completed Sep 17 20:47:44 raspberrypi volumio[17609]: info: ------------------------------------------- Sep 17 20:47:44 raspberrypi volumio[17609]: info: ----- Core plugins startup ---- Sep 17 20:47:44 raspberrypi volumio[17609]: info: ------------------------------------------- Sep 17 20:47:44 raspberrypi volumio[17609]: info: Loading plugins from folder /volumio/app/plugins/ Sep 17 20:47:44 raspberrypi volumio[17609]: info: Adding plugin upnp to MyMusic Plugins Sep 17 20:47:44 raspberrypi volumio[17609]: info: Adding plugin airplay_emulation to MyMusic Plugins Sep 17 20:47:44 raspberrypi volumio[17609]: info: Adding plugin upnp_browser to MyMusic Plugins Sep 17 20:47:44 raspberrypi volumio[17609]: info: Loading plugins from folder /data/plugins/ Sep 17 20:47:44 raspberrypi volumio[17609]: info: Loading plugin "system"... Sep 17 20:47:44 raspberrypi volumio[17609]: info: Loading plugin "appearance"... Sep 17 20:47:44 raspberrypi volumio[17622]: Traceback (most recent call last): Sep 17 20:47:44 raspberrypi volumio[17622]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:44 raspberrypi volumio[17622]: from camilladsp import CamillaConnection Sep 17 20:47:44 raspberrypi volumio[17622]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:44 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:44 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:45 raspberrypi volumio[17609]: info: Loading plugin "network"... Sep 17 20:47:45 raspberrypi volumio[17609]: info: Refreshing Cached IP Addresses Sep 17 20:47:45 raspberrypi sudo[17637]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Sep 17 20:47:45 raspberrypi sudo[17637]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:45 raspberrypi sudo[17637]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:45 raspberrypi sudo[17639]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Sep 17 20:47:45 raspberrypi sudo[17639]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:45 raspberrypi sudo[17639]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:45 raspberrypi volumio[17609]: info: Loading plugin "services"... Sep 17 20:47:45 raspberrypi volumio[17609]: info: Loading plugin "alsa_controller"... Sep 17 20:47:45 raspberrypi sudo[17652]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Sep 17 20:47:45 raspberrypi sudo[17652]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:45 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:47:45 raspberrypi volumio[17609]: info: Loading plugin "wizard"... Sep 17 20:47:45 raspberrypi volumio[17609]: info: Loading plugin "networkfs"... Sep 17 20:47:45 raspberrypi volumio[17609]: info: Cannot mount NAS Music at system boot, trial number 1 ,retrying in 5 seconds Sep 17 20:47:45 raspberrypi volumio[17609]: info: Starting Udev Watcher for removable devices Sep 17 20:47:45 raspberrypi volumio[17609]: info: Ignoring mount for partition: boot Sep 17 20:47:45 raspberrypi volumio[17609]: info: Ignoring mount for partition: volumio Sep 17 20:47:45 raspberrypi volumio[17609]: info: Ignoring mount for partition: volumio_data Sep 17 20:47:45 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:45 raspberrypi volumio[17609]: info: Loading plugin "volumio_command_line_client"... Sep 17 20:47:45 raspberrypi volumio[17609]: info: Loading plugin "upnp"... Sep 17 20:47:45 raspberrypi volumio[17609]: info: [1758134865807] Starting Upmpd Daemon Sep 17 20:47:45 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:45 raspberrypi volumio[17609]: info: Loading plugin "my_music"... Sep 17 20:47:45 raspberrypi volumio[17609]: info: Loading plugin "mpd"... Sep 17 20:47:45 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:45] [connect] Successful connection Sep 17 20:47:46 raspberrypi volumio[17609]: info: Loading plugin "upnp_browser"... Sep 17 20:47:46 raspberrypi volumio[17609]: info: Loading plugin "alarm-clock"... Sep 17 20:47:46 raspberrypi sudo[17652]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:46 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:46 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 252. Sep 17 20:47:46 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:46 raspberrypi volumio[17609]: info: Loading plugin "airplay_emulation"... Sep 17 20:47:46 raspberrypi volumio[17609]: info: Starting Shairport Sync Sep 17 20:47:46 raspberrypi volumio[17609]: info: Loading plugin "last_100"... Sep 17 20:47:46 raspberrypi volumio[17609]: info: Loading plugin "webradio"... Sep 17 20:47:46 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:46 raspberrypi volumio[17609]: info: Loading plugin "i2s_dacs"... Sep 17 20:47:46 raspberrypi volumio[17609]: info: I2S DAC not set, start Auto-detection Sep 17 20:47:46 raspberrypi volumio[17609]: info: Loading plugin "volumiodiscovery"... Sep 17 20:47:46 raspberrypi volumio[17609]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:46 raspberrypi volumio[17609]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:46 raspberrypi volumio[17609]: *** WARNING *** For more information see Sep 17 20:47:46 raspberrypi node[17609]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:46 raspberrypi volumio[17609]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:46 raspberrypi volumio[17609]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:46 raspberrypi volumio[17609]: *** WARNING *** For more information see Sep 17 20:47:46 raspberrypi node[17609]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:46 raspberrypi node[17609]: *** WARNING *** For more information see Sep 17 20:47:46 raspberrypi node[17609]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:46 raspberrypi node[17609]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:46 raspberrypi node[17609]: *** WARNING *** For more information see Sep 17 20:47:46 raspberrypi volumio[17609]: info: Applying required configuration parameters for plugin volumiodiscovery Sep 17 20:47:46 raspberrypi volumio[17609]: info: Discovery: Started advertising with name: raspberrypi Sep 17 20:47:46 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:46 raspberrypi volumio[17609]: info: Loading plugin "spop"... Sep 17 20:47:48 raspberrypi volumio[17664]: Traceback (most recent call last): Sep 17 20:47:48 raspberrypi volumio[17664]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:48 raspberrypi volumio[17664]: from camilladsp import CamillaConnection Sep 17 20:47:48 raspberrypi volumio[17664]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:48 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:48 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:48 raspberrypi volumio[17609]: info: Loading plugin "outputs"... Sep 17 20:47:48 raspberrypi volumio[17609]: info: Loading plugin "albumart"... Sep 17 20:47:48 raspberrypi volumio[17609]: info: Plugin example_plugin is not enabled Sep 17 20:47:48 raspberrypi volumio[17609]: info: Loading plugin "inputs"... Sep 17 20:47:48 raspberrypi volumio[17609]: info: Loading plugin "updater_comm"... Sep 17 20:47:48 raspberrypi volumio[17609]: info: Plugin mpdemulation is not enabled Sep 17 20:47:48 raspberrypi volumio[17609]: info: Loading plugin "rest_api"... Sep 17 20:47:48 raspberrypi volumio[17609]: info: Loading plugin "websocket"... Sep 17 20:47:48 raspberrypi volumio[17609]: info: Starting Socket.io Server version 2.3.0 Sep 17 20:47:48 raspberrypi volumio[17609]: info: Loading plugin "fusiondsp"... Sep 17 20:47:48 raspberrypi volumio[17609]: Forking 3 albumart workers Sep 17 20:47:48 raspberrypi volumio[17609]: info: Applying required configuration parameters for plugin fusiondsp Sep 17 20:47:49 raspberrypi volumio[17609]: info: Loading i18n strings for locale pl Sep 17 20:47:49 raspberrypi volumio[17609]: Updating browse sources language Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreCommandRouter::initPlayerControls Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 17 20:47:49 raspberrypi volumio[17609]: Express server listening on port 3000 Sep 17 20:47:49 raspberrypi volumio[17609]: [Metrics] WebUI: 6s 837.48ms Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreStateMachine::resetVolumioState Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreStateMachine::getcurrentVolume Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioRetrievevolume Sep 17 20:47:49 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:47:49 raspberrypi volumio[17609]: info: Volumio Network Manager: Network status updated: 3 Sep 17 20:47:49 raspberrypi volumio[17609]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 1 Sep 17 20:47:49 raspberrypi volumio[17609]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 2 Sep 17 20:47:49 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:49] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=4&transport=websocket&t=1758134865 101 Sep 17 20:47:49 raspberrypi volumio[17609]: 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: 3 Sep 17 20:47:49 raspberrypi volumio[17609]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 4 Sep 17 20:47:49 raspberrypi volumio[17609]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 5 Sep 17 20:47:49 raspberrypi volumio[17609]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 6 Sep 17 20:47:49 raspberrypi volumio[17609]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 7 Sep 17 20:47:49 raspberrypi volumio[17609]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 8 Sep 17 20:47:49 raspberrypi volumio[17609]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 9 Sep 17 20:47:50 raspberrypi volumio[17609]: Starting albumart workers Sep 17 20:47:50 raspberrypi volumio[17609]: info: Reloading queue from file Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreStateMachine::setRepeat false single undefined Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreStateMachine::pushState Sep 17 20:47:50 raspberrypi volumio[17609]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreStateMachine::setRandom null Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreStateMachine::pushState Sep 17 20:47:50 raspberrypi volumio[17609]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:50 raspberrypi volumio[17609]: info: Setting Device type: Raspberry PI Sep 17 20:47:50 raspberrypi volumio[17609]: info: Received Get System Info Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Sep 17 20:47:50 raspberrypi volumio[17609]: info: Discovery: Getting this device information Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:50 raspberrypi volumio[17609]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:50 raspberrypi volumio[17609]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioGetVisibleSources Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:50 raspberrypi volumio[17609]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioGetQueue Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreStateMachine::getQueue Sep 17 20:47:50 raspberrypi volumio[17609]: info: CorePlayQueue::getQueue Sep 17 20:47:50 raspberrypi volumio[17609]: info: Listing playlists Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Sep 17 20:47:50 raspberrypi volumio[17609]: info: Received Get System Info Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Sep 17 20:47:50 raspberrypi volumio[17609]: info: Discovery: Getting this device information Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:50 raspberrypi volumio[17609]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:50 raspberrypi volumio[17609]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:50 raspberrypi volumio[17609]: info: VolumeController:: Volume=0 Mute =false Sep 17 20:47:50 raspberrypi volumio[17609]: Starting albumart workers Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreStateMachine::pushState Sep 17 20:47:50 raspberrypi volumio[17609]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreStateMachine::updateTrackBlock Sep 17 20:47:50 raspberrypi volumio[17609]: info: CorePlayQueue::getTrackBlock Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioRetrievevolume Sep 17 20:47:50 raspberrypi volumio[17609]: Starting albumart workers Sep 17 20:47:50 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:50 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 253. Sep 17 20:47:50 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:50 raspberrypi volumio[17609]: info: Discovery: adding 1092a755-1821-4e66-be8c-eba752f9503e Sep 17 20:47:50 raspberrypi volumio[17609]: info: Discovery: Found device raspberrypi Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:50 raspberrypi volumio[17609]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:50 raspberrypi volumio[17609]: info: Completed loading Core Plugins Sep 17 20:47:50 raspberrypi volumio[17609]: info: Preparing to generate the ALSA configuration file Sep 17 20:47:50 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:50 raspberrypi volumio[17609]: info: Discovery: this is already registered, 1092a755-1821-4e66-be8c-eba752f9503e Sep 17 20:47:50 raspberrypi volumio[17609]: info: Discovery: Found device raspberrypi Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioGetState Sep 17 20:47:50 raspberrypi volumio[17609]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:50 raspberrypi volumio[17609]: info: The plugin fusiondsp has an ALSA contribution file volumioDsp.postDsp.10.conf Sep 17 20:47:50 raspberrypi volumio[17609]: info: Reading ALSA contributions from plugins. Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:47:50 raspberrypi volumio[17609]: info: VolumeController:: Volume=0 Mute =false Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreStateMachine::pushState Sep 17 20:47:50 raspberrypi volumio[17609]: info: CorePlayQueue::getTrack 0 Sep 17 20:47:50 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioPushState Sep 17 20:47:50 raspberrypi volumio[17609]: info: FusionDsp - Sep 17 20:47:51 raspberrypi volumio[17609]: info: FusionDsp - Sep 17 20:47:51 raspberrypi volumio[17609]: info: FusionDsp - Sep 17 20:47:51 raspberrypi volumio[17609]: info: FusionDsp - Sep 17 20:47:52 raspberrypi volumio[17609]: info: Cannot mount NAS Music at system boot, trial number 2 ,retrying in 5 seconds Sep 17 20:47:52 raspberrypi volumio[17609]: info: FusionDsp - undefined Sep 17 20:47:52 raspberrypi volumio[17711]: Traceback (most recent call last): Sep 17 20:47:52 raspberrypi volumio[17711]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:52 raspberrypi volumio[17711]: from camilladsp import CamillaConnection Sep 17 20:47:52 raspberrypi volumio[17711]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:52 raspberrypi volumio[17609]: info: FusionDsp - undefined Sep 17 20:47:52 raspberrypi volumio[17609]: info: FusionDsp - undefined Sep 17 20:47:52 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:52 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:52 raspberrypi volumio[17609]: info: FusionDsp - undefined Sep 17 20:47:52 raspberrypi volumio[17609]: info: Preload queue cleared Sep 17 20:47:52 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioReplaceandPlayItems Sep 17 20:47:52 raspberrypi volumio[17609]: info: CoreStateMachine::ClearQueue Sep 17 20:47:52 raspberrypi volumio[17609]: info: CoreStateMachine::stop Sep 17 20:47:52 raspberrypi volumio[17609]: info: CoreStateMachine::setConsumeUpdateService undefined Sep 17 20:47:52 raspberrypi volumio[17609]: info: CorePlayQueue::clearPlayQueue Sep 17 20:47:52 raspberrypi volumio[17609]: info: CorePlayQueue::saveQueue Sep 17 20:47:52 raspberrypi volumio[17609]: info: CoreCommandRouter::volumioPushQueue Sep 17 20:47:52 raspberrypi volumio[17609]: info: CoreStateMachine::addQueueItems Sep 17 20:47:52 raspberrypi volumio[17609]: info: CorePlayQueue::addQueueItems Sep 17 20:47:52 raspberrypi volumio[17609]: info: Preload queue cleared Sep 17 20:47:52 raspberrypi volumio[17609]: info: Adding Item to queue: music-library/NAS/Music/The Doors/The Doors - Discography [FLAC] [PMEDIA]/(1968) - The Doors - Waiting For The Sun [24Bit-96kHz]/01. Hello, I Love You.flac Sep 17 20:47:52 raspberrypi volumio[17609]: info: Exploding uri music-library/NAS/Music/The Doors/The Doors - Discography [FLAC] [PMEDIA]/(1968) - The Doors - Waiting For The Sun [24Bit-96kHz]/01. Hello, I Love You.flac in service mpd Sep 17 20:47:52 raspberrypi volumio[17609]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Sep 17 20:47:52 raspberrypi volumio[17609]: TypeError: Cannot read property 'then' of undefined Sep 17 20:47:52 raspberrypi volumio[17609]: at ControllerMpd.scanFolder (/volumio/app/plugins/music_service/mpd/index.js:2528:19) Sep 17 20:47:52 raspberrypi volumio[17609]: at ControllerMpd.explodeUri (/volumio/app/plugins/music_service/mpd/index.js:2326:21) Sep 17 20:47:52 raspberrypi volumio[17609]: at CoreCommandRouter.explodeUriFromService (/volumio/app/index.js:1384:16) Sep 17 20:47:52 raspberrypi volumio[17609]: at CorePlayQueue.explodeUriFromCache (/volumio/app/playqueue.js:123:24) Sep 17 20:47:52 raspberrypi volumio[17609]: at CorePlayQueue.explodeUri (/volumio/app/playqueue.js:181:19) Sep 17 20:47:52 raspberrypi volumio[17609]: at CorePlayQueue.addQueueItems (/volumio/app/playqueue.js:223:30) Sep 17 20:47:52 raspberrypi volumio[17609]: at CoreStateMachine.addQueueItems (/volumio/app/statemachine.js:249:25) Sep 17 20:47:52 raspberrypi volumio[17609]: at CoreCommandRouter.replaceAndPlay (/volumio/app/index.js:511:25) Sep 17 20:47:52 raspberrypi volumio[17609]: at CoreCommandRouter.playItemsList (/volumio/app/index.js:484:17) Sep 17 20:47:52 raspberrypi volumio[17609]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:142:33) Sep 17 20:47:52 raspberrypi volumio[17609]: at Socket.emit (events.js:315:20) Sep 17 20:47:52 raspberrypi volumio[17609]: at /volumio/node_modules/socket.io/lib/socket.js:528:12 Sep 17 20:47:52 raspberrypi volumio[17609]: at processTicksAndRejections (internal/process/task_queues.js:75:11) Sep 17 20:47:52 raspberrypi volumio[17609]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Sep 17 20:47:53 raspberrypi sudo[17746]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-09-17 20:46 Sep 17 20:47:53 raspberrypi sudo[17746]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:53 raspberrypi sudo[17746]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:53 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:53] [error] handle_read_frame error: websocketpp.transport:7 (End of File) Sep 17 20:47:53 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:53] [disconnect] Disconnect close local:[1006,End of File] remote:[1006] Sep 17 20:47:53 raspberrypi systemd[1]: volumio.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:53 raspberrypi systemd[1]: volumio.service: Failed with result 'exit-code'. Sep 17 20:47:53 raspberrypi systemd[1]: Started dynamicswap service. Sep 17 20:47:53 raspberrypi systemd[1]: dynamicswap.service: Succeeded. Sep 17 20:47:54 raspberrypi systemd[1]: volumio.service: Service RestartSec=100ms expired, scheduling restart. Sep 17 20:47:54 raspberrypi systemd[1]: volumio.service: Scheduled restart job, restart counter is at 70. Sep 17 20:47:54 raspberrypi systemd[1]: Started dynamicswap service. Sep 17 20:47:54 raspberrypi systemd[1]: Stopped Volumio Backend Module. Sep 17 20:47:54 raspberrypi systemd[1]: Started Volumio Backend Module. Sep 17 20:47:54 raspberrypi systemd[1]: dynamicswap.service: Succeeded. Sep 17 20:47:54 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:54 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 254. Sep 17 20:47:54 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:54 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:55 raspberrypi volumio[17772]: Traceback (most recent call last): Sep 17 20:47:55 raspberrypi volumio[17772]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:55 raspberrypi volumio[17772]: from camilladsp import CamillaConnection Sep 17 20:47:55 raspberrypi volumio[17772]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:55 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:55 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:56 raspberrypi volumio[17760]: info: ------------------------------------------- Sep 17 20:47:56 raspberrypi volumio[17760]: info: ----- Volumio3 ---- Sep 17 20:47:56 raspberrypi volumio[17760]: info: ------------------------------------------- Sep 17 20:47:56 raspberrypi volumio[17760]: info: ----- System startup ---- Sep 17 20:47:56 raspberrypi volumio[17760]: info: ------------------------------------------- Sep 17 20:47:57 raspberrypi volumio[17760]: info: MYVOLUMIO Environment detected Sep 17 20:47:57 raspberrypi volumio[17760]: info: Plugin folders cleanup Sep 17 20:47:57 raspberrypi volumio[17760]: info: Scanning into folder /volumio/app/plugins/ Sep 17 20:47:57 raspberrypi volumio[17760]: info: Scanning category audio_interface Sep 17 20:47:57 raspberrypi volumio[17760]: info: Scanning category miscellanea Sep 17 20:47:57 raspberrypi volumio[17760]: info: Scanning category music_service Sep 17 20:47:57 raspberrypi volumio[17760]: info: Scanning category plugins.json Sep 17 20:47:57 raspberrypi volumio[17760]: info: Scanning category system_controller Sep 17 20:47:57 raspberrypi volumio[17760]: info: Scanning category user_interface Sep 17 20:47:57 raspberrypi volumio[17760]: info: Scanning into folder /data/plugins/ Sep 17 20:47:57 raspberrypi volumio[17760]: info: Scanning category audio_interface Sep 17 20:47:57 raspberrypi volumio[17760]: info: Scanning category music_service Sep 17 20:47:57 raspberrypi volumio[17760]: info: Plugin folders cleanup completed Sep 17 20:47:57 raspberrypi volumio[17760]: info: ------------------------------------------- Sep 17 20:47:57 raspberrypi volumio[17760]: info: ----- Core plugins startup ---- Sep 17 20:47:57 raspberrypi volumio[17760]: info: ------------------------------------------- Sep 17 20:47:57 raspberrypi volumio[17760]: info: Loading plugins from folder /volumio/app/plugins/ Sep 17 20:47:57 raspberrypi volumio[17760]: info: Adding plugin upnp to MyMusic Plugins Sep 17 20:47:57 raspberrypi volumio[17760]: info: Adding plugin airplay_emulation to MyMusic Plugins Sep 17 20:47:57 raspberrypi volumio[17760]: info: Adding plugin upnp_browser to MyMusic Plugins Sep 17 20:47:57 raspberrypi volumio[17760]: info: Loading plugins from folder /data/plugins/ Sep 17 20:47:57 raspberrypi volumio[17760]: info: Loading plugin "system"... Sep 17 20:47:57 raspberrypi volumio[17760]: info: Loading plugin "appearance"... Sep 17 20:47:58 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:47:58 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 255. Sep 17 20:47:58 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:47:58 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:47:58 raspberrypi volumio[17760]: info: Loading plugin "network"... Sep 17 20:47:58 raspberrypi volumio[17760]: info: Refreshing Cached IP Addresses Sep 17 20:47:58 raspberrypi sudo[17788]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Sep 17 20:47:58 raspberrypi sudo[17788]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:58 raspberrypi sudo[17790]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Sep 17 20:47:58 raspberrypi sudo[17788]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:58 raspberrypi sudo[17790]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:58 raspberrypi sudo[17790]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:58 raspberrypi volumio[17760]: info: Loading plugin "services"... Sep 17 20:47:58 raspberrypi volumio[17760]: info: Loading plugin "alsa_controller"... Sep 17 20:47:58 raspberrypi sudo[17799]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Sep 17 20:47:58 raspberrypi sudo[17799]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:47:58 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:47:58 raspberrypi volumio[17760]: info: Loading plugin "wizard"... Sep 17 20:47:58 raspberrypi volumio[17760]: info: Loading plugin "networkfs"... Sep 17 20:47:58 raspberrypi volumio[17760]: info: Cannot mount NAS Music at system boot, trial number 1 ,retrying in 5 seconds Sep 17 20:47:58 raspberrypi volumio[17760]: info: Starting Udev Watcher for removable devices Sep 17 20:47:58 raspberrypi volumio[17760]: info: Ignoring mount for partition: boot Sep 17 20:47:58 raspberrypi volumio[17760]: info: Ignoring mount for partition: volumio Sep 17 20:47:58 raspberrypi volumio[17760]: info: Ignoring mount for partition: volumio_data Sep 17 20:47:58 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:58 raspberrypi volumio[17760]: info: Loading plugin "volumio_command_line_client"... Sep 17 20:47:58 raspberrypi volumio[17760]: info: Loading plugin "upnp"... Sep 17 20:47:58 raspberrypi volumio[17760]: info: [1758134878683] Starting Upmpd Daemon Sep 17 20:47:58 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:58 raspberrypi volumio[17760]: info: Loading plugin "my_music"... Sep 17 20:47:58 raspberrypi volumio[17760]: info: Loading plugin "mpd"... Sep 17 20:47:58 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:47:58] [connect] Successful connection Sep 17 20:47:59 raspberrypi volumio[17760]: info: Loading plugin "upnp_browser"... Sep 17 20:47:59 raspberrypi sudo[17799]: pam_unix(sudo:session): session closed for user root Sep 17 20:47:59 raspberrypi volumio[17760]: info: Loading plugin "alarm-clock"... Sep 17 20:47:59 raspberrypi volumio[17786]: Traceback (most recent call last): Sep 17 20:47:59 raspberrypi volumio[17786]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:47:59 raspberrypi volumio[17786]: from camilladsp import CamillaConnection Sep 17 20:47:59 raspberrypi volumio[17786]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:47:59 raspberrypi volumio[17760]: info: Loading plugin "airplay_emulation"... Sep 17 20:47:59 raspberrypi volumio[17760]: info: Starting Shairport Sync Sep 17 20:47:59 raspberrypi volumio[17760]: info: Loading plugin "last_100"... Sep 17 20:47:59 raspberrypi volumio[17760]: info: Loading plugin "webradio"... Sep 17 20:47:59 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:47:59 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:47:59 raspberrypi volumio[17760]: info: Loading plugin "i2s_dacs"... Sep 17 20:47:59 raspberrypi volumio[17760]: info: I2S DAC not set, start Auto-detection Sep 17 20:47:59 raspberrypi volumio[17760]: info: Loading plugin "volumiodiscovery"... Sep 17 20:47:59 raspberrypi volumio[17760]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:59 raspberrypi volumio[17760]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:59 raspberrypi volumio[17760]: *** WARNING *** For more information see Sep 17 20:47:59 raspberrypi node[17760]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:59 raspberrypi volumio[17760]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:59 raspberrypi volumio[17760]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:59 raspberrypi volumio[17760]: *** WARNING *** For more information see Sep 17 20:47:59 raspberrypi node[17760]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:59 raspberrypi node[17760]: *** WARNING *** For more information see Sep 17 20:47:59 raspberrypi node[17760]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Sep 17 20:47:59 raspberrypi node[17760]: *** WARNING *** Please fix your application to use the native API of Avahi! Sep 17 20:47:59 raspberrypi node[17760]: *** WARNING *** For more information see Sep 17 20:47:59 raspberrypi volumio[17760]: info: Applying required configuration parameters for plugin volumiodiscovery Sep 17 20:47:59 raspberrypi volumio[17760]: info: Discovery: Started advertising with name: raspberrypi Sep 17 20:47:59 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Sep 17 20:47:59 raspberrypi volumio[17760]: info: Loading plugin "spop"... Sep 17 20:48:01 raspberrypi volumio[17760]: info: Loading plugin "outputs"... Sep 17 20:48:01 raspberrypi volumio[17760]: info: Loading plugin "albumart"... Sep 17 20:48:01 raspberrypi volumio[17760]: info: Plugin example_plugin is not enabled Sep 17 20:48:01 raspberrypi volumio[17760]: info: Loading plugin "inputs"... Sep 17 20:48:01 raspberrypi volumio[17760]: info: Loading plugin "updater_comm"... Sep 17 20:48:01 raspberrypi volumio[17760]: info: Plugin mpdemulation is not enabled Sep 17 20:48:01 raspberrypi volumio[17760]: info: Loading plugin "rest_api"... Sep 17 20:48:01 raspberrypi volumio[17760]: info: Loading plugin "websocket"... Sep 17 20:48:01 raspberrypi volumio[17760]: info: Starting Socket.io Server version 2.3.0 Sep 17 20:48:01 raspberrypi volumio[17760]: info: Loading plugin "fusiondsp"... Sep 17 20:48:01 raspberrypi volumio[17760]: Forking 3 albumart workers Sep 17 20:48:01 raspberrypi volumio[17760]: info: Applying required configuration parameters for plugin fusiondsp Sep 17 20:48:01 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:48:01 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 256. Sep 17 20:48:01 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:48:01 raspberrypi volumio[17760]: info: Loading i18n strings for locale pl Sep 17 20:48:01 raspberrypi volumio[17760]: Updating browse sources language Sep 17 20:48:01 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:48:01 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreCommandRouter::initPlayerControls Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 17 20:48:02 raspberrypi volumio[17760]: Express server listening on port 3000 Sep 17 20:48:02 raspberrypi volumio[17760]: [Metrics] WebUI: 6s 572.21ms Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreStateMachine::resetVolumioState Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreStateMachine::getcurrentVolume Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioRetrievevolume Sep 17 20:48:02 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:48:02 raspberrypi volumio[17760]: info: Volumio Network Manager: Network status updated: 3 Sep 17 20:48:02 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 1 Sep 17 20:48:02 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 2 Sep 17 20:48:02 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 3 Sep 17 20:48:02 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 4 Sep 17 20:48:02 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 5 Sep 17 20:48:02 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 6 Sep 17 20:48:02 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 7 Sep 17 20:48:02 raspberrypi volumio-remote-updater[586]: [2025-09-17 20:48:02] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=4&transport=websocket&t=1758134878 101 Sep 17 20:48:02 raspberrypi volumio[17760]: 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: 8 Sep 17 20:48:02 raspberrypi volumio[17760]: Starting albumart workers Sep 17 20:48:02 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 9 Sep 17 20:48:02 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 10 Sep 17 20:48:03 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 11 Sep 17 20:48:03 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 12 Sep 17 20:48:03 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 13 Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioGetState Sep 17 20:48:03 raspberrypi volumio[17760]: info: CorePlayQueue::getTrack 0 Sep 17 20:48:03 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 14 Sep 17 20:48:03 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 15 Sep 17 20:48:03 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.126 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 16 Sep 17 20:48:03 raspberrypi volumio[17760]: info: Reloading queue from file Sep 17 20:48:03 raspberrypi volumio[17760]: verbose: New Socket.io Connection to 192.168.1.214 from 192.168.1.152 UA: Mozilla/5.0 (X11; Linux x86_64; rv:142.0) Gecko/20100101 Firefox/142.0 Engine version: 3 Transport: polling Total Clients: 17 Sep 17 20:48:03 raspberrypi volumio[17760]: Starting albumart workers Sep 17 20:48:03 raspberrypi volumio[17760]: info: VolumeController:: Volume=0 Mute =false Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreStateMachine::pushState Sep 17 20:48:03 raspberrypi volumio[17760]: info: CorePlayQueue::getTrack 0 Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioPushState Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreStateMachine::updateTrackBlock Sep 17 20:48:03 raspberrypi volumio[17760]: info: CorePlayQueue::getTrackBlock Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioRetrievevolume Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreStateMachine::setRepeat false single undefined Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreStateMachine::pushState Sep 17 20:48:03 raspberrypi volumio[17760]: info: CorePlayQueue::getTrack 0 Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioPushState Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreStateMachine::setRandom null Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreStateMachine::pushState Sep 17 20:48:03 raspberrypi volumio[17760]: info: CorePlayQueue::getTrack 0 Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioPushState Sep 17 20:48:03 raspberrypi volumio[17760]: info: Setting Device type: Raspberry PI Sep 17 20:48:03 raspberrypi volumio[17760]: info: Listing playlists Sep 17 20:48:03 raspberrypi volumio[17760]: info: Listing playlists Sep 17 20:48:03 raspberrypi volumio[17760]: info: Cannot mount NAS Music at system boot, trial number 2 ,retrying in 5 seconds Sep 17 20:48:03 raspberrypi volumio[17845]: Traceback (most recent call last): Sep 17 20:48:03 raspberrypi volumio[17845]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:48:03 raspberrypi volumio[17845]: from camilladsp import CamillaConnection Sep 17 20:48:03 raspberrypi volumio[17845]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:48:03 raspberrypi volumio[17760]: info: Received Get System Info Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Sep 17 20:48:03 raspberrypi volumio[17760]: info: Discovery: Getting this device information Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioGetState Sep 17 20:48:03 raspberrypi volumio[17760]: info: CorePlayQueue::getTrack 0 Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioGetState Sep 17 20:48:03 raspberrypi volumio[17760]: info: CorePlayQueue::getTrack 0 Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioGetVisibleSources Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioGetState Sep 17 20:48:03 raspberrypi volumio[17760]: info: CorePlayQueue::getTrack 0 Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: metavolumio , getInfinityPlayback Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioGetQueue Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreStateMachine::getQueue Sep 17 20:48:03 raspberrypi volumio[17760]: info: CorePlayQueue::getQueue Sep 17 20:48:03 raspberrypi volumio[17760]: info: Listing playlists Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Sep 17 20:48:03 raspberrypi volumio[17760]: info: Received Get System Info Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Sep 17 20:48:03 raspberrypi volumio[17760]: info: Discovery: Getting this device information Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioGetState Sep 17 20:48:03 raspberrypi volumio[17760]: info: CorePlayQueue::getTrack 0 Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioGetState Sep 17 20:48:03 raspberrypi volumio[17760]: Starting albumart workers Sep 17 20:48:03 raspberrypi volumio[17760]: info: CorePlayQueue::getTrack 0 Sep 17 20:48:03 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:48:03 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:48:03 raspberrypi volumio[17760]: info: Discovery: adding 1092a755-1821-4e66-be8c-eba752f9503e Sep 17 20:48:03 raspberrypi volumio[17760]: info: Discovery: Found device raspberrypi Sep 17 20:48:03 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioGetState Sep 17 20:48:03 raspberrypi volumio[17760]: info: CorePlayQueue::getTrack 0 Sep 17 20:48:04 raspberrypi volumio[17760]: info: VolumeController:: Volume=0 Mute =false Sep 17 20:48:04 raspberrypi volumio[17760]: info: CoreStateMachine::pushState Sep 17 20:48:04 raspberrypi volumio[17760]: info: CorePlayQueue::getTrack 0 Sep 17 20:48:04 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioPushState Sep 17 20:48:04 raspberrypi volumio[17760]: info: Discovery: this is already registered, 1092a755-1821-4e66-be8c-eba752f9503e Sep 17 20:48:04 raspberrypi volumio[17760]: info: Discovery: Found device raspberrypi Sep 17 20:48:04 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioGetState Sep 17 20:48:04 raspberrypi volumio[17760]: info: CorePlayQueue::getTrack 0 Sep 17 20:48:04 raspberrypi volumio[17760]: info: Completed loading Core Plugins Sep 17 20:48:04 raspberrypi volumio[17760]: info: Preparing to generate the ALSA configuration file Sep 17 20:48:04 raspberrypi volumio[17760]: info: The plugin fusiondsp has an ALSA contribution file volumioDsp.postDsp.10.conf Sep 17 20:48:04 raspberrypi volumio[17760]: info: Reading ALSA contributions from plugins. Sep 17 20:48:04 raspberrypi volumio[17760]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:48:04 raspberrypi volumio[17760]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:48:04 raspberrypi volumio[17760]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:48:04 raspberrypi volumio[17760]: info: CoreCommandRouter::getUIConfigOnPlugin Sep 17 20:48:04 raspberrypi volumio[17760]: info: FusionDsp - Sep 17 20:48:04 raspberrypi volumio[17760]: info: FusionDsp - Sep 17 20:48:04 raspberrypi volumio[17760]: info: FusionDsp - Sep 17 20:48:05 raspberrypi volumio[17760]: info: FusionDsp - Sep 17 20:48:05 raspberrypi volumio[17760]: info: FusionDsp - undefined Sep 17 20:48:05 raspberrypi volumio[17760]: info: FusionDsp - undefined Sep 17 20:48:05 raspberrypi volumio[17760]: info: FusionDsp - undefined Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: FusionDsp - undefined Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:05 raspberrypi volumio[17760]: info: Asound.conf file unchanged, so no further update is needed Sep 17 20:48:05 raspberrypi volumio[17760]: info: Output device has changed, restarting MPD Sep 17 20:48:05 raspberrypi sudo[17884]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Sep 17 20:48:05 raspberrypi volumio[17760]: info: Output device has changed, restarting Shairport Sync Sep 17 20:48:05 raspberrypi sudo[17884]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:48:05 raspberrypi sudo[17884]: pam_unix(sudo:session): session closed for user root Sep 17 20:48:05 raspberrypi sudo[17886]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Sep 17 20:48:05 raspberrypi sudo[17886]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:48:05 raspberrypi systemd[1]: Stopping Music Player Daemon... Sep 17 20:48:05 raspberrypi volumio[17760]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 17 20:48:05 raspberrypi volumio[17760]: info: ___________ START PLUGINS ___________ Sep 17 20:48:05 raspberrypi volumio[17760]: info: ControllerMpd::onStart: Initializing MPD Sep 17 20:48:05 raspberrypi volumio[17760]: info: Creating MPD Configuration file Sep 17 20:48:05 raspberrypi systemd[1]: mpd.service: Succeeded. Sep 17 20:48:05 raspberrypi systemd[1]: Stopped Music Player Daemon. Sep 17 20:48:05 raspberrypi sudo[17893]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Sep 17 20:48:05 raspberrypi sudo[17893]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 17 20:48:05 raspberrypi volumio[17760]: info: [1758134885903] CoreMusicLibrary::Adding element Serwery Mediów Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:05 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:48:05 raspberrypi sudo[17893]: pam_unix(sudo:session): session closed for user root Sep 17 20:48:05 raspberrypi systemd[1]: Starting Music Player Daemon... Sep 17 20:48:05 raspberrypi sudo[17896]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Sep 17 20:48:05 raspberrypi sudo[17896]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:48:05 raspberrypi systemd[1]: fusiondsp.service: Service RestartSec=2s expired, scheduling restart. Sep 17 20:48:05 raspberrypi systemd[1]: fusiondsp.service: Scheduled restart job, restart counter is at 257. Sep 17 20:48:05 raspberrypi systemd[1]: Stopped FusionDsp Daemon. Sep 17 20:48:05 raspberrypi systemd[1]: Started FusionDsp Daemon. Sep 17 20:48:05 raspberrypi systemd[1]: mpd.service: Control process exited, code=killed, status=15/TERM Sep 17 20:48:05 raspberrypi systemd[1]: mpd.service: Succeeded. Sep 17 20:48:05 raspberrypi systemd[1]: Stopped Music Player Daemon. Sep 17 20:48:06 raspberrypi volumio[17760]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:48:06 raspberrypi systemd[1]: Starting Music Player Daemon... Sep 17 20:48:06 raspberrypi volumio[17760]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 17 20:48:06 raspberrypi volumio[17760]: info: [1758134886074] CoreMusicLibrary::Adding element Last_100 Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Sep 17 20:48:06 raspberrypi volumio[17760]: info: [1758134886079] CoreMusicLibrary::Adding element Webradio Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:48:06 raspberrypi volumio[17760]: info: Initializing BBC Radios Sep 17 20:48:06 raspberrypi sudo[17903]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Sep 17 20:48:06 raspberrypi sudo[17903]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:48:06 raspberrypi sudo[17903]: pam_unix(sudo:session): session closed for user root Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: Creating Spotify config file Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: Loading i18n strings for locale pl Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , updateALSAConfigFile Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: FusionDsp - mixtype--------------------- Hardware Sep 17 20:48:06 raspberrypi volumio[17760]: info: Volumio Calling Home Sep 17 20:48:06 raspberrypi volumio[17760]: info: Preparing to generate the ALSA configuration file Sep 17 20:48:06 raspberrypi volumio[17760]: info: The plugin fusiondsp has an ALSA contribution file volumioDsp.postDsp.10.conf Sep 17 20:48:06 raspberrypi volumio[17760]: info: Reading ALSA contributions from plugins. Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:06 raspberrypi volumio[17760]: info: MPD Permissions set Sep 17 20:48:06 raspberrypi volumio[17760]: info: MPD Permissions set Sep 17 20:48:06 raspberrypi volumio[17760]: info: Spotify config file written Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:06 raspberrypi volumio[17760]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 18 Sep 17 20:48:06 raspberrypi volumio[17760]: info: Volumio called home Sep 17 20:48:06 raspberrypi sudo[17923]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart go-librespot-daemon.service Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi sudo[17923]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi systemd[1]: Stopping go-librespot Daemon... Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi systemd[1]: go-librespot-daemon.service: Main process exited, code=killed, status=15/TERM Sep 17 20:48:06 raspberrypi systemd[1]: go-librespot-daemon.service: Succeeded. Sep 17 20:48:06 raspberrypi systemd[1]: Stopped go-librespot Daemon. Sep 17 20:48:06 raspberrypi systemd[1]: Started go-librespot Daemon. Sep 17 20:48:06 raspberrypi go-librespot[17930]: go-librespot daemon starting... Sep 17 20:48:06 raspberrypi sudo[17923]: pam_unix(sudo:session): session closed for user root Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:48:06 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:06 raspberrypi go-librespot[17930]: time="2025-09-17T20:48:06+02:00" level=info msg="running go-librespot 0.3.2" Sep 17 20:48:06 raspberrypi go-librespot[17930]: time="2025-09-17T20:48:06+02:00" level=debug msg="app state loaded" Sep 17 20:48:06 raspberrypi go-librespot[17930]: time="2025-09-17T20:48:06+02:00" level=debug msg="stored credentials not found" Sep 17 20:48:06 raspberrypi go-librespot[17930]: time="2025-09-17T20:48:06+02:00" level=info msg="api server listening on 127.0.0.1:9879" Sep 17 20:48:06 raspberrypi volumio[17760]: info: No need to fix Spotify hosts Sep 17 20:48:07 raspberrypi volumio[17760]: info: Starting Shairport Sync Sep 17 20:48:07 raspberrypi volumio[17760]: info: Starting Shairport Sync Sep 17 20:48:07 raspberrypi volumio[17760]: info: Starting Shairport Sync Sep 17 20:48:07 raspberrypi sudo[17942]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Sep 17 20:48:07 raspberrypi sudo[17942]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:48:07 raspberrypi sudo[17944]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Sep 17 20:48:07 raspberrypi sudo[17944]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:48:07 raspberrypi systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::volumioGetState Sep 17 20:48:07 raspberrypi volumio[17760]: info: CorePlayQueue::getTrack 0 Sep 17 20:48:07 raspberrypi systemd[1]: shairport-sync.service: Succeeded. Sep 17 20:48:07 raspberrypi systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Sep 17 20:48:07 raspberrypi sudo[17947]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Sep 17 20:48:07 raspberrypi go-librespot[17930]: time="2025-09-17T20:48:07+02:00" level=debug msg="fetched new accesspoints: [ap-gew4.spotify.com:4070 ap-gew4.spotify.com:443 ap-gew4.spotify.com:80 ap-guc3.spotify.com:4070 ap-gue1.spotify.com:443 ap-gew1.spotify.com:80]" Sep 17 20:48:07 raspberrypi go-librespot[17930]: time="2025-09-17T20:48:07+02:00" level=debug msg="fetched new dealers: [gew4-dealer.spotify.com:443 guc3-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew1-dealer.spotify.com:443]" Sep 17 20:48:07 raspberrypi go-librespot[17930]: time="2025-09-17T20:48:07+02:00" level=debug msg="fetched new spclients: [gew4-spclient.spotify.com:443 guc3-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew1-spclient.spotify.com:443]" Sep 17 20:48:07 raspberrypi go-librespot[17930]: time="2025-09-17T20:48:07+02:00" level=info msg="zeroconf server listening on port 42119" Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:07 raspberrypi sudo[17947]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:48:07 raspberrypi systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Sep 17 20:48:07 raspberrypi sudo[17942]: pam_unix(sudo:session): session closed for user root Sep 17 20:48:07 raspberrypi sudo[17944]: pam_unix(sudo:session): session closed for user root Sep 17 20:48:07 raspberrypi systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Sep 17 20:48:07 raspberrypi systemd[1]: shairport-sync.service: Succeeded. Sep 17 20:48:07 raspberrypi systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Sep 17 20:48:07 raspberrypi volumio[17760]: info: Asound.conf file unchanged, so no further update is needed Sep 17 20:48:07 raspberrypi volumio[17760]: info: Output device has changed, restarting MPD Sep 17 20:48:07 raspberrypi systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Sep 17 20:48:07 raspberrypi sudo[17947]: pam_unix(sudo:session): session closed for user root Sep 17 20:48:07 raspberrypi volumio[17760]: info: Output device has changed, restarting Shairport Sync Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:48:07 raspberrypi sudo[17954]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Sep 17 20:48:07 raspberrypi sudo[17954]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:48:07 raspberrypi sudo[17954]: pam_unix(sudo:session): session closed for user root Sep 17 20:48:07 raspberrypi sudo[17956]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Sep 17 20:48:07 raspberrypi sudo[17956]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:48:07 raspberrypi systemd[1]: mpd.service: Main process exited, code=killed, status=15/TERM Sep 17 20:48:07 raspberrypi systemd[1]: mpd.service: Succeeded. Sep 17 20:48:07 raspberrypi systemd[1]: Stopped Music Player Daemon. Sep 17 20:48:07 raspberrypi volumio[17760]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Sep 17 20:48:07 raspberrypi volumio[17760]: info: Shairport-Sync Started Sep 17 20:48:07 raspberrypi volumio[17760]: Error adding Membership: Error: addMembership EINVAL Sep 17 20:48:07 raspberrypi volumio[17760]: info: Shairport-Sync Started Sep 17 20:48:07 raspberrypi systemd[1]: Starting Music Player Daemon... Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:07 raspberrypi volumio[17760]: info: MPD Permissions set Sep 17 20:48:07 raspberrypi volumio[17760]: info: Shairport-Sync Started Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Sep 17 20:48:07 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:07 raspberrypi volumio[17760]: info: Starting Shairport Sync Sep 17 20:48:07 raspberrypi sudo[17970]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Sep 17 20:48:07 raspberrypi sudo[17970]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:48:07 raspberrypi systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Sep 17 20:48:07 raspberrypi sudo[17963]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Sep 17 20:48:07 raspberrypi sudo[17963]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:48:07 raspberrypi systemd[1]: shairport-sync.service: Succeeded. Sep 17 20:48:07 raspberrypi systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Sep 17 20:48:07 raspberrypi sudo[17963]: pam_unix(sudo:session): session closed for user root Sep 17 20:48:07 raspberrypi volumio[17902]: Traceback (most recent call last): Sep 17 20:48:07 raspberrypi volumio[17902]: File "/data/plugins/audio_interface/fusiondsp/cgui/main.py", line 4, in Sep 17 20:48:07 raspberrypi volumio[17902]: from camilladsp import CamillaConnection Sep 17 20:48:07 raspberrypi volumio[17902]: ModuleNotFoundError: No module named 'camilladsp' Sep 17 20:48:07 raspberrypi systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Sep 17 20:48:07 raspberrypi sudo[17970]: pam_unix(sudo:session): session closed for user root Sep 17 20:48:07 raspberrypi volumio[17760]: info: Shairport-Sync Started Sep 17 20:48:08 raspberrypi systemd[1]: fusiondsp.service: Main process exited, code=exited, status=1/FAILURE Sep 17 20:48:08 raspberrypi systemd[1]: fusiondsp.service: Failed with result 'exit-code'. Sep 17 20:48:08 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: appearance , isLatestTOSAccepted Sep 17 20:48:08 raspberrypi volumio[17760]: /usr/bin/mkfifo: cannot create fifo '/tmp/fusiondspfifo': File exists Sep 17 20:48:08 raspberrypi volumio[17760]: error: FusionDsp - ----failed to create fusiondspfifo :Error: Command failed: /bin/touch /tmp/fusiondsp_stream_params.log && /bin/chmod 666 /tmp/fusiondsp_stream_params.log && /bin/touch /tmp/camilladsp.log && /bin/chmod 666 /tmp/camilladsp.log && /usr/bin/mkfifo -m 646 /tmp/fusiondspfifo Sep 17 20:48:08 raspberrypi volumio[17760]: /usr/bin/mkfifo: cannot create fifo '/tmp/fusiondspfifo': File exists Sep 17 20:48:08 raspberrypi volumio[17760]: info: camilladsp service started and running in background, instance 1 Sep 17 20:48:08 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Sep 17 20:48:08 raspberrypi volumio[17760]: /bin/sh: 1: /data/plugins/audio_interface/fusiondsp/hw_params: not found Sep 17 20:48:08 raspberrypi volumio[17760]: error: FusionDsp - ----Hw detection failed :Error: Command failed: /data/plugins/audio_interface/fusiondsp/hw_params volumioHw >/data/configuration/audio_interface/fusiondsp/hwinfo.json Sep 17 20:48:08 raspberrypi volumio[17760]: /bin/sh: 1: /data/plugins/audio_interface/fusiondsp/hw_params: not found Sep 17 20:48:08 raspberrypi volumio[17760]: info: FusionDsp loaded Sep 17 20:48:08 raspberrypi volumio[17760]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Sep 17 20:48:08 raspberrypi sudo[17987]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start fusiondsp.service Sep 17 20:48:08 raspberrypi sudo[17987]: pam_unix(sudo:session): session opened for user root by (uid=0) Sep 17 20:48:08 raspberrypi volumio[17760]: info: FusionDsp - Reporting Fusion DSP Enabled Sep 17 20:48:08 raspberrypi volumio[17760]: info: Adding Signal Path Element [object Object] Sep 17 20:48:08 raspberrypi volumio[17760]: info: Adding fusiondspeq DSP Signal Path Element Sep 17 20:48:08 raspberrypi volumio[17760]: info: FusionDsp - ---- installed callbackRead Sep 17 20:48:08 raspberrypi volumio[17760]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Sep 17 20:48:08 raspberrypi volumio[17760]: Error: spawn /data/plugins/audio_interface/fusiondsp/camilladsp ENOENT Sep 17 20:48:08 raspberrypi volumio[17760]: at Process.ChildProcess._handle.onexit (internal/child_process.js:269:19) Sep 17 20:48:08 raspberrypi volumio[17760]: at onErrorNT (internal/child_process.js:465:16) Sep 17 20:48:08 raspberrypi volumio[17760]: at processTicksAndRejections (internal/process/task_queues.js:80:21) { Sep 17 20:48:08 raspberrypi volumio[17760]: errno: -2, Sep 17 20:48:08 raspberrypi volumio[17760]: code: 'ENOENT', Sep 17 20:48:08 raspberrypi volumio[17760]: syscall: 'spawn /data/plugins/audio_interface/fusiondsp/camilladsp', Sep 17 20:48:08 raspberrypi volumio[17760]: path: '/data/plugins/audio_interface/fusiondsp/camilladsp', Sep 17 20:48:08 raspberrypi volumio[17760]: spawnargs: [ Sep 17 20:48:08 raspberrypi volumio[17760]: '-p', Sep 17 20:48:08 raspberrypi volumio[17760]: 9876, Sep 17 20:48:08 raspberrypi volumio[17760]: '-o', Sep 17 20:48:08 raspberrypi volumio[17760]: '/tmp/camilladsp.log', Sep 17 20:48:08 raspberrypi volumio[17760]: '-l', Sep 17 20:48:08 raspberrypi volumio[17760]: 'warn', Sep 17 20:48:08 raspberrypi volumio[17760]: '/data/configuration/audio_interface/fusiondsp/camilladsp.yml' Sep 17 20:48:08 raspberrypi volumio[17760]: ] Sep 17 20:48:08 raspberrypi volumio[17760]: } Sep 17 20:48:08 raspberrypi volumio[17760]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Sep 17 20:48:09 raspberrypi sudo[18012]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-09-17 20:47 Sep 17 20:48:09 raspberrypi sudo[18012]: 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="29866754e5f1d7e4d0f581c10d9f22852f6f21db" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="fc4c820ddd3b5fc1a7a6b54ef112273ebd122010" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Sat 26 Jul 2025 10:25:36 AM CEST" VOLUMIO_VERSION="3.832" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="cf6e14681b2ecbbdc9a62186b0f3114c"