-- Logs begin at Thu 2019-02-14 17:11:58 +07, end at Sat 2025-02-22 07:38:44 +07. -- Feb 22 07:37:16 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 22 07:37:16 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 22 07:37:16 volumio volumio[1307]: info: Discovery: Getting this device information Feb 22 07:37:16 volumio volumio[1307]: info: CoreCommandRouter::volumioGetState Feb 22 07:37:16 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 22 07:37:25 volumio sudo[4263]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop lircd.service Feb 22 07:37:25 volumio sudo[4263]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:37:25 volumio sudo[4263]: pam_unix(sudo:session): session closed for user root Feb 22 07:37:25 volumio volumio[1307]: info: ir_controller: systemctl stop lircd.service succeeded. Feb 22 07:37:25 volumio volumio[1307]: info: Disabling plugin ir_controller Feb 22 07:37:25 volumio volumio[1307]: info: Done. Feb 22 07:37:29 volumio volumio[1307]: info: Enabling plugin ir_controller Feb 22 07:37:29 volumio volumio[1307]: info: Loading plugin "ir_controller"... Feb 22 07:37:29 volumio volumio[1307]: info: Applying required configuration parameters for plugin ir_controller Feb 22 07:37:29 volumio volumio[1307]: info: PLUGIN START: ir_controller Feb 22 07:37:29 volumio volumio[1307]: info: Loading i18n strings for locale th Feb 22 07:37:29 volumio volumio[1307]: info: Plugin audiophonics_evo_sabre has duplicated i18n key SAVE. It is ignored. Feb 22 07:37:29 volumio volumio[1307]: error: remotepi: Fetching language file: Error: i18n file complementing the system language not found. Feb 22 07:37:29 volumio volumio[1307]: error: ir_controller: Fetching language file: Error: i18n file complementing the system language not found. Feb 22 07:37:29 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Feb 22 07:37:29 volumio sudo[4273]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod -R a+rwX /etc/lirc/irexec.lircrc /etc/lirc/lirc_options.conf /etc/lirc/lircd.conf /etc/lirc/lircd.conf.d /etc/lirc/lircmd.conf /etc/lirc/lircrc Feb 22 07:37:29 volumio sudo[4273]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:37:29 volumio sudo[4273]: pam_unix(sudo:session): session closed for user root Feb 22 07:37:29 volumio volumio[1307]: info: ir_controller: File permissions successfully set on /etc/lirc/*. Feb 22 07:37:29 volumio volumio[1307]: info: ir_controller: LIRC correctly updated. Feb 22 07:37:29 volumio volumio[1307]: info: ir_controller: HAT already loaded /proc/device-tree/ir_receiver! Feb 22 07:37:29 volumio volumio[1307]: info: Done. Feb 22 07:37:30 volumio sudo[4276]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart lircd.service Feb 22 07:37:30 volumio sudo[4276]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:37:30 volumio systemd[1]: Starting lircd(8) initialization helper tool... Feb 22 07:37:30 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: running Feb 22 07:37:30 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Feb 22 07:37:30 volumio lircd-setup[4278]: /usr/sbin/lircd-setup:37: DeprecationWarning: The SafeConfigParser class has been renamed to ConfigParser in Python 3.2. This alias will be removed in future versions. Use ConfigParser directly instead. Feb 22 07:37:30 volumio lircd-setup[4278]: parser = configparser.SafeConfigParser() Feb 22 07:37:30 volumio systemd[1]: lircd-setup.service: Succeeded. Feb 22 07:37:30 volumio systemd[1]: Started lircd(8) initialization helper tool. Feb 22 07:37:30 volumio systemd[1]: Starting Flexible IR remote input/output application support... Feb 22 07:37:30 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: running Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Info: lircd: Opening log, level: Info Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Version: lircd 0.10.1 Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: System info: Linux volumio 6.6.62-v8+ #1816 SMP PREEMPT Mon Nov 18 15:35:52 GMT 2024 aarch64 GNU/Linux Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Info: Initial device: /dev/lirc0 Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Info: [lirc] protocol is enabled Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Info: Initial device: /dev/lirc0 Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Info: [lirc] protocol is enabled Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: driver: default Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: output: /var/run/lirc/lircd Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: nodaemon: 1 Feb 22 07:37:30 volumio lircd[4279]: lircd-0.10.1[4279]: Info: lircd: Opening log, level: Info Feb 22 07:37:30 volumio lircd[4279]: lircd: there seems to already be a lircd process with pid 1835 Feb 22 07:37:30 volumio lircd[4279]: lircd: otherwise delete stale lockfile /var/run/lirc/lircd.pid Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: plugindir: /usr/lib/arm-linux-gnueabihf/lirc/plugins Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: logfile: syslog Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: immediate-init: 0 Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: permission: 666 Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: driver-options: Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: pidfile: /var/run/lirc/lircd.pid Feb 22 07:37:30 volumio systemd[1]: lircd.service: Main process exited, code=exited, status=1/FAILURE Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: listen: 0 Feb 22 07:37:30 volumio systemd[1]: lircd.service: Failed with result 'exit-code'. Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: connect: (null) Feb 22 07:37:30 volumio systemd[1]: Failed to start Flexible IR remote input/output application support. Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: userelease: 0 Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: effective_user: (null) Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: release_suffix: _EVUP Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: allow_simulate: 0 Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: repeat_max: 600 Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: configfile: /etc/lirc/lircd.conf Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Options: dynamic_codes: (null) Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Current driver: default Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Driver API version: 3 Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Driver version: 0.10.0 Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Notice: Driver info: See file:///usr/share/doc/lirc/plugindocs/default.html Feb 22 07:37:30 volumio lircd-0.10.1[4279]: Info: lircd: Opening log, level: Info Feb 22 07:37:30 volumio sudo[4276]: pam_unix(sudo:session): session closed for user root Feb 22 07:37:30 volumio volumio[1307]: error: ir_controller: Failed to restart lircd.service: Error: Command failed: /usr/bin/sudo /bin/systemctl restart lircd.service Feb 22 07:37:30 volumio volumio[1307]: Job for lircd.service failed because the control process exited with error code. Feb 22 07:37:30 volumio volumio[1307]: See "systemctl status lircd.service" and "journalctl -xe" for details. Feb 22 07:37:38 volumio sudo[4302]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop lircd.service Feb 22 07:37:38 volumio sudo[4302]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:37:38 volumio sudo[4302]: pam_unix(sudo:session): session closed for user root Feb 22 07:37:38 volumio volumio[1307]: info: ir_controller: systemctl stop lircd.service succeeded. Feb 22 07:37:38 volumio volumio[1307]: info: Disabling plugin ir_controller Feb 22 07:37:38 volumio volumio[1307]: info: Done. Feb 22 07:37:46 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 22 07:37:46 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 22 07:37:46 volumio volumio[1307]: info: Discovery: Getting this device information Feb 22 07:37:46 volumio volumio[1307]: info: CoreCommandRouter::volumioGetState Feb 22 07:37:46 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 22 07:38:02 volumio sudo[4359]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop mpd_oled_plugin.service Feb 22 07:38:02 volumio sudo[4359]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:38:02 volumio volumio[1307]: info: Disabling plugin mpd_oled Feb 22 07:38:02 volumio volumio[1307]: info: Preparing to generate the ALSA configuration file Feb 22 07:38:02 volumio sudo[4359]: pam_unix(sudo:session): session closed for user root Feb 22 07:38:02 volumio volumio[1307]: info: The plugin multiroom has an ALSA contribution file volumioMultiRoomServer.postMultiRoom.1000.conf Feb 22 07:38:02 volumio volumio[1307]: info: Reading ALSA contributions from plugins. Feb 22 07:38:02 volumio volumio[1307]: info: [MPD_OLED Plugin] Stopped mpd_oled_plugin service Feb 22 07:38:02 volumio volumio[1307]: info: Asound.conf file written Feb 22 07:38:02 volumio sudo[4364]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/mv /home/volumio/.asoundrc /etc/asound.conf Feb 22 07:38:02 volumio sudo[4364]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:38:02 volumio sudo[4364]: pam_unix(sudo:session): session closed for user root Feb 22 07:38:02 volumio volumio[1307]: xcb_connection_has_error() returned true Feb 22 07:38:02 volumio volumio[1307]: info: Output device has changed, restarting MPD Feb 22 07:38:02 volumio sudo[4369]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Feb 22 07:38:02 volumio sudo[4369]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:38:02 volumio volumio[1307]: info: Output device has changed, restarting Shairport Sync Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 22 07:38:02 volumio sudo[4369]: pam_unix(sudo:session): session closed for user root Feb 22 07:38:02 volumio sudo[4372]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Feb 22 07:38:02 volumio sudo[4372]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:38:02 volumio systemd[1]: musicservicesshield.service: Succeeded. Feb 22 07:38:02 volumio systemd[1]: Stopped Shield Volumio Music Services in the User CPU Set. Feb 22 07:38:02 volumio systemd[1]: Stopping Shield Volumio Music Services in the User CPU Set... Feb 22 07:38:02 volumio systemd[1]: Stopping Music Player Daemon... Feb 22 07:38:02 volumio volumio[1307]: xcb_connection_has_error() returned true Feb 22 07:38:02 volumio volumio[1307]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Feb 22 07:38:02 volumio volumio[1307]: xcb_connection_has_error() returned true Feb 22 07:38:02 volumio volumio[1307]: info: MRS: Audio Device Changed, rebuilding Multiroom Configuration Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 22 07:38:02 volumio systemd[1]: mpd.service: Succeeded. Feb 22 07:38:02 volumio systemd[1]: Stopped Music Player Daemon. Feb 22 07:38:02 volumio vtcs[3595]: [2025-02-22 07:38:02.593] [tisoc] [error] [SpkconServer.cpp:376] recv error. socket disconnected Feb 22 07:38:02 volumio vtcs[3595]: [2025-02-22 07:38:02.593] [tisoc] [warning] [SessionManagerImpl.cpp:243] Illegal State: IDLE Feb 22 07:38:02 volumio systemd[1]: Starting Music Player Daemon... Feb 22 07:38:02 volumio volumio[1307]: info: Done. Feb 22 07:38:02 volumio sudo[4381]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Feb 22 07:38:02 volumio sudo[4381]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:38:02 volumio systemd[1]: Stopping Volumio Tidal Connect Service... Feb 22 07:38:02 volumio systemd[1]: vtcs.service: Main process exited, code=killed, status=15/TERM Feb 22 07:38:02 volumio systemd[1]: vtcs.service: Succeeded. Feb 22 07:38:02 volumio sudo[4378]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Feb 22 07:38:02 volumio sudo[4378]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:38:02 volumio systemd[1]: Stopped Volumio Tidal Connect Service. Feb 22 07:38:02 volumio sudo[4378]: pam_unix(sudo:session): session closed for user root Feb 22 07:38:02 volumio sudo[4381]: pam_unix(sudo:session): session closed for user root Feb 22 07:38:02 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: running Feb 22 07:38:02 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Feb 22 07:38:02 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Feb 22 07:38:02 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: running Feb 22 07:38:02 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: running Feb 22 07:38:02 volumio volumio[1307]: info: MPD Permissions set Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Feb 22 07:38:02 volumio volumio[1307]: info: Starting Shairport Sync Feb 22 07:38:02 volumio sudo[4387]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop vtcs.service Feb 22 07:38:02 volumio sudo[4387]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:38:02 volumio sudo[4387]: pam_unix(sudo:session): session closed for user root Feb 22 07:38:02 volumio volumio[1307]: info: mpdhttpout ---Configuration successfully replaced in mpd.conf. Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::volumioGetState Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::volumioPause Feb 22 07:38:02 volumio volumio[1307]: info: CoreStateMachine::pause Feb 22 07:38:02 volumio volumio[1307]: info: CoreStateMachine::stPlaybackTimer Feb 22 07:38:02 volumio volumio[1307]: info: CoreStateMachine::servicePause Feb 22 07:38:02 volumio volumio[1307]: info: CorePlayQueue::getTrack 2 Feb 22 07:38:02 volumio volumio[1307]: info: CoreCommandRouter::servicePause Feb 22 07:38:02 volumio volumio[1307]: info: [1740184682693] ControllerTidal::pause Feb 22 07:38:02 volumio volumio[1307]: info: CoreStateMachine::setConsumeUpdateService mpd Feb 22 07:38:02 volumio volumio[1307]: info: ControllerMpd::pause Feb 22 07:38:02 volumio volumio[1307]: verbose: ControllerMpd::sendMpdCommand pause Feb 22 07:38:02 volumio volumio[1307]: info: mpdhttpout --- Volumio set on pause Feb 22 07:38:02 volumio volumio[1307]: error: MPD error: Error: This socket has been ended by the other party Feb 22 07:38:02 volumio volumio[1307]: error: This socket has been ended by the other party {"code":"EPIPE"} Feb 22 07:38:02 volumio volumio[1307]: error: MPD error: Error: This socket has been ended by the other party Feb 22 07:38:02 volumio volumio[1307]: error: This socket has been ended by the other party {"code":"EPIPE"} Feb 22 07:38:02 volumio volumio[1307]: error: MPD error: Error: This socket has been ended by the other party Feb 22 07:38:02 volumio volumio[1307]: error: This socket has been ended by the other party {"code":"EPIPE"} Feb 22 07:38:02 volumio sudo[4395]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Feb 22 07:38:02 volumio sudo[4395]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:38:02 volumio systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Feb 22 07:38:02 volumio systemd[1]: shairport-sync.service: Succeeded. Feb 22 07:38:02 volumio systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Feb 22 07:38:02 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: running Feb 22 07:38:02 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Feb 22 07:38:02 volumio systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Feb 22 07:38:02 volumio sudo[4395]: pam_unix(sudo:session): session closed for user root Feb 22 07:38:02 volumio volumio[1307]: info: Shairport-Sync Started Feb 22 07:38:02 volumio mpd[4385]: Feb 22 07:38 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Feb 22 07:38:02 volumio systemd[1]: Started Music Player Daemon. Feb 22 07:38:02 volumio sudo[4372]: pam_unix(sudo:session): session closed for user root Feb 22 07:38:02 volumio volumio[1307]: error: updateQueue error: null Feb 22 07:38:02 volumio systemd[1]: Starting Shield Volumio Music Services in the User CPU Set... Feb 22 07:38:02 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: running Feb 22 07:38:03 volumio volumio[4403]: cset: --> shielding system active with Feb 22 07:38:03 volumio volumio[4403]: cset: "system" cpuset of CPUSPEC(1-3) with 191 tasks running Feb 22 07:38:03 volumio volumio[4403]: cset: "user" cpuset of CPUSPEC(0) with 3 tasks running Feb 22 07:38:03 volumio systemd[1]: Started Shield Volumio Music Services in the User CPU Set. Feb 22 07:38:04 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: mpd , restartMpd Feb 22 07:38:04 volumio sudo[4421]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Feb 22 07:38:04 volumio sudo[4421]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:38:04 volumio systemd[1]: musicservicesshield.service: Succeeded. Feb 22 07:38:04 volumio systemd[1]: Stopped Shield Volumio Music Services in the User CPU Set. Feb 22 07:38:04 volumio systemd[1]: Stopping Shield Volumio Music Services in the User CPU Set... Feb 22 07:38:04 volumio systemd[1]: Stopping Music Player Daemon... Feb 22 07:38:04 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: running Feb 22 07:38:04 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Feb 22 07:38:04 volumio systemd[1]: mpd.service: Succeeded. Feb 22 07:38:04 volumio systemd[1]: Stopped Music Player Daemon. Feb 22 07:38:04 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: waiting Feb 22 07:38:04 volumio systemd[1]: Starting Music Player Daemon... Feb 22 07:38:04 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: running Feb 22 07:38:04 volumio sudo[4423]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Feb 22 07:38:04 volumio sudo[4423]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:38:04 volumio sudo[4423]: pam_unix(sudo:session): session closed for user root Feb 22 07:38:05 volumio mpd[4425]: Feb 22 07:38 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Feb 22 07:38:05 volumio systemd[1]: Started Music Player Daemon. Feb 22 07:38:05 volumio sudo[4421]: pam_unix(sudo:session): session closed for user root Feb 22 07:38:05 volumio volumio[1307]: error: updateQueue error: null Feb 22 07:38:05 volumio systemd[1]: Starting Shield Volumio Music Services in the User CPU Set... Feb 22 07:38:05 volumio volumio[1307]: ------------------------------------ BT MESSAGE: BT STATUS: running Feb 22 07:38:05 volumio volumio[4428]: cset: --> shielding system active with Feb 22 07:38:05 volumio volumio[4428]: cset: "system" cpuset of CPUSPEC(1-3) with 191 tasks running Feb 22 07:38:05 volumio volumio[4428]: cset: "user" cpuset of CPUSPEC(0) with 3 tasks running Feb 22 07:38:05 volumio systemd[1]: Started Shield Volumio Music Services in the User CPU Set. Feb 22 07:38:05 volumio volumio[1307]: info: TidalConnect service stoped! Feb 22 07:38:05 volumio volumio[1307]: info: TidalConnect service stoped! Feb 22 07:38:05 volumio volumio[1307]: info: Updating tc_getconfig REST Endpoint for plugin: music_service/tidalconnect Feb 22 07:38:05 volumio volumio[1307]: info: Updating tc_connect REST Endpoint for plugin: music_service/tidalconnect Feb 22 07:38:05 volumio sudo[4455]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start vtcs.service Feb 22 07:38:05 volumio sudo[4455]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:38:05 volumio systemd[1]: Started Volumio Tidal Connect Service. Feb 22 07:38:05 volumio sudo[4455]: pam_unix(sudo:session): session closed for user root Feb 22 07:38:05 volumio volumio[1307]: info: Executing endpoint tc_getconfig Feb 22 07:38:05 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: tidalconnect , onGetConfig Feb 22 07:38:05 volumio vtcs[4457]: STARTING TidalConnect services, version: 1.4.0.34 Feb 22 07:38:05 volumio vtcs[4457]: STARTED TidalConnect services. Feb 22 07:38:05 volumio volumio[1307]: info: Executing endpoint tc_connect Feb 22 07:38:05 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: tidalconnect , onConnect Feb 22 07:38:05 volumio volumio[1307]: info: Connecting to TidalConnect Feb 22 07:38:05 volumio volumio[1307]: info: CoreCommandRouter::servicePushState Feb 22 07:38:05 volumio volumio[1307]: info: CoreStateMachine::pushState Feb 22 07:38:05 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Feb 22 07:38:05 volumio volumio[1307]: info: CoreCommandRouter::volumioPushState Feb 22 07:38:05 volumio volumio[1307]: info: MRS: Pushing multiroomSync output update for this device Feb 22 07:38:05 volumio volumio[1307]: info: MRS: Pushing multiroomSync output Feb 22 07:38:05 volumio volumio[1307]: info: CorePlayQueue::getTrack 2 Feb 22 07:38:05 volumio volumio[1307]: info: CONSUME SERVICE: Received update from a service different from the one supposed to be playing music. Skipping notification. Current mpd Received tidalconnect Feb 22 07:38:05 volumio volumio[1307]: info: CoreCommandRouter::servicePushState Feb 22 07:38:05 volumio volumio[1307]: info: CoreStateMachine::pushState Feb 22 07:38:05 volumio volumio[1307]: info: CoreCommandRouter::volumioPushState Feb 22 07:38:05 volumio volumio[1307]: info: MRS: Pushing multiroomSync output update for this device Feb 22 07:38:05 volumio volumio[1307]: info: MRS: Pushing multiroomSync output Feb 22 07:38:05 volumio volumio[1307]: info: CorePlayQueue::getTrack 2 Feb 22 07:38:05 volumio volumio[1307]: info: CONSUME SERVICE: Received update from a service different from the one supposed to be playing music. Skipping notification. Current mpd Received tidalconnect Feb 22 07:38:05 volumio volumio[1307]: info: [ASDebug] CurState: play PrevState: play Feb 22 07:38:05 volumio volumio[1307]: info: [ASDebug] CurState: play PrevState: play Feb 22 07:38:05 volumio volumio[1307]: info: [GPIO_Control] Status changed: play Feb 22 07:38:05 volumio volumio[1307]: info: [GPIO_Control] Status changed: play Feb 22 07:38:05 volumio volumio[1307]: SPOTIFY: RECEIVED VOLUMIO VOLUME 41 Feb 22 07:38:05 volumio volumio[1307]: SPOTIFY: RECEIVED VOLUMIO VOLUME 41 Feb 22 07:38:08 volumio volumio[1307]: info: TidalConnect service started! Feb 22 07:38:09 volumio volumio[1307]: info: Stopping Pirate audio service Feb 22 07:38:09 volumio volumio[1307]: info: Disabling plugin pirateaudio Feb 22 07:38:09 volumio volumio[1307]: info: Done. Feb 22 07:38:09 volumio sudo[4477]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop pirateaudio.service Feb 22 07:38:09 volumio sudo[4477]: pam_unix(sudo:session): session opened for user root by (uid=0) Feb 22 07:38:09 volumio sudo[4477]: pam_unix(sudo:session): session closed for user root Feb 22 07:38:16 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Feb 22 07:38:16 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Feb 22 07:38:16 volumio volumio[1307]: info: Discovery: Getting this device information Feb 22 07:38:16 volumio volumio[1307]: info: CoreCommandRouter::volumioGetState Feb 22 07:38:16 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Feb 22 07:38:32 volumio volumio[1307]: info: CoreCommandRouter::getUIConfigOnPlugin Feb 22 07:38:42 volumio volumio[1307]: info: CALLMETHOD: system_hardware remotepi saveConf [object Object] Feb 22 07:38:42 volumio volumio[1307]: info: CoreCommandRouter::executeOnPlugin: remotepi , saveConf Feb 22 07:38:44 volumio volumio[1307]: info: ___________ PLUGINS: Run onVolumioReboot Tasks ___________ Feb 22 07:38:44 volumio volumio[1307]: info: PLUGIN onReboot : networkfs Feb 22 07:38:44 volumio volumio[1307]: info: PLUGIN onReboot : audiophonicsonoff Feb 22 07:38:44 volumio volumio[1307]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Feb 22 07:38:44 volumio volumio[1307]: TypeError: Cannot read property 'writeSync' of undefined Feb 22 07:38:44 volumio volumio[1307]: at ControllerAudiophonicsOnOff.onVolumioReboot (/data/plugins/system_hardware/audiophonicsonoff/index.js:40:25) Feb 22 07:38:44 volumio volumio[1307]: at PluginManager.onVolumioRebootPlugin (/volumio/app/pluginmanager.js:684:30) Feb 22 07:38:44 volumio volumio[1307]: at HashMap. (/volumio/app/pluginmanager.js:668:31) Feb 22 07:38:44 volumio volumio[1307]: at HashMap.forEach (/volumio/node_modules/hashmap/hashmap.js:171:10) Feb 22 07:38:44 volumio volumio[1307]: at HashMap.proto. [as forEach] (/volumio/node_modules/hashmap/hashmap.js:201:7) Feb 22 07:38:44 volumio volumio[1307]: at PluginManager.onVolumioReboot (/volumio/app/pluginmanager.js:666:20) Feb 22 07:38:44 volumio volumio[1307]: at CoreCommandRouter.reboot (/volumio/app/index.js:1344:22) Feb 22 07:38:44 volumio volumio[1307]: at Socket. (/volumio/app/plugins/user_interface/websocket/index.js:864:33) Feb 22 07:38:44 volumio volumio[1307]: at Socket.emit (events.js:315:20) Feb 22 07:38:44 volumio volumio[1307]: at /volumio/node_modules/socket.io/lib/socket.js:528:12 Feb 22 07:38:44 volumio volumio[1307]: at processTicksAndRejections (internal/process/task_queues.js:75:11) Feb 22 07:38:44 volumio volumio[1307]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Feb 22 07:38:44 volumio sudo[4592]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2025-02-22 07:37 Feb 22 07:38:44 volumio sudo[4592]: 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="f6610a1100d2380eef33bd3004af43153c786f96" VOLUMIO_FE_VERSION="e7cae168f9927391640a091813b8a9656b6909b6" VOLUMIO_FE3_VERSION="df82a8f23c90a3617c15c55572c8aaea90d8b32a" VOLUMIO_BE_VERSION="1c0e5daee99fe3a72cc38b0d1fe6cd78d7f001fe" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Mon 16 Dec 2024 09:30:04 AM CET" VOLUMIO_VERSION="3.785" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="fe0ac4b79aed19ccde4b5bd83d468193"