-- Logs begin at Mon 2024-10-07 22:37:04 +04, end at Mon 2024-10-07 22:45:59 +04. -- Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CALLMETHOD: audio_interface alsa_controller saveVolumeOptions [object Object] Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , saveVolumeOptions Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioGetState Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Restoring Previous Volume level: 0 false true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: VolumeController::SetAlsaVolume100 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Enable softmixer device for audio device number 2 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioStop Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreStateMachine::stop Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreStateMachine::setConsumeUpdateService undefined Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Enable softmixer device for audio device undefined Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioUpdateVolumeSettings Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Updating Volume Controller Parameters: Device: 2 Name: HiFiBerry DAC2 HD Mixer: DAC Max Vol: 100 Vol Curve; logarithmic Vol Steps: 4 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Disabling external Volume Control Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Output device has changed, restarting MPD Oct 07 22:44:24 balonias-pi-5 sudo[3142]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Oct 07 22:44:24 balonias-pi-5 sudo[3142]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Output device has changed, restarting Shairport Sync Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 07 22:44:24 balonias-pi-5 sudo[3142]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 sudo[3144]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Oct 07 22:44:24 balonias-pi-5 sudo[3144]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 systemd[1]: Stopping Music Player Daemon... Oct 07 22:44:24 balonias-pi-5 systemd[1]: mpd.service: Succeeded. Oct 07 22:44:24 balonias-pi-5 systemd[1]: Stopped Music Player Daemon. Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 vtcs[2586]: [2024-10-07 22:44:24.399] [tisoc] [warning] [SessionManagerImpl.cpp:243] Illegal State: IDLE Oct 07 22:44:24 balonias-pi-5 vtcs[2586]: [2024-10-07 22:44:24.399] [tisoc] [error] [SpkconServer.cpp:376] recv error. socket disconnected Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Volume configurations have been set Oct 07 22:44:24 balonias-pi-5 systemd[1]: Starting Music Player Daemon... Oct 07 22:44:24 balonias-pi-5 sudo[3154]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Oct 07 22:44:24 balonias-pi-5 sudo[3154]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 systemd[1]: Stopping Volumio Tidal Connect Service... Oct 07 22:44:24 balonias-pi-5 systemd[1]: vtcs.service: Main process exited, code=killed, status=15/TERM Oct 07 22:44:24 balonias-pi-5 systemd[1]: vtcs.service: Succeeded. Oct 07 22:44:24 balonias-pi-5 systemd[1]: Stopped Volumio Tidal Connect Service. Oct 07 22:44:24 balonias-pi-5 sudo[3154]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 sudo[3157]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Oct 07 22:44:24 balonias-pi-5 sudo[3157]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 sudo[3150]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Oct 07 22:44:24 balonias-pi-5 sudo[3150]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 sudo[3150]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioUpdateVolumeSettings Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Updating Volume Controller Parameters: Device: 2 Name: HiFiBerry DAC2 HD Mixer: DAC Max Vol: 100 Vol Curve; logarithmic Vol Steps: 4 Oct 07 22:44:24 balonias-pi-5 sudo[3157]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Disabling external Volume Control Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::getUIConfigOnPlugin Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:44:24 balonias-pi-5 sudo[3173]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Oct 07 22:44:24 balonias-pi-5 sudo[3173]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:44:24 balonias-pi-5 sudo[3176]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Oct 07 22:44:24 balonias-pi-5 sudo[3176]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:44:24 balonias-pi-5 sudo[3173]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:44:24 balonias-pi-5 sudo[3176]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 volumio[1071]: error: Cannot set ALSA Volume: Error: Alsa Mixer Error: Invalid card number. Oct 07 22:44:24 balonias-pi-5 volumio[1071]: error: Failed to parse min max audio card capabilities, sending default vales: TypeError: Cannot read property 'split' of undefined Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: MPD Permissions set Oct 07 22:44:24 balonias-pi-5 volumio[1071]: error: Cannot get ALSA Volume: Error: Alsa Mixer Error: Invalid card number. Oct 07 22:44:24 balonias-pi-5 volumio[1071]: error: Cannot set ALSA Volume: Error: Alsa Mixer Error: Invalid card number. Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Software Volume ALSA configuration written Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Preparing to generate the ALSA configuration file Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: VolumeController:: Volume=undefined Mute =false Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: The plugin alsa_controller has an ALSA contribution file softvolume.postVolume.conf Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Reading ALSA contributions from plugins. Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sOptions Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Getting Alsa Cards List without I2S DAC Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2SNumber Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: Invalid card number. Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: mpd , getPlaybackMode Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: system , getAdvancedSettingsStatus Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Starting Shairport Sync Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Asound.conf file written Oct 07 22:44:24 balonias-pi-5 sudo[3194]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Oct 07 22:44:24 balonias-pi-5 sudo[3194]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 sudo[3197]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mv /home/volumio/.asoundrc /etc/asound.conf Oct 07 22:44:24 balonias-pi-5 sudo[3197]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Oct 07 22:44:24 balonias-pi-5 systemd[1]: shairport-sync.service: Succeeded. Oct 07 22:44:24 balonias-pi-5 systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Oct 07 22:44:24 balonias-pi-5 sudo[3197]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: No state is present for card vc4hdmi0 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: Found hardware: "vc4-hdmi" "" "" "" "" Oct 07 22:44:24 balonias-pi-5 volumio[1071]: Hardware is initialized using a generic method Oct 07 22:44:24 balonias-pi-5 volumio[1071]: No state is present for card vc4hdmi0 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: No state is present for card vc4hdmi1 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: Found hardware: "vc4-hdmi" "" "" "" "" Oct 07 22:44:24 balonias-pi-5 volumio[1071]: Hardware is initialized using a generic method Oct 07 22:44:24 balonias-pi-5 volumio[1071]: No state is present for card vc4hdmi1 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: No state is present for card DAC51110883 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: Found hardware: "USB-Audio" "USB Mixer" "USB2a39:3fd3" "" "" Oct 07 22:44:24 balonias-pi-5 volumio[1071]: Hardware is initialized using a generic method Oct 07 22:44:24 balonias-pi-5 volumio[1071]: No state is present for card DAC51110883 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Output device has changed, restarting MPD Oct 07 22:44:24 balonias-pi-5 sudo[3194]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 mpd[3163]: Oct 07 22:44 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Oct 07 22:44:24 balonias-pi-5 systemd[1]: Started Music Player Daemon. Oct 07 22:44:24 balonias-pi-5 sudo[3144]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 sudo[3206]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Oct 07 22:44:24 balonias-pi-5 sudo[3206]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Output device has changed, restarting Shairport Sync Oct 07 22:44:24 balonias-pi-5 sudo[3206]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 07 22:44:24 balonias-pi-5 sudo[3210]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Oct 07 22:44:24 balonias-pi-5 sudo[3210]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 systemd[1]: Stopping Music Player Daemon... Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Oct 07 22:44:24 balonias-pi-5 systemd[1]: mpd.service: Succeeded. Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 systemd[1]: Stopped Music Player Daemon. Oct 07 22:44:24 balonias-pi-5 sudo[3220]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Oct 07 22:44:24 balonias-pi-5 sudo[3220]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 systemd[1]: Starting Music Player Daemon... Oct 07 22:44:24 balonias-pi-5 sudo[3220]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ALSA lib pcm_hw.c:1822:(_snd_pcm_hw_open) Invalid value for card Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ALSA lib /home/pi/volumio-alsa-plugin/src/pcm_volumioswitch.c:143:(_snd_pcm_volumioswitch_open_target_pcm) PCM Volumio ALSA Switch Plugin failed to open the switcher target pcm volumioLocalPlayback Oct 07 22:44:24 balonias-pi-5 volumio[1071]: aplay: main:828: audio open error: No such device Oct 07 22:44:24 balonias-pi-5 sudo[3215]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Oct 07 22:44:24 balonias-pi-5 sudo[3215]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 sudo[3215]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: No state is present for card vc4hdmi0 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: Found hardware: "vc4-hdmi" "" "" "" "" Oct 07 22:44:24 balonias-pi-5 volumio[1071]: Hardware is initialized using a generic method Oct 07 22:44:24 balonias-pi-5 volumio[1071]: No state is present for card vc4hdmi0 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: No state is present for card vc4hdmi1 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: Found hardware: "vc4-hdmi" "" "" "" "" Oct 07 22:44:24 balonias-pi-5 volumio[1071]: Hardware is initialized using a generic method Oct 07 22:44:24 balonias-pi-5 volumio[1071]: No state is present for card vc4hdmi1 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: No state is present for card DAC51110883 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: Found hardware: "USB-Audio" "USB Mixer" "USB2a39:3fd3" "" "" Oct 07 22:44:24 balonias-pi-5 volumio[1071]: Hardware is initialized using a generic method Oct 07 22:44:24 balonias-pi-5 volumio[1071]: No state is present for card DAC51110883 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Output device has changed, restarting MPD Oct 07 22:44:24 balonias-pi-5 sudo[3231]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Oct 07 22:44:24 balonias-pi-5 sudo[3231]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 sudo[3234]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Oct 07 22:44:24 balonias-pi-5 sudo[3234]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 sudo[3234]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 sudo[3231]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Output device has changed, restarting Shairport Sync Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 07 22:44:24 balonias-pi-5 sudo[3238]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Oct 07 22:44:24 balonias-pi-5 sudo[3238]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 systemd[1]: mpd.service: Main process exited, code=killed, status=15/TERM Oct 07 22:44:24 balonias-pi-5 systemd[1]: mpd.service: Succeeded. Oct 07 22:44:24 balonias-pi-5 systemd[1]: Stopped Music Player Daemon. Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:24 balonias-pi-5 sudo[3247]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Oct 07 22:44:24 balonias-pi-5 sudo[3247]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 systemd[1]: Starting Music Player Daemon... Oct 07 22:44:24 balonias-pi-5 sudo[3247]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 volumio[1071]: xcb_connection_has_error() returned true Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioUpdateVolumeSettings Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Updating Volume Controller Parameters: Device: 2 Name: softvolume Mixer: SoftMaster Max Vol: 100 Vol Curve; logarithmic Vol Steps: 4 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , setExternalVolume Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: Disabling external Volume Control Oct 07 22:44:24 balonias-pi-5 sudo[3243]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Oct 07 22:44:24 balonias-pi-5 sudo[3243]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 sudo[3243]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 sudo[3262]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Oct 07 22:44:24 balonias-pi-5 sudo[3262]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 sudo[3262]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 sudo[3266]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Oct 07 22:44:24 balonias-pi-5 sudo[3266]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Oct 07 22:44:24 balonias-pi-5 sudo[3268]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Oct 07 22:44:24 balonias-pi-5 sudo[3268]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:24 balonias-pi-5 sudo[3266]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Oct 07 22:44:24 balonias-pi-5 sudo[3268]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Oct 07 22:44:24 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:44:24 balonias-pi-5 volumio[1071]: error: Cannot set ALSA Volume: Error: Alsa Mixer Error: Invalid card number. Oct 07 22:44:24 balonias-pi-5 volumio[1071]: error: Failed to parse min max audio card capabilities, sending default vales: TypeError: Cannot read property 'split' of undefined Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: MPD Permissions set Oct 07 22:44:24 balonias-pi-5 volumio[1071]: error: Failed to parse min max audio card capabilities, sending default vales: TypeError: Cannot read property 'split' of undefined Oct 07 22:44:24 balonias-pi-5 volumio[1071]: info: MPD Permissions set Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: Shairport-Sync Started Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: Starting Shairport Sync Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: Starting Shairport Sync Oct 07 22:44:25 balonias-pi-5 sudo[3283]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Oct 07 22:44:25 balonias-pi-5 sudo[3283]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:25 balonias-pi-5 systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Oct 07 22:44:25 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:44:25 balonias-pi-5 sudo[3286]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Oct 07 22:44:25 balonias-pi-5 sudo[3286]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:25 balonias-pi-5 systemd[1]: shairport-sync.service: Succeeded. Oct 07 22:44:25 balonias-pi-5 systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Oct 07 22:44:25 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Oct 07 22:44:25 balonias-pi-5 systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Oct 07 22:44:25 balonias-pi-5 sudo[3283]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:25 balonias-pi-5 systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Oct 07 22:44:25 balonias-pi-5 systemd[1]: shairport-sync.service: Main process exited, code=killed, status=15/TERM Oct 07 22:44:25 balonias-pi-5 systemd[1]: shairport-sync.service: Succeeded. Oct 07 22:44:25 balonias-pi-5 systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: Shairport-Sync Started Oct 07 22:44:25 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:44:25 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Oct 07 22:44:25 balonias-pi-5 systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Oct 07 22:44:25 balonias-pi-5 sudo[3286]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:25 balonias-pi-5 volumio[1071]: info: Shairport-Sync Started Oct 07 22:44:25 balonias-pi-5 mpd[3255]: Oct 07 22:44 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Oct 07 22:44:25 balonias-pi-5 systemd[1]: Started Music Player Daemon. Oct 07 22:44:25 balonias-pi-5 volumio[1071]: error: updateQueue error: null Oct 07 22:44:25 balonias-pi-5 sudo[3210]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:25 balonias-pi-5 sudo[3238]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:25 balonias-pi-5 volumio[1071]: error: MPD error: The expression evaluated to a falsy value: Oct 07 22:44:25 balonias-pi-5 volumio[1071]: assert.ok(self.idling) Oct 07 22:44:25 balonias-pi-5 volumio[1071]: error: The expression evaluated to a falsy value: Oct 07 22:44:25 balonias-pi-5 volumio[1071]: assert.ok(self.idling) Oct 07 22:44:25 balonias-pi-5 volumio[1071]: error: updateQueue error: null Oct 07 22:44:26 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: mpd , restartMpd Oct 07 22:44:26 balonias-pi-5 sudo[3295]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Oct 07 22:44:26 balonias-pi-5 sudo[3295]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:26 balonias-pi-5 systemd[1]: Stopping Music Player Daemon... Oct 07 22:44:26 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:44:26 balonias-pi-5 systemd[1]: mpd.service: Succeeded. Oct 07 22:44:26 balonias-pi-5 systemd[1]: Stopped Music Player Daemon. Oct 07 22:44:26 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Oct 07 22:44:26 balonias-pi-5 systemd[1]: Starting Music Player Daemon... Oct 07 22:44:26 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:44:26 balonias-pi-5 sudo[3297]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Oct 07 22:44:26 balonias-pi-5 sudo[3297]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:26 balonias-pi-5 sudo[3297]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:26 balonias-pi-5 mpd[3300]: Oct 07 22:44 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Oct 07 22:44:26 balonias-pi-5 systemd[1]: Started Music Player Daemon. Oct 07 22:44:26 balonias-pi-5 sudo[3295]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:26 balonias-pi-5 volumio[1071]: error: updateQueue error: null Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: TidalConnect service stoped! Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: TidalConnect service stoped! Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: TidalConnect service stoped! Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: TidalConnect service stoped! Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: Updating tc_getconfig REST Endpoint for plugin: music_service/tidalconnect Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: Updating tc_connect REST Endpoint for plugin: music_service/tidalconnect Oct 07 22:44:27 balonias-pi-5 sudo[3316]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service Oct 07 22:44:27 balonias-pi-5 sudo[3316]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: Updating tc_getconfig REST Endpoint for plugin: music_service/tidalconnect Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: Updating tc_connect REST Endpoint for plugin: music_service/tidalconnect Oct 07 22:44:27 balonias-pi-5 sudo[3323]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service Oct 07 22:44:27 balonias-pi-5 sudo[3323]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:27 balonias-pi-5 systemd[1]: Started Volumio Tidal Connect Service. Oct 07 22:44:27 balonias-pi-5 sudo[3316]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:27 balonias-pi-5 sudo[3323]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: Executing endpoint tc_getconfig Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: tidalconnect , onGetConfig Oct 07 22:44:27 balonias-pi-5 vtcs[3324]: STARTING TidalConnect services, version: 1.4.0.34 Oct 07 22:44:27 balonias-pi-5 vtcs[3324]: STARTED TidalConnect services. Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: Executing endpoint tc_connect Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: tidalconnect , onConnect Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: Connecting to TidalConnect Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::servicePushState Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:27 balonias-pi-5 volumio[1071]: verbose: STATE SERVICE {"status":"stop","service":"tidalconnect","title":"","artist":"","album":"","albumart":"/albumart","uri":"","icon":"fa fa-spinner","trackType":"tidal","codec":"","seek":0,"duration":0,"samplerate":"44.1 KHz","bitdepth":"16 bit","bitrate":"","channels":2,"random":false,"repeat":false,"repeatSingle":false} Oct 07 22:44:27 balonias-pi-5 volumio[1071]: verbose: CURRENT POSITION 0 Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreStateMachine::syncState stateService stop Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreStateMachine::syncState currentStatus stop Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: No code Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::servicePushState Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:27 balonias-pi-5 volumio[1071]: verbose: STATE SERVICE {"status":"stop","service":"tidalconnect","title":"","artist":"","album":"","albumart":"/albumart","uri":"","icon":"fa fa-spinner","trackType":"tidal","codec":"","seek":0,"duration":0,"samplerate":"44.1 KHz","bitdepth":"16 bit","bitrate":"","channels":2,"random":false,"repeat":false,"repeatSingle":false} Oct 07 22:44:27 balonias-pi-5 volumio[1071]: verbose: CURRENT POSITION 0 Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreStateMachine::syncState stateService stop Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreStateMachine::syncState currentStatus stop Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: No code Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: TidalConnect service stoped! Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: TidalConnect service stoped! Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: TidalConnect service stoped! Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: TidalConnect service stoped! Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: Updating tc_getconfig REST Endpoint for plugin: music_service/tidalconnect Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: Updating tc_connect REST Endpoint for plugin: music_service/tidalconnect Oct 07 22:44:27 balonias-pi-5 sudo[3354]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service Oct 07 22:44:27 balonias-pi-5 sudo[3354]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: TidalConnect service stoped! Oct 07 22:44:27 balonias-pi-5 sudo[3354]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:27 balonias-pi-5 volumio[1071]: info: TidalConnect service stoped! Oct 07 22:44:28 balonias-pi-5 volumio[1071]: info: Updating tc_getconfig REST Endpoint for plugin: music_service/tidalconnect Oct 07 22:44:28 balonias-pi-5 volumio[1071]: info: Updating tc_connect REST Endpoint for plugin: music_service/tidalconnect Oct 07 22:44:28 balonias-pi-5 volumio[1071]: info: Updating tc_getconfig REST Endpoint for plugin: music_service/tidalconnect Oct 07 22:44:28 balonias-pi-5 volumio[1071]: info: Updating tc_connect REST Endpoint for plugin: music_service/tidalconnect Oct 07 22:44:28 balonias-pi-5 sudo[3374]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service Oct 07 22:44:28 balonias-pi-5 sudo[3374]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:28 balonias-pi-5 sudo[3377]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service Oct 07 22:44:28 balonias-pi-5 sudo[3377]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:28 balonias-pi-5 sudo[3374]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:28 balonias-pi-5 sudo[3377]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:28 balonias-pi-5 volumio[1071]: info: VolumeController::SetAlsaVolume0 Oct 07 22:44:28 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:44:28 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:28 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Oct 07 22:44:28 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:44:28 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:44:28 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:44:28 balonias-pi-5 volumio[1071]: error: Cannot set ALSA Volume: Error: Alsa Mixer Error: Invalid card number. Oct 07 22:44:30 balonias-pi-5 volumio[1071]: info: TidalConnect service started! Oct 07 22:44:30 balonias-pi-5 volumio[1071]: info: TidalConnect service started! Oct 07 22:44:30 balonias-pi-5 volumio[1071]: info: TidalConnect service started! Oct 07 22:44:31 balonias-pi-5 volumio[1071]: info: TidalConnect service started! Oct 07 22:44:31 balonias-pi-5 volumio[1071]: info: TidalConnect service started! Oct 07 22:44:35 balonias-pi-5 volumio[1071]: info: CALLMETHOD: audio_interface alsa_controller saveResamplingOpts [object Object] Oct 07 22:44:35 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , saveResamplingOpts Oct 07 22:44:35 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: mpd , saveResampleOptions Oct 07 22:44:35 balonias-pi-5 sudo[3384]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Oct 07 22:44:35 balonias-pi-5 sudo[3384]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:35 balonias-pi-5 sudo[3384]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:35 balonias-pi-5 volumio[1071]: info: MPD Permissions set Oct 07 22:44:35 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:35 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:35 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:35 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:35 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:35 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:35 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:35 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:35 balonias-pi-5 sudo[3387]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Oct 07 22:44:35 balonias-pi-5 sudo[3387]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:35 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 07 22:44:35 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 07 22:44:35 balonias-pi-5 systemd[1]: Stopping Music Player Daemon... Oct 07 22:44:35 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:44:35 balonias-pi-5 systemd[1]: mpd.service: Succeeded. Oct 07 22:44:35 balonias-pi-5 systemd[1]: Stopped Music Player Daemon. Oct 07 22:44:35 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Oct 07 22:44:35 balonias-pi-5 systemd[1]: Starting Music Player Daemon... Oct 07 22:44:35 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:44:35 balonias-pi-5 sudo[3393]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Oct 07 22:44:35 balonias-pi-5 sudo[3393]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:44:35 balonias-pi-5 sudo[3393]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:35 balonias-pi-5 mpd[3396]: Oct 07 22:44 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Oct 07 22:44:35 balonias-pi-5 systemd[1]: Started Music Player Daemon. Oct 07 22:44:35 balonias-pi-5 sudo[3387]: pam_unix(sudo:session): session closed for user root Oct 07 22:44:35 balonias-pi-5 volumio[1071]: error: updateQueue error: null Oct 07 22:44:44 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPlay Oct 07 22:44:44 balonias-pi-5 volumio[1071]: info: CoreStateMachine::play index undefined Oct 07 22:44:44 balonias-pi-5 volumio[1071]: info: CoreStateMachine::setConsumeUpdateService undefined Oct 07 22:44:44 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:44:49 balonias-pi-5 ntpd[974]: Soliciting pool server 2001:ac8:81:65:0:2:0:2 Oct 07 22:44:50 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: tidal , handleBrowseUri Oct 07 22:44:50 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioGetQueue Oct 07 22:44:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::getQueue Oct 07 22:44:50 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getQueue Oct 07 22:44:50 balonias-pi-5 volumio[1071]: info: Listing playlists Oct 07 22:44:51 balonias-pi-5 volumio[1071]: info: browseTIDALUri took 354 milliseconds Oct 07 22:44:51 balonias-pi-5 volumio[1071]: info: Preload queue cleared Oct 07 22:44:51 balonias-pi-5 volumio[1071]: info: Preload queue cleared Oct 07 22:45:03 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: tidal , handleBrowseUri Oct 07 22:45:03 balonias-pi-5 volumio[1071]: info: browseTIDALUri took 330 milliseconds Oct 07 22:45:03 balonias-pi-5 volumio[1071]: info: Preload queue cleared Oct 07 22:45:03 balonias-pi-5 volumio[1071]: info: Preload queue cleared Oct 07 22:45:09 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: tidal , handleBrowseUri Oct 07 22:45:10 balonias-pi-5 volumio[1071]: info: browseTIDALUri took 759 milliseconds Oct 07 22:45:10 balonias-pi-5 volumio[1071]: info: Preload queue cleared Oct 07 22:45:10 balonias-pi-5 volumio[1071]: info: Preload queue cleared Oct 07 22:45:13 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: tidal , handleBrowseUri Oct 07 22:45:14 balonias-pi-5 volumio[1071]: info: browseTIDALUri took 807 milliseconds Oct 07 22:45:14 balonias-pi-5 volumio[1071]: info: Preload queue cleared Oct 07 22:45:14 balonias-pi-5 volumio[1071]: info: Preload queue cleared Oct 07 22:45:15 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPlay Oct 07 22:45:15 balonias-pi-5 volumio[1071]: info: CoreStateMachine::play index undefined Oct 07 22:45:15 balonias-pi-5 volumio[1071]: info: CoreStateMachine::setConsumeUpdateService undefined Oct 07 22:45:15 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:45:31 balonias-pi-5 volumio[1071]: info: Preload queue cleared Oct 07 22:45:31 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioReplaceandPlayItems Oct 07 22:45:31 balonias-pi-5 volumio[1071]: info: CoreStateMachine::ClearQueue Oct 07 22:45:31 balonias-pi-5 volumio[1071]: info: CoreStateMachine::stop Oct 07 22:45:31 balonias-pi-5 volumio[1071]: info: CoreStateMachine::setConsumeUpdateService undefined Oct 07 22:45:31 balonias-pi-5 volumio[1071]: info: CorePlayQueue::clearPlayQueue Oct 07 22:45:31 balonias-pi-5 volumio[1071]: info: CorePlayQueue::saveQueue Oct 07 22:45:31 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushQueue Oct 07 22:45:31 balonias-pi-5 volumio[1071]: info: CoreStateMachine::addQueueItems Oct 07 22:45:31 balonias-pi-5 volumio[1071]: info: CorePlayQueue::addQueueItems Oct 07 22:45:31 balonias-pi-5 volumio[1071]: info: Preload queue cleared Oct 07 22:45:31 balonias-pi-5 volumio[1071]: info: Adding Item to queue: tidal://genres/Country/playlists/c2f010a0-0465-49df-9d0c-fdb350b0429a Oct 07 22:45:31 balonias-pi-5 volumio[1071]: info: Exploding uri tidal://genres/Country/playlists/c2f010a0-0465-49df-9d0c-fdb350b0429a in service tidal Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: explodeTIDALUri took 967 milliseconds Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushQueue Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CorePlayQueue::saveQueue Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CoreStateMachine::updateTrackBlock Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrackBlock Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPlay Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CoreStateMachine::play index 0 Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CoreStateMachine::setConsumeUpdateService undefined Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CoreStateMachine::stop Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CoreStateMachine::setConsumeUpdateService undefined Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CoreStateMachine::play index undefined Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CoreStateMachine::setConsumeUpdateService undefined Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CoreStateMachine::startPlaybackTimer Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: [1728326732465] ControllerTidal::clearAddPlayTrack Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: Getting stream with soundQuality HI_RES Oct 07 22:45:32 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand stop Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: sendMpdCommand stop took 3 milliseconds Oct 07 22:45:32 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand clear Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: Oct 07 22:45:32 balonias-pi-5 volumio[1071]: ---------------------------- MPD announces system playlist update Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: Ignoring MPD Status Update Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: sendMpdCommand clear took 1 milliseconds Oct 07 22:45:32 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand add "http://127.0.0.1:3245?data=tidal://song/312132602&soundQuality=HI_RES" Oct 07 22:45:32 balonias-pi-5 volumio[1071]: error: updateQueue error: null Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: Oct 07 22:45:32 balonias-pi-5 volumio[1071]: ---------------------------- MPD announces system playlist update Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: Ignoring MPD Status Update Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: ------------------------------ 1ms Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: sendMpdCommand add "http://127.0.0.1:3245?data=tidal://song/312132602&soundQuality=HI_RES" took 1 milliseconds Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CoreStateMachine::setConsumeUpdateService mpd Oct 07 22:45:32 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand play Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: ------------------------------ 1ms Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: sendMpdCommand play took 1 milliseconds Oct 07 22:45:32 balonias-pi-5 volumio[1071]: STREAMING PROXY: Handling url /?data=tidal://song/312132602&soundQuality=HI_RES Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: Executing endpoint getStreamUrltidal Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: tidal , getStreamUrlAPI Oct 07 22:45:32 balonias-pi-5 volumio[1071]: info: getStreamUrl took 379 milliseconds Oct 07 22:45:32 balonias-pi-5 volumio[1071]: STREAMING PROXY: Got real url: http://sp-pr-cf.audio.tidal.com/mediatracks/CAEaKwgDEidkNjYyMjIwM2FlYzc4NTE4MzFhNzUxZDVkNDZhM2U0Y182Mi5tcDQ/0.flac?Expires=1728330332&Signature=jLUu1eoOeLe13Rvs5re7KWznlGXmEgOitQPD0lihxcdWKti~3~tYeLWeBW9Q0Z~eG0YGJjsAJLdY0P6Zh9ILoMZPk0bOdk3NUWK7EpfPRe5FUs7PPgi5YGAKxPyzAqUMY8r0c6yfB~vq3XnMP5-XAw8~e4B~0Z~dcz1gbmnML1OYmgdKLytm-gvMZswLz64RVJUynG6B9KmAZyEfIyUZGbnijORqlYmun7wnFRW8d0Rg1RY0VOf6nFKBHDQp3q~kzVnCAzO5~SmoX18Jn0guUWtDziOttTjhw5b-OEPMiFvTSSxbLIY9D-aYTS9-M-Uwt31gGhTklT8fgaBuDzuxRw__&Key-Pair-Id=K14LZCZ9QUI4JL Oct 07 22:45:33 balonias-pi-5 volumio[1071]: STREAMING PROXY: Response: 200, length: 43289674 Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: Oct 07 22:45:33 balonias-pi-5 volumio[1071]: ---------------------------- MPD announces state update: player Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: ControllerMpd::getState Oct 07 22:45:33 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand status Oct 07 22:45:33 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand clearerror Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: sendMpdCommand status took 8 milliseconds Oct 07 22:45:33 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::parseState Oct 07 22:45:33 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand playlistinfo Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: Oct 07 22:45:33 balonias-pi-5 volumio[1071]: ---------------------------- MPD announces state update: player Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: ControllerMpd::getState Oct 07 22:45:33 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand status Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: sendMpdCommand clearerror took 2 milliseconds Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: sendMpdCommand playlistinfo took 1 milliseconds Oct 07 22:45:33 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::parseTrackInfo Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: ControllerMpd::pushState Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::servicePushState Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:45:33 balonias-pi-5 volumio[1071]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":0,"duration":184,"samplerate":"48 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"312132602&soundQuality=HI_RES","artist":null,"album":null,"uri":"http://127.0.0.1:3245?data=tidal://song/312132602&soundQuality=HI_RES","trackType":"tidal"} Oct 07 22:45:33 balonias-pi-5 volumio[1071]: verbose: CURRENT POSITION 0 Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: CoreStateMachine::syncState stateService pause Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: CoreStateMachine::syncState currentStatus stop Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: ------------------------------ 20ms Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: sendMpdCommand status took 12 milliseconds Oct 07 22:45:33 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::parseState Oct 07 22:45:33 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand playlistinfo Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: sendMpdCommand playlistinfo took 0 milliseconds Oct 07 22:45:33 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::parseTrackInfo Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: ControllerMpd::pushState Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::servicePushState Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:45:33 balonias-pi-5 volumio[1071]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":0,"duration":184,"samplerate":"48 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"312132602&soundQuality=HI_RES","artist":null,"album":null,"uri":"http://127.0.0.1:3245?data=tidal://song/312132602&soundQuality=HI_RES","trackType":"tidal"} Oct 07 22:45:33 balonias-pi-5 volumio[1071]: verbose: CURRENT POSITION 0 Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: CoreStateMachine::syncState stateService pause Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: CoreStateMachine::syncState currentStatus stop Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:45:33 balonias-pi-5 volumio[1071]: info: ------------------------------ 19ms Oct 07 22:45:33 balonias-pi-5 volumio[1071]: error: Cannot update RT Device info: Error: Reference.set failed: First argument contains undefined in property 'user_devices.bio3czC0QwWrgh8ctw7hZeAUDXG2.6f65d13945d6f4a47b12af561ac7c194.state.status' Oct 07 22:45:42 balonias-pi-5 volumio[1071]: verbose: New Socket.io Connection to 192.168.0.147 from 192.168.0.117 UA: Mozilla/5.0 (Windows NT 10.0; Win64; x64) AppleWebKit/537.36 (KHTML, like Gecko) Chrome/115.0.0.0 Safari/537.36 Engine version: 3 Transport: polling Total Clients: 6 Oct 07 22:45:42 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Oct 07 22:45:42 balonias-pi-5 volumio[1071]: info: Error : CoreCommandRouter::executeOnPlugin: No method [getMultiroom] in plugin multiroom Oct 07 22:45:42 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioGetState Oct 07 22:45:42 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioGetVisibleSources Oct 07 22:45:42 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Oct 07 22:45:42 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioGetQueue Oct 07 22:45:42 balonias-pi-5 volumio[1071]: info: CoreStateMachine::getQueue Oct 07 22:45:42 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getQueue Oct 07 22:45:42 balonias-pi-5 volumio[1071]: info: Listing playlists Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: Preload queue cleared Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioReplaceandPlayItems Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::ClearQueue Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::stop Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::setConsumeUpdateService undefined Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CorePlayQueue::clearPlayQueue Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CorePlayQueue::saveQueue Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushQueue Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::addQueueItems Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CorePlayQueue::addQueueItems Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: Preload queue cleared Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: Adding Item to queue: tidal://genres/Country/playlists/c2f010a0-0465-49df-9d0c-fdb350b0429a Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: Using cached record of: tidal://genres/Country/playlists/c2f010a0-0465-49df-9d0c-fdb350b0429a Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushQueue Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CorePlayQueue::saveQueue Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::updateTrackBlock Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrackBlock Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPlay Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::play index 0 Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::setConsumeUpdateService undefined Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::stop Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::setConsumeUpdateService undefined Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::play index undefined Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::setConsumeUpdateService undefined Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::startPlaybackTimer Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: [1728326750065] ControllerTidal::clearAddPlayTrack Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: Getting stream with soundQuality HI_RES Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand stop Oct 07 22:45:50 balonias-pi-5 volumio[1071]: STREAMING PROXY: Client dropped request, destroying Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: Oct 07 22:45:50 balonias-pi-5 volumio[1071]: ---------------------------- MPD announces state update: player Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: sendMpdCommand stop took 4 milliseconds Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: ControllerMpd::getState Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand status Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand clear Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: Oct 07 22:45:50 balonias-pi-5 volumio[1071]: ---------------------------- MPD announces system playlist update Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: Ignoring MPD Status Update Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: sendMpdCommand status took 1 milliseconds Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: sendMpdCommand clear took 1 milliseconds Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::parseState Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand playlistinfo Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand add "http://127.0.0.1:3245?data=tidal://song/312132602&soundQuality=HI_RES" Oct 07 22:45:50 balonias-pi-5 volumio[1071]: error: updateQueue error: null Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: Oct 07 22:45:50 balonias-pi-5 volumio[1071]: ---------------------------- MPD announces system playlist update Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: Ignoring MPD Status Update Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: ------------------------------ 3ms Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: sendMpdCommand playlistinfo took 2 milliseconds Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: sendMpdCommand add "http://127.0.0.1:3245?data=tidal://song/312132602&soundQuality=HI_RES" took 3 milliseconds Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::parseTrackInfo Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::setConsumeUpdateService mpd Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand play Oct 07 22:45:50 balonias-pi-5 volumio[1071]: error: ControllerMpd::pushError: TypeError: Cannot read property 'split' of undefined Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: ------------------------------ 5ms Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: ------------------------------ 2ms Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: sendMpdCommand play took 1 milliseconds Oct 07 22:45:50 balonias-pi-5 volumio[1071]: STREAMING PROXY: Handling url /?data=tidal://song/312132602&soundQuality=HI_RES Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: Executing endpoint getStreamUrltidal Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: tidal , getStreamUrlAPI Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: getStreamUrl took 495 milliseconds Oct 07 22:45:50 balonias-pi-5 volumio[1071]: STREAMING PROXY: Got real url: http://sp-pr-cf.audio.tidal.com/mediatracks/CAEaKwgDEidkNjYyMjIwM2FlYzc4NTE4MzFhNzUxZDVkNDZhM2U0Y182Mi5tcDQ/0.flac?Expires=1728330332&Signature=jLUu1eoOeLe13Rvs5re7KWznlGXmEgOitQPD0lihxcdWKti~3~tYeLWeBW9Q0Z~eG0YGJjsAJLdY0P6Zh9ILoMZPk0bOdk3NUWK7EpfPRe5FUs7PPgi5YGAKxPyzAqUMY8r0c6yfB~vq3XnMP5-XAw8~e4B~0Z~dcz1gbmnML1OYmgdKLytm-gvMZswLz64RVJUynG6B9KmAZyEfIyUZGbnijORqlYmun7wnFRW8d0Rg1RY0VOf6nFKBHDQp3q~kzVnCAzO5~SmoX18Jn0guUWtDziOttTjhw5b-OEPMiFvTSSxbLIY9D-aYTS9-M-Uwt31gGhTklT8fgaBuDzuxRw__&Key-Pair-Id=K14LZCZ9QUI4JL Oct 07 22:45:50 balonias-pi-5 volumio[1071]: STREAMING PROXY: Response: 200, length: 43289674 Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: Oct 07 22:45:50 balonias-pi-5 volumio[1071]: ---------------------------- MPD announces state update: player Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: ControllerMpd::getState Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand status Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: Oct 07 22:45:50 balonias-pi-5 volumio[1071]: ---------------------------- MPD announces state update: player Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand clearerror Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: sendMpdCommand status took 2 milliseconds Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: ControllerMpd::getState Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand status Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::parseState Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand playlistinfo Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: sendMpdCommand clearerror took 2 milliseconds Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: sendMpdCommand status took 1 milliseconds Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: sendMpdCommand playlistinfo took 1 milliseconds Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::parseState Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::sendMpdCommand playlistinfo Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::parseTrackInfo Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: ControllerMpd::pushState Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::servicePushState Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":0,"duration":184,"samplerate":"48 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"312132602&soundQuality=HI_RES","artist":null,"album":null,"uri":"http://127.0.0.1:3245?data=tidal://song/312132602&soundQuality=HI_RES","trackType":"tidal"} Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: CURRENT POSITION 0 Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::syncState stateService pause Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::syncState currentStatus stop Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: ------------------------------ 12ms Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: sendMpdCommand playlistinfo took 10 milliseconds Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: ControllerMpd::parseTrackInfo Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: ControllerMpd::pushState Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::servicePushState Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CorePlayQueue::getTrack 0 Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: STATE SERVICE {"status":"pause","position":0,"seek":0,"duration":184,"samplerate":"48 kHz","bitdepth":"24 bit","channels":2,"random":false,"updatedb":false,"repeat":false,"bitrate":null,"isStreaming":false,"title":"312132602&soundQuality=HI_RES","artist":null,"album":null,"uri":"http://127.0.0.1:3245?data=tidal://song/312132602&soundQuality=HI_RES","trackType":"tidal"} Oct 07 22:45:50 balonias-pi-5 volumio[1071]: verbose: CURRENT POSITION 0 Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::syncState stateService pause Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::syncState currentStatus stop Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreStateMachine::pushState Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioPushState Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output update for this device Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: MRS: Pushing multiroomSync output Oct 07 22:45:50 balonias-pi-5 volumio[1071]: info: ------------------------------ 21ms Oct 07 22:45:50 balonias-pi-5 volumio[1071]: error: Cannot update RT Device info: Error: Reference.set failed: First argument contains undefined in property 'user_devices.bio3czC0QwWrgh8ctw7hZeAUDXG2.6f65d13945d6f4a47b12af561ac7c194.state.status' Oct 07 22:45:51 balonias-pi-5 volumio[1071]: info: Tunnel connection is inactive, restarting it Oct 07 22:45:51 balonias-pi-5 volumio[1071]: info: Starting Tunnel 1 Oct 07 22:45:51 balonias-pi-5 volumio[1071]: info: Starting Tunnel Connection Checker Oct 07 22:45:52 balonias-pi-5 sudo[3459]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart sshtunnel.service Oct 07 22:45:52 balonias-pi-5 sudo[3459]: pam_unix(sudo:session): session opened for user root by (uid=0) Oct 07 22:45:52 balonias-pi-5 autossh[2987]: received signal to exit (15) Oct 07 22:45:52 balonias-pi-5 systemd[1]: Stopping MyVolumio SSH Tunnel... Oct 07 22:45:52 balonias-pi-5 systemd[1]: sshtunnel.service: Main process exited, code=killed, status=15/TERM Oct 07 22:45:52 balonias-pi-5 systemd[1]: sshtunnel.service: Succeeded. Oct 07 22:45:52 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: running Oct 07 22:45:52 balonias-pi-5 systemd[1]: Stopped MyVolumio SSH Tunnel. Oct 07 22:45:52 balonias-pi-5 volumio[1071]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Oct 07 22:45:52 balonias-pi-5 systemd[1]: Started MyVolumio SSH Tunnel. Oct 07 22:45:52 balonias-pi-5 sudo[3459]: pam_unix(sudo:session): session closed for user root Oct 07 22:45:52 balonias-pi-5 volumio[1071]: info: Remote SSH Started Oct 07 22:45:52 balonias-pi-5 autossh[3462]: port set to 0, monitoring disabled Oct 07 22:45:52 balonias-pi-5 autossh[3462]: starting ssh (count 1) Oct 07 22:45:52 balonias-pi-5 autossh[3462]: ssh child pid is 3465 Oct 07 22:45:52 balonias-pi-5 volumio[1071]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 7 Oct 07 22:45:52 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::volumioGetState Oct 07 22:45:52 balonias-pi-5 volumio[1071]: error: Cannot update RT Device info: Error: Reference.set failed: First argument contains undefined in property 'user_devices.bio3czC0QwWrgh8ctw7hZeAUDXG2.6f65d13945d6f4a47b12af561ac7c194.state.status' Oct 07 22:45:53 balonias-pi-5 volumiossh-tunnel[3461]: Warning: Permanently added '[as1.myvolumio.org]:2222,[128.199.166.162]:2222' (RSA) to the list of known hosts. Oct 07 22:45:56 balonias-pi-5 ntpd[974]: Soliciting pool server 2001:ac8:81:65:0:2:0:3 Oct 07 22:45:59 balonias-pi-5 volumio[1071]: info: CoreCommandRouter::executeOnPlugin: multiroom , audioOutputPlay Oct 07 22:45:59 balonias-pi-5 volumio[1071]: info: Error : CoreCommandRouter::executeOnPlugin: No method [audioOutputPlay] in plugin multiroom Oct 07 22:45:59 balonias-pi-5 volumio[1071]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Oct 07 22:45:59 balonias-pi-5 volumio[1071]: TypeError: Cannot read property 'then' of undefined Oct 07 22:45:59 balonias-pi-5 volumio[1071]: at outputs.audioOutputPlay (/volumio/app/plugins/audio_interface/outputs/index.js:367:9) Oct 07 22:45:59 balonias-pi-5 volumio[1071]: at CoreCommandRouter.audioOutputPlay (/volumio/app/index.js:2260:30) Oct 07 22:45:59 balonias-pi-5 volumio[1071]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:1442:26) Oct 07 22:45:59 balonias-pi-5 volumio[1071]: at Socket.emit (events.js:315:20) Oct 07 22:45:59 balonias-pi-5 volumio[1071]: at /volumio/node_modules/socket.io/lib/socket.js:528:12 Oct 07 22:45:59 balonias-pi-5 volumio[1071]: at processTicksAndRejections (internal/process/task_queues.js:75:11) Oct 07 22:45:59 balonias-pi-5 volumio[1071]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Oct 07 22:45:59 balonias-pi-5 sudo[3478]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2024-10-07 22:44 Oct 07 22:45:59 balonias-pi-5 sudo[3478]: 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="bba9e3185e150dd0995f9a49355b34fc6218d5a2" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="8aa57e3ae5b742ea1069404608336a9884ccfb4e" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue 17 Sep 2024 05:01:09 PM CEST" VOLUMIO_VERSION="3.757" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="e0a6dc7e914e3fb93cbf2123f2f73eac"