-- Logs begin at Sun 2025-06-08 11:15:40 CEST, end at Sun 2025-06-08 11:30:53 CEST. -- Jun 08 11:29:14 volumio-tarci volumio[3885]: info: Jun 08 11:29:14 volumio-tarci volumio[3885]: ---------------------------- MPD announces system playlist update Jun 08 11:29:14 volumio-tarci volumio[3885]: info: Ignoring MPD Status Update Jun 08 11:29:14 volumio-tarci volumio[3885]: info: Jun 08 11:29:14 volumio-tarci volumio[3885]: ---------------------------- MPD announces state update: player Jun 08 11:29:14 volumio-tarci volumio[3885]: info: ControllerMpd::getState Jun 08 11:29:14 volumio-tarci volumio[3885]: verbose: ControllerMpd::sendMpdCommand status Jun 08 11:29:14 volumio-tarci volumio[3885]: info: Jun 08 11:29:14 volumio-tarci volumio[3885]: ---------------------------- MPD announces system playlist update Jun 08 11:29:14 volumio-tarci volumio[3885]: info: Ignoring MPD Status Update Jun 08 11:29:14 volumio-tarci volumio[3885]: info: Jun 08 11:29:14 volumio-tarci volumio[3885]: ---------------------------- MPD announces state update: player Jun 08 11:29:14 volumio-tarci volumio[3885]: info: ControllerMpd::getState Jun 08 11:29:14 volumio-tarci volumio[3885]: verbose: ControllerMpd::sendMpdCommand status Jun 08 11:29:14 volumio-tarci volumio[3885]: info: ------------------------------ 13ms Jun 08 11:29:14 volumio-tarci volumio[3885]: info: sendMpdCommand status took 9 milliseconds Jun 08 11:29:14 volumio-tarci volumio[3885]: info: ------------------------------ 9ms Jun 08 11:29:14 volumio-tarci volumio[3885]: verbose: ControllerMpd::parseState Jun 08 11:29:14 volumio-tarci volumio[3885]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 08 11:29:14 volumio-tarci volumio[3885]: info: sendMpdCommand status took 13 milliseconds Jun 08 11:29:14 volumio-tarci volumio[3885]: info: sendMpdCommand playlistinfo took 4 milliseconds Jun 08 11:29:14 volumio-tarci volumio[3885]: verbose: ControllerMpd::parseState Jun 08 11:29:14 volumio-tarci volumio[3885]: verbose: ControllerMpd::sendMpdCommand playlistinfo Jun 08 11:29:14 volumio-tarci volumio[3885]: verbose: ControllerMpd::parseTrackInfo Jun 08 11:29:14 volumio-tarci volumio[3885]: info: ControllerMpd::pushState Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreCommandRouter::servicePushState Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CorePlayQueue::getTrack 1 Jun 08 11:29:14 volumio-tarci volumio[3885]: verbose: STATE SERVICE {"status":"play","position":0,"seek":22,"duration":251,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"737 Kbps","isStreaming":false,"title":"Il Libro In Una Mano, La Bomba Nell'Altra (Remastered 2019)","artist":"Negrita","album":"NEGRITA 30 (1994 - 2024)","uri":"USB/Toshiba/Music/Playlist/Negrita - NEGRITA 30 (1994 - 2024)/02. Negrita - Il Libro In Una Mano, La Bomba Nell'Altra (Remastered 2019).flac","trackType":"flac"} Jun 08 11:29:14 volumio-tarci volumio[3885]: verbose: CURRENT POSITION 1 Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreStateMachine::syncState stateService play Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreStateMachine::syncState currentStatus play Jun 08 11:29:14 volumio-tarci volumio[3885]: info: Received an update from plugin. extracting info from payload Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreStateMachine::pushState Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CorePlayQueue::getTrack 1 Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreCommandRouter::volumioPushState Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreStateMachine::pushState Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CorePlayQueue::getTrack 1 Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreCommandRouter::volumioPushState Jun 08 11:29:14 volumio-tarci volumio[3885]: info: ------------------------------ 86ms Jun 08 11:29:14 volumio-tarci volumio[3885]: info: sendMpdCommand playlistinfo took 66 milliseconds Jun 08 11:29:14 volumio-tarci volumio[3885]: verbose: ControllerMpd::parseTrackInfo Jun 08 11:29:14 volumio-tarci volumio[3885]: info: ControllerMpd::pushState Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreCommandRouter::servicePushState Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CorePlayQueue::getTrack 1 Jun 08 11:29:14 volumio-tarci volumio[3885]: verbose: STATE SERVICE {"status":"play","position":0,"seek":22,"duration":251,"samplerate":"44.1 kHz","bitdepth":"16 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":"737 Kbps","isStreaming":false,"title":"Il Libro In Una Mano, La Bomba Nell'Altra (Remastered 2019)","artist":"Negrita","album":"NEGRITA 30 (1994 - 2024)","uri":"USB/Toshiba/Music/Playlist/Negrita - NEGRITA 30 (1994 - 2024)/02. Negrita - Il Libro In Una Mano, La Bomba Nell'Altra (Remastered 2019).flac","trackType":"flac"} Jun 08 11:29:14 volumio-tarci volumio[3885]: verbose: CURRENT POSITION 1 Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreStateMachine::syncState stateService play Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreStateMachine::syncState currentStatus play Jun 08 11:29:14 volumio-tarci volumio[3885]: info: Received an update from plugin. extracting info from payload Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreStateMachine::pushState Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CorePlayQueue::getTrack 1 Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreCommandRouter::volumioPushState Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreStateMachine::pushState Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CorePlayQueue::getTrack 1 Jun 08 11:29:14 volumio-tarci volumio[3885]: info: CoreCommandRouter::volumioPushState Jun 08 11:29:14 volumio-tarci volumio[3885]: info: ------------------------------ 131ms Jun 08 11:29:14 volumio-tarci volumio[3885]: info: PeppySpectrum ---peppyspectrum status play Jun 08 11:29:14 volumio-tarci volumio[3885]: info: PeppySpectrum ---peppyspectrum status play Jun 08 11:29:14 volumio-tarci sudo[7479]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service Jun 08 11:29:14 volumio-tarci sudo[7479]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:29:14 volumio-tarci volumio[3885]: info: PeppySpectrum ---peppyspectrum status play Jun 08 11:29:14 volumio-tarci sudo[7479]: pam_unix(sudo:session): session closed for user root Jun 08 11:29:14 volumio-tarci sudo[7482]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service Jun 08 11:29:14 volumio-tarci sudo[7482]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:29:14 volumio-tarci sudo[7482]: pam_unix(sudo:session): session closed for user root Jun 08 11:29:14 volumio-tarci volumio[3885]: info: PeppySpectrum ---peppyspectrum status play Jun 08 11:29:14 volumio-tarci sudo[7485]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service Jun 08 11:29:14 volumio-tarci sudo[7485]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:29:14 volumio-tarci sudo[7485]: pam_unix(sudo:session): session closed for user root Jun 08 11:29:14 volumio-tarci sudo[7488]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start peppyspectrum.service Jun 08 11:29:14 volumio-tarci sudo[7488]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:29:14 volumio-tarci volumio[3885]: info: PeppySpectrum ---peppyspectrum failed to start. Check your configuration Error: Command failed: /usr/bin/sudo /bin/systemctl start peppyspectrum.service Jun 08 11:29:14 volumio-tarci volumio[3885]: Failed to start peppyspectrum.service: Unit peppyspectrum.service not found. Jun 08 11:29:14 volumio-tarci volumio[3885]: info: PeppySpectrum ---peppyspectrum failed to start. Check your configuration Error: Command failed: /usr/bin/sudo /bin/systemctl start peppyspectrum.service Jun 08 11:29:14 volumio-tarci volumio[3885]: Failed to start peppyspectrum.service: Unit peppyspectrum.service not found. Jun 08 11:29:14 volumio-tarci volumio[3885]: info: PeppySpectrum ---peppyspectrum failed to start. Check your configuration Error: Command failed: /usr/bin/sudo /bin/systemctl start peppyspectrum.service Jun 08 11:29:14 volumio-tarci volumio[3885]: Failed to start peppyspectrum.service: Unit peppyspectrum.service not found. Jun 08 11:29:14 volumio-tarci sudo[7488]: pam_unix(sudo:session): session closed for user root Jun 08 11:29:14 volumio-tarci volumio[3885]: info: PeppySpectrum ---peppyspectrum failed to start. Check your configuration Error: Command failed: /usr/bin/sudo /bin/systemctl start peppyspectrum.service Jun 08 11:29:14 volumio-tarci volumio[3885]: Failed to start peppyspectrum.service: Unit peppyspectrum.service not found. Jun 08 11:29:16 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Jun 08 11:29:16 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken Jun 08 11:29:17 volumio-tarci go-librespot[4141]: time="2025-06-08T11:29:17+02:00" level=trace msg="received accesspoint ping" Jun 08 11:29:17 volumio-tarci go-librespot[4141]: time="2025-06-08T11:29:17+02:00" level=trace msg="received accesspoint pong ack" Jun 08 11:29:17 volumio-tarci go-librespot[4141]: time="2025-06-08T11:29:17+02:00" level=trace msg="sent dealer ping" Jun 08 11:29:17 volumio-tarci go-librespot[4141]: time="2025-06-08T11:29:17+02:00" level=trace msg="received dealer pong" Jun 08 11:29:46 volumio-tarci volumiologrotate[945]: ls: cannot access '/var/log/samba/log.wb-VOLUMIO': No such file or directory Jun 08 11:29:46 volumio-tarci volumiologrotate[945]: ls: cannot access 'TARCI': No such file or directory Jun 08 11:29:47 volumio-tarci go-librespot[4141]: time="2025-06-08T11:29:47+02:00" level=trace msg="sent dealer ping" Jun 08 11:29:47 volumio-tarci go-librespot[4141]: time="2025-06-08T11:29:47+02:00" level=trace msg="received dealer pong" Jun 08 11:29:52 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken Jun 08 11:30:03 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioToken Jun 08 11:30:17 volumio-tarci go-librespot[4141]: time="2025-06-08T11:30:17+02:00" level=trace msg="sent dealer ping" Jun 08 11:30:17 volumio-tarci go-librespot[4141]: time="2025-06-08T11:30:17+02:00" level=trace msg="received dealer pong" Jun 08 11:30:29 volumio-tarci systemd[1]: Starting Cleanup of Temporary Directories... Jun 08 11:30:29 volumio-tarci systemd[1]: systemd-tmpfiles-clean.service: Succeeded. Jun 08 11:30:29 volumio-tarci systemd[1]: Started Cleanup of Temporary Directories. Jun 08 11:30:42 volumio-tarci volumio[3885]: info: FusionDsp - Stopping FusionDsp service Jun 08 11:30:42 volumio-tarci volumio[3885]: info: camilladsp stopping service pid 6884... Jun 08 11:30:42 volumio-tarci volumio[3885]: info: camilladsp service terminated, instance 1 Jun 08 11:30:42 volumio-tarci volumio[3885]: info: Disabling plugin fusiondsp Jun 08 11:30:42 volumio-tarci volumio[3885]: info: Preparing to generate the ALSA configuration file Jun 08 11:30:42 volumio-tarci sudo[7685]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop fusiondsp.service Jun 08 11:30:42 volumio-tarci sudo[7685]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:42 volumio-tarci systemd[1]: Stopping FusionDsp Daemon... Jun 08 11:30:42 volumio-tarci volumio[1919]: Backend configuration: Jun 08 11:30:42 volumio-tarci volumio[1919]: active_config: /data/configuration/audio_interface/fusiondsp/camilladsp.yml Jun 08 11:30:42 volumio-tarci volumio[1919]: active_config_txt: null Jun 08 11:30:42 volumio-tarci volumio[1919]: camilla_host: 127.0.0.1 Jun 08 11:30:42 volumio-tarci volumio[1919]: camilla_port: 9876 Jun 08 11:30:42 volumio-tarci volumio[1919]: coeff_dir: /data/INTERNAL/FusionDsp/filters Jun 08 11:30:42 volumio-tarci volumio[1919]: config_dir: /data/configuration/audio_interface/fusiondsp Jun 08 11:30:42 volumio-tarci volumio[1919]: default_config: /data/configuration/audio_interface/fusiondsp/camilladsp.yml Jun 08 11:30:42 volumio-tarci volumio[1919]: log_file: /tmp/camilladsp.log Jun 08 11:30:42 volumio-tarci volumio[1919]: on_get_active_config: null Jun 08 11:30:42 volumio-tarci volumio[1919]: on_set_active_config: null Jun 08 11:30:42 volumio-tarci volumio[1919]: port: 5011 Jun 08 11:30:42 volumio-tarci volumio[1919]: supported_capture_types: null Jun 08 11:30:42 volumio-tarci volumio[1919]: supported_playback_types: null Jun 08 11:30:42 volumio-tarci volumio[1919]: update_config_symlink: false Jun 08 11:30:42 volumio-tarci volumio[1919]: update_config_txt: false Jun 08 11:30:42 volumio-tarci volumio[1919]: ======== Running on http://0.0.0.0:5011 ======== Jun 08 11:30:42 volumio-tarci volumio[1919]: (Press CTRL+C to quit) Jun 08 11:30:43 volumio-tarci volumio[3885]: info: The plugin peppyspectrum has an ALSA contribution file peppy_in.peppy_out.6.conf Jun 08 11:30:43 volumio-tarci volumio[3885]: info: Reading ALSA contributions from plugins. Jun 08 11:30:43 volumio-tarci volumio[3885]: info: Asound.conf file written Jun 08 11:30:43 volumio-tarci sudo[7688]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mv /home/volumio/.asoundrc /etc/asound.conf Jun 08 11:30:43 volumio-tarci sudo[7688]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:43 volumio-tarci sudo[7688]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:43 volumio-tarci systemd[1]: fusiondsp.service: Succeeded. Jun 08 11:30:43 volumio-tarci systemd[1]: Stopped FusionDsp Daemon. Jun 08 11:30:43 volumio-tarci volumio[3885]: info: Output device has changed, restarting MPD Jun 08 11:30:43 volumio-tarci sudo[7685]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:43 volumio-tarci sudo[7696]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Jun 08 11:30:43 volumio-tarci sudo[7696]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:43 volumio-tarci sudo[7696]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:43 volumio-tarci volumio[3885]: info: Output device has changed, restarting Shairport Sync Jun 08 11:30:43 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:43 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jun 08 11:30:43 volumio-tarci sudo[7699]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Jun 08 11:30:43 volumio-tarci sudo[7699]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:43 volumio-tarci systemd[1]: musicservicesshield.service: Succeeded. Jun 08 11:30:43 volumio-tarci systemd[1]: Stopped Shield Volumio Music Services in the User CPU Set. Jun 08 11:30:43 volumio-tarci systemd[1]: Stopping Shield Volumio Music Services in the User CPU Set... Jun 08 11:30:43 volumio-tarci systemd[1]: Stopping Music Player Daemon... Jun 08 11:30:43 volumio-tarci volumio[3885]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Jun 08 11:30:43 volumio-tarci volumio[3885]: info: Done. Jun 08 11:30:43 volumio-tarci volumio[3885]: info: MPD Permissions set Jun 08 11:30:43 volumio-tarci volumio[3885]: info: FusionDsp - Reporting Fusion DSP Disabled Jun 08 11:30:43 volumio-tarci volumio[3885]: info: Removing fusiondspeq DSP Signal Path Element Jun 08 11:30:43 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:43 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:43 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:43 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:43 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:43 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:43 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jun 08 11:30:43 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: system , getCPUCoresNumber Jun 08 11:30:43 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:43 volumio-tarci volumio[3885]: info: Starting Shairport Sync Jun 08 11:30:43 volumio-tarci systemd[1]: mpd.service: Succeeded. Jun 08 11:30:43 volumio-tarci systemd[1]: Stopped Music Player Daemon. Jun 08 11:30:43 volumio-tarci sudo[7711]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Jun 08 11:30:43 volumio-tarci sudo[7711]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:43 volumio-tarci systemd[1]: Starting Music Player Daemon... Jun 08 11:30:43 volumio-tarci systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Jun 08 11:30:43 volumio-tarci systemd[1]: shairport-sync.service: Succeeded. Jun 08 11:30:43 volumio-tarci systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Jun 08 11:30:43 volumio-tarci systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Jun 08 11:30:43 volumio-tarci sudo[7711]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:43 volumio-tarci volumio[3885]: info: Shairport-Sync Started Jun 08 11:30:43 volumio-tarci sudo[7712]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Jun 08 11:30:43 volumio-tarci sudo[7712]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:43 volumio-tarci sudo[7712]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:45 volumio-tarci mpd[7721]: Jun 08 11:30 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Jun 08 11:30:45 volumio-tarci systemd[1]: Started Music Player Daemon. Jun 08 11:30:45 volumio-tarci sudo[7699]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:45 volumio-tarci volumio[3885]: error: updateQueue error: null Jun 08 11:30:45 volumio-tarci systemd[1]: Starting Shield Volumio Music Services in the User CPU Set... Jun 08 11:30:45 volumio-tarci volumio[7724]: cset: --> shielding system active with Jun 08 11:30:45 volumio-tarci volumio[7724]: cset: "system" cpuset of CPUSPEC(1-3) with 197 tasks running Jun 08 11:30:45 volumio-tarci volumio[7724]: cset: "user" cpuset of CPUSPEC(0) with 3 tasks running Jun 08 11:30:45 volumio-tarci systemd[1]: Started Shield Volumio Music Services in the User CPU Set. Jun 08 11:30:46 volumio-tarci volumiologrotate[945]: ls: cannot access '/var/log/samba/log.wb-VOLUMIO': No such file or directory Jun 08 11:30:46 volumio-tarci volumiologrotate[945]: ls: cannot access 'TARCI': No such file or directory Jun 08 11:30:47 volumio-tarci go-librespot[4141]: time="2025-06-08T11:30:47+02:00" level=trace msg="sent dealer ping" Jun 08 11:30:47 volumio-tarci go-librespot[4141]: time="2025-06-08T11:30:47+02:00" level=trace msg="received dealer pong" Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Enabling plugin fusiondsp Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Loading plugin "fusiondsp"... Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Applying required configuration parameters for plugin fusiondsp Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Preparing to generate the ALSA configuration file Jun 08 11:30:51 volumio-tarci volumio[3885]: info: The plugin fusiondsp has an ALSA contribution file volumioDsp.postDsp.10.conf Jun 08 11:30:51 volumio-tarci volumio[3885]: info: The plugin peppyspectrum has an ALSA contribution file peppy_in.peppy_out.6.conf Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Reading ALSA contributions from plugins. Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Asound.conf file written Jun 08 11:30:51 volumio-tarci sudo[7806]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mv /home/volumio/.asoundrc /etc/asound.conf Jun 08 11:30:51 volumio-tarci sudo[7806]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:51 volumio-tarci sudo[7806]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Output device has changed, restarting MPD Jun 08 11:30:51 volumio-tarci sudo[7811]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Jun 08 11:30:51 volumio-tarci sudo[7811]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:51 volumio-tarci sudo[7811]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Output device has changed, restarting Shairport Sync Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jun 08 11:30:51 volumio-tarci sudo[7814]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Jun 08 11:30:51 volumio-tarci sudo[7814]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:51 volumio-tarci systemd[1]: musicservicesshield.service: Succeeded. Jun 08 11:30:51 volumio-tarci systemd[1]: Stopped Shield Volumio Music Services in the User CPU Set. Jun 08 11:30:51 volumio-tarci systemd[1]: Stopping Shield Volumio Music Services in the User CPU Set... Jun 08 11:30:51 volumio-tarci systemd[1]: Stopping Music Player Daemon... Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Jun 08 11:30:51 volumio-tarci systemd[1]: mpd.service: Succeeded. Jun 08 11:30:51 volumio-tarci volumio[3885]: info: PLUGIN START: fusiondsp Jun 08 11:30:51 volumio-tarci systemd[1]: Stopped Music Player Daemon. Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Loading i18n strings for locale it Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , updateALSAConfigFile Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:51 volumio-tarci volumio[3885]: info: FusionDsp - mixtype--------------------- None Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Preparing to generate the ALSA configuration file Jun 08 11:30:51 volumio-tarci systemd[1]: Starting Music Player Daemon... Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Done. Jun 08 11:30:51 volumio-tarci volumio[3885]: info: The plugin fusiondsp has an ALSA contribution file volumioDsp.postDsp.10.conf Jun 08 11:30:51 volumio-tarci volumio[3885]: info: The plugin peppyspectrum has an ALSA contribution file peppy_in.peppy_out.6.conf Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Reading ALSA contributions from plugins. Jun 08 11:30:51 volumio-tarci volumio[3885]: info: MPD Permissions set Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: system , getCPUCoresNumber Jun 08 11:30:51 volumio-tarci sudo[7819]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Jun 08 11:30:51 volumio-tarci sudo[7819]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:51 volumio-tarci sudo[7819]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:51 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Starting Shairport Sync Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Asound.conf file unchanged, so no further update is needed Jun 08 11:30:51 volumio-tarci volumio[3885]: info: Output device has changed, restarting MPD Jun 08 11:30:51 volumio-tarci sudo[7829]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Jun 08 11:30:51 volumio-tarci sudo[7829]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:51 volumio-tarci systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Jun 08 11:30:52 volumio-tarci systemd[1]: shairport-sync.service: Succeeded. Jun 08 11:30:52 volumio-tarci systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Jun 08 11:30:52 volumio-tarci sudo[7832]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Jun 08 11:30:52 volumio-tarci sudo[7832]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:52 volumio-tarci systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Jun 08 11:30:52 volumio-tarci sudo[7832]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:52 volumio-tarci sudo[7829]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:52 volumio-tarci volumio[3885]: info: Output device has changed, restarting Shairport Sync Jun 08 11:30:52 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:52 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jun 08 11:30:52 volumio-tarci sudo[7836]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Jun 08 11:30:52 volumio-tarci sudo[7836]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:52 volumio-tarci systemd[1]: mpd.service: Main process exited, code=killed, status=15/TERM Jun 08 11:30:52 volumio-tarci systemd[1]: mpd.service: Succeeded. Jun 08 11:30:52 volumio-tarci systemd[1]: Stopped Music Player Daemon. Jun 08 11:30:52 volumio-tarci volumio[3885]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Jun 08 11:30:52 volumio-tarci systemd[1]: Starting Music Player Daemon... Jun 08 11:30:52 volumio-tarci volumio[3885]: info: MPD Permissions set Jun 08 11:30:52 volumio-tarci volumio[3885]: info: Shairport-Sync Started Jun 08 11:30:52 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:52 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:52 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:52 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:52 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:52 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:52 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:52 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:52 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jun 08 11:30:52 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: system , getCPUCoresNumber Jun 08 11:30:52 volumio-tarci volumio[3885]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jun 08 11:30:52 volumio-tarci volumio[3885]: info: Starting Shairport Sync Jun 08 11:30:52 volumio-tarci sudo[7843]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Jun 08 11:30:52 volumio-tarci sudo[7843]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:52 volumio-tarci sudo[7843]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:52 volumio-tarci sudo[7853]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Jun 08 11:30:52 volumio-tarci sudo[7853]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:52 volumio-tarci systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Jun 08 11:30:52 volumio-tarci systemd[1]: shairport-sync.service: Succeeded. Jun 08 11:30:52 volumio-tarci systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Jun 08 11:30:52 volumio-tarci systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Jun 08 11:30:52 volumio-tarci sudo[7853]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:52 volumio-tarci volumio[3885]: info: Shairport-Sync Started Jun 08 11:30:52 volumio-tarci volumio[3885]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jun 08 11:30:52 volumio-tarci volumio[3885]: TypeError: Cannot read property 'off' of undefined Jun 08 11:30:52 volumio-tarci volumio[3885]: at FusionDsp.onStop (/data/plugins/audio_interface/fusiondsp/index.js:107:15) Jun 08 11:30:52 volumio-tarci volumio[3885]: at PluginManager.stopPlugin (/volumio/app/pluginmanager.js:460:30) Jun 08 11:30:52 volumio-tarci volumio[3885]: at PluginManager.disableAndStopPlugin (/volumio/app/pluginmanager.js:1883:8) Jun 08 11:30:52 volumio-tarci volumio[3885]: at CoreCommandRouter.disableAndStopPlugin (/volumio/app/index.js:1556:29) Jun 08 11:30:52 volumio-tarci volumio[3885]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:1401:47) Jun 08 11:30:52 volumio-tarci volumio[3885]: at Socket.emit (events.js:400:28) Jun 08 11:30:52 volumio-tarci volumio[3885]: at /volumio/node_modules/socket.io/lib/socket.js:528:12 Jun 08 11:30:52 volumio-tarci volumio[3885]: at processTicksAndRejections (internal/process/task_queues.js:77:11) Jun 08 11:30:52 volumio-tarci volumio[3885]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jun 08 11:30:53 volumio-tarci mpd[7852]: Jun 08 11:30 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Jun 08 11:30:53 volumio-tarci systemd[1]: Started Music Player Daemon. Jun 08 11:30:53 volumio-tarci sudo[7814]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:53 volumio-tarci sudo[7836]: pam_unix(sudo:session): session closed for user root Jun 08 11:30:53 volumio-tarci sudo[7869]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-06-08 11:29 Jun 08 11:30:53 volumio-tarci sudo[7869]: pam_unix(sudo:session): session opened for user root by (uid=0) Jun 08 11:30:53 volumio-tarci systemd[1]: Starting Shield Volumio Music Services in the User CPU Set... PRETTY_NAME="Debian GNU/Linux 10 (buster)" NAME="Debian GNU/Linux" VERSION_ID="10" VERSION="10 (buster)" VERSION_CODENAME=buster ID=debian HOME_URL="https://www.debian.org/" SUPPORT_URL="https://www.debian.org/support" BUG_REPORT_URL="https://bugs.debian.org/" VOLUMIO_BUILD_VERSION="570c5791513f5bac7da274aba6690c1a961705de" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="35e4a13c94df42ebab19fd6178d6be47190c244d" VOLUMIO_ARCH="x64" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 13 May 2025 05:50:12 PM CEST" VOLUMIO_VERSION="3.812" VOLUMIO_HARDWARE="x86_amd64" VOLUMIO_DEVICENAME="x86_64" VOLUMIO_HASH="39b0f8c200b2dcadf117e189b4b3632d"