Oct 14 10:06:26 adivolumio ntpd[1085]: CLOCK: time stepped by 4801649.969401 Oct 14 10:06:26 adivolumio ntpd[1085]: CLOCK: time changed from 2026-08-19 to 2026-10-14 Oct 14 10:06:26 adivolumio volumio[1291]: info: Scanning category user_interface Oct 14 10:06:26 adivolumio volumio[1291]: info: Scanning into folder /data/plugins/ Oct 14 10:06:26 adivolumio volumio[1291]: info: Scanning category music_service Oct 14 10:06:26 adivolumio volumio[1291]: info: Scanning category system_controller Oct 14 10:06:26 adivolumio ntpd[1085]: INIT: MRU 13107 entries, 13 hash bits, 32768 bytes Oct 14 10:06:26 adivolumio volumio[1291]: info: Scanning category system_hardware Oct 14 10:06:26 adivolumio volumio[1291]: info: Scanning category user_interface Oct 14 10:06:26 adivolumio volumio[1291]: info: Plugin folders cleanup completed Oct 14 10:06:26 adivolumio volumio[1291]: info: ------------------------------------------- Oct 14 10:06:26 adivolumio volumio[1291]: info: ----- Core plugins startup ---- Oct 14 10:06:26 adivolumio volumio[1291]: info: ------------------------------------------- Oct 14 10:06:26 adivolumio volumio[1291]: info: Loading plugins from folder /volumio/app/plugins/ Oct 14 10:06:26 adivolumio volumio[1291]: info: Adding plugin upnp to MyMusic Plugins Oct 14 10:06:26 adivolumio volumio[1291]: info: Adding plugin airplay_emulation to MyMusic Plugins Oct 14 10:06:26 adivolumio volumio[1291]: info: Adding plugin upnp_browser to MyMusic Plugins Oct 14 10:06:26 adivolumio volumio[1291]: info: Loading plugins from folder /data/plugins/ Oct 14 10:06:26 adivolumio volumio[1291]: info: Loading plugin "system"... Oct 14 10:06:26 adivolumio volumio[1291]: info: Loading plugin "appearance"... Oct 14 10:06:26 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:26 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:26 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:26 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:27 adivolumio systemd[1]: systemd-fsckd.service: Deactivated successfully. Oct 14 10:06:27 adivolumio systemd[1]: Starting dpkg-db-backup.service - Daily dpkg database backup service... Oct 14 10:06:27 adivolumio systemd[1]: Starting e2scrub_all.service - Online ext4 Metadata Check for All Filesystems... Oct 14 10:06:27 adivolumio systemd[1]: Started ntpsec-rotate-stats.service - Rotate ntpd stats. Oct 14 10:06:27 adivolumio systemd[1]: e2scrub_all.service: Deactivated successfully. Oct 14 10:06:27 adivolumio systemd[1]: Finished e2scrub_all.service - Online ext4 Metadata Check for All Filesystems. Oct 14 10:06:27 adivolumio systemd[1]: ntpsec-rotate-stats.service: Deactivated successfully. Oct 14 10:06:27 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:27 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:27 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:27 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:27 adivolumio systemd[1]: dpkg-db-backup.service: Deactivated successfully. Oct 14 10:06:27 adivolumio systemd[1]: Finished dpkg-db-backup.service - Daily dpkg database backup service. Oct 14 10:06:28 adivolumio dhcpcd[718]: timed out Oct 14 10:06:28 adivolumio sh[708]: timed out Oct 14 10:06:28 adivolumio sh[647]: ifup: failed to bring up eth0 Oct 14 10:06:28 adivolumio systemd[1]: ifup@eth0.service: Main process exited, code=exited, status=1/FAILURE Oct 14 10:06:28 adivolumio systemd[1]: ifup@eth0.service: Failed with result 'exit-code'. Oct 14 10:06:28 adivolumio volumio[1291]: info: Loading plugin "network"... Oct 14 10:06:28 adivolumio volumio[1291]: info: Refreshing Cached IP Addresses Oct 14 10:06:28 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:28 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:28 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:28 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:28 adivolumio sudo[1492]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 14 10:06:28 adivolumio sudo[1492]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:28 adivolumio sudo[1493]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 14 10:06:28 adivolumio sudo[1493]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:28 adivolumio volumio[1291]: info: Loading plugin "services"... Oct 14 10:06:28 adivolumio volumio[1291]: info: Loading plugin "volumio5onboarding"... Oct 14 10:06:28 adivolumio sudo[1492]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:28 adivolumio sudo[1493]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:28 adivolumio sudo[1502]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/iwlist wlan0 scan Oct 14 10:06:28 adivolumio sudo[1502]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:28 adivolumio volumio[1291]: info: Loading plugin "alsa_controller"... Oct 14 10:06:28 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Oct 14 10:06:28 adivolumio volumio[1291]: info: Loading plugin "wizard"... Oct 14 10:06:28 adivolumio volumio[1291]: info: Loading plugin "networkfs"... Oct 14 10:06:28 adivolumio volumio[1291]: info: Starting Udev Watcher for removable devices Oct 14 10:06:28 adivolumio volumio[1291]: info: Ignoring mount for partition: boot Oct 14 10:06:28 adivolumio volumio[1291]: info: Ignoring mount for partition: volumio Oct 14 10:06:28 adivolumio volumio[1291]: info: Ignoring mount for partition: volumio_data Oct 14 10:06:28 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Oct 14 10:06:28 adivolumio volumio[1291]: info: Loading plugin "pi_screen_setup"... Oct 14 10:06:28 adivolumio sudo[1527]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/mount -t cifs -o username=Adi001,password=Neomax20263,ro,dir_mode=0777,file_mode=0666,iocharset=utf8,noauto,soft //192.168.1.10/music /mnt/NAS/AdiNAS Oct 14 10:06:28 adivolumio sudo[1527]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:28 adivolumio kernel: netfs: FS-Cache loaded Oct 14 10:06:28 adivolumio kernel: Key type cifs.spnego registered Oct 14 10:06:28 adivolumio kernel: Key type cifs.idmap registered Oct 14 10:06:28 adivolumio kernel: CIFS: No dialect specified on mount. Default has changed to a more secure dialect, SMB2.1 or later (e.g. SMB3.1.1), from CIFS (SMB1). To use the less secure SMB1 dialect to access old servers which do not support SMB3.1.1 (or even SMB3 or SMB2.1) specify vers=1.0 on mount. Oct 14 10:06:28 adivolumio kernel: CIFS: Attempting to mount //192.168.1.10/music Oct 14 10:06:29 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:29 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:29 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:29 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:29 adivolumio sudo[1527]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:30 adivolumio volumio[1291]: info: Loading plugin "volumio_command_line_client"... Oct 14 10:06:30 adivolumio volumio[1291]: info: Loading plugin "upnp"... Oct 14 10:06:30 adivolumio volumio[1291]: info: [1791965190272] Starting Upmpd Daemon Oct 14 10:06:30 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Oct 14 10:06:30 adivolumio volumio[1291]: info: Loading plugin "my_music"... Oct 14 10:06:30 adivolumio volumio[1291]: info: Loading plugin "mpd"... Oct 14 10:06:30 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:30 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:30 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:30 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:30 adivolumio volumio[1291]: info: Loading plugin "upnp_browser"... Oct 14 10:06:31 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:31 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:31 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:31 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:31 adivolumio systemd[1]: upmpdcli.service: Scheduled restart job, restart counter is at 2. Oct 14 10:06:31 adivolumio systemd[1]: Stopped upmpdcli.service - UPnP Renderer front-end to MPD. Oct 14 10:06:31 adivolumio systemd[1]: Started upmpdcli.service - UPnP Renderer front-end to MPD. Oct 14 10:06:31 adivolumio upmpdcli[1569]: Could not open config: /tmp/upmpdcli.conf Oct 14 10:06:31 adivolumio systemd[1]: upmpdcli.service: Main process exited, code=exited, status=1/FAILURE Oct 14 10:06:31 adivolumio systemd[1]: upmpdcli.service: Failed with result 'exit-code'. Oct 14 10:06:31 adivolumio systemd[1]: systemd-hostnamed.service: Deactivated successfully. Oct 14 10:06:32 adivolumio sudo[1502]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:32 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:32 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:32 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:32 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:32 adivolumio volumio[1291]: info: Starting UPNP Browser Oct 14 10:06:32 adivolumio volumio[1291]: info: Loading plugin "alarm-clock"... Oct 14 10:06:32 adivolumio volumio[1291]: info: Loading plugin "airplay_emulation"... Oct 14 10:06:32 adivolumio volumio[1291]: info: Starting Shairport Sync Oct 14 10:06:32 adivolumio volumio[1291]: info: Loading plugin "last_100"... Oct 14 10:06:32 adivolumio volumio[1291]: info: Loading plugin "webradio"... Oct 14 10:06:32 adivolumio volumio-remote-updater[834]: [2026-10-14 10:06:32] [connect] Successful connection Oct 14 10:06:33 adivolumio volumio[1291]: info: Loading plugin "i2s_dacs"... Oct 14 10:06:33 adivolumio volumio[1291]: info: Loading plugin "volumiodiscovery"... Oct 14 10:06:33 adivolumio volumio[1291]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Oct 14 10:06:33 adivolumio volumio[1291]: *** WARNING *** Please fix your application to use the native API of Avahi! Oct 14 10:06:33 adivolumio node[1291]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Oct 14 10:06:33 adivolumio volumio[1291]: *** WARNING *** For more information see Oct 14 10:06:33 adivolumio volumio[1291]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Oct 14 10:06:33 adivolumio volumio[1291]: *** WARNING *** Please fix your application to use the native API of Avahi! Oct 14 10:06:33 adivolumio volumio[1291]: *** WARNING *** For more information see Oct 14 10:06:33 adivolumio node[1291]: *** WARNING *** Please fix your application to use the native API of Avahi! Oct 14 10:06:33 adivolumio node[1291]: *** WARNING *** For more information see Oct 14 10:06:33 adivolumio node[1291]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Oct 14 10:06:33 adivolumio node[1291]: *** WARNING *** Please fix your application to use the native API of Avahi! Oct 14 10:06:33 adivolumio node[1291]: *** WARNING *** For more information see Oct 14 10:06:33 adivolumio volumio[1291]: info: Applying required configuration parameters for plugin volumiodiscovery Oct 14 10:06:33 adivolumio volumio[1291]: info: Discovery: Started advertising with name: AdiVolumio Oct 14 10:06:33 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Oct 14 10:06:33 adivolumio volumio[1291]: info: Loading plugin "autostart"... Oct 14 10:06:33 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:33 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:33 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:33 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:33 adivolumio volumio[1291]: info: Applying required configuration parameters for plugin autostart Oct 14 10:06:33 adivolumio volumio[1291]: info: AutoStart - onVolumioStart - read config.json Oct 14 10:06:33 adivolumio volumio[1291]: info: Loading plugin "now_playing"... Oct 14 10:06:34 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:34 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:34 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:34 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:35 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:35 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:35 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:35 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:36 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:36 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:36 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:36 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:36 adivolumio volumio[1291]: info: Loading plugin "outputs"... Oct 14 10:06:36 adivolumio volumio[1291]: info: Loading plugin "albumart"... Oct 14 10:06:36 adivolumio volumio[1291]: info: Plugin example_plugin is not enabled Oct 14 10:06:36 adivolumio volumio[1291]: info: Loading plugin "inputs"... Oct 14 10:06:36 adivolumio volumio[1291]: info: Loading plugin "updater_comm"... Oct 14 10:06:37 adivolumio volumio[1291]: info: Plugin mpdemulation is not enabled Oct 14 10:06:37 adivolumio volumio[1291]: info: Loading plugin "rest_api"... Oct 14 10:06:37 adivolumio volumio[1291]: info: Loading plugin "websocket"... Oct 14 10:06:37 adivolumio volumio[1291]: info: Starting Socket.io Server version 1.7.4 Oct 14 10:06:37 adivolumio volumio[1291]: info: Loading plugin "80s80s"... Oct 14 10:06:37 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:37 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:37 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:37 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:37 adivolumio volumio[1588]: Forking 3 albumart workers Oct 14 10:06:38 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:38 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:38 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:38 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:39 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:39 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:39 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:39 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:39 adivolumio systemd[1]: Starting setdatetime-helper.service - Time Synchronization Helper Service... Oct 14 10:06:40 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:40 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:40 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:40 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:41 adivolumio systemd[1]: setdatetime-helper.service: Deactivated successfully. Oct 14 10:06:41 adivolumio systemd[1]: Finished setdatetime-helper.service - Time Synchronization Helper Service. Oct 14 10:06:41 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:41 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:41 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:41 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:41 adivolumio volumio[1291]: info: Applying required configuration parameters for plugin 80s80s Oct 14 10:06:41 adivolumio volumio[1291]: info: [1791965201412] [80s80s] API delay: 10 Oct 14 10:06:41 adivolumio volumio[1291]: info: Loading plugin "ir_controller"... Oct 14 10:06:42 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:42 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:42 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:42 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:43 adivolumio volumio[1291]: info: Applying required configuration parameters for plugin ir_controller Oct 14 10:06:43 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:43 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:43 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:43 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:44 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:44 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:44 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:44 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:44 adivolumio volumio[1291]: info: Loading plugin "rotaryencoder2"... Oct 14 10:06:44 adivolumio volumio[1600]: Starting albumart workers Oct 14 10:06:45 adivolumio volumio[1601]: Starting albumart workers Oct 14 10:06:45 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:45 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:45 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:45 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:46 adivolumio volumio[1602]: Starting albumart workers Oct 14 10:06:46 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:46 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:46 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:46 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:46 adivolumio systemd[1]: upmpdcli.service: Scheduled restart job, restart counter is at 3. Oct 14 10:06:46 adivolumio systemd[1]: Stopped upmpdcli.service - UPnP Renderer front-end to MPD. Oct 14 10:06:46 adivolumio systemd[1]: Started upmpdcli.service - UPnP Renderer front-end to MPD. Oct 14 10:06:46 adivolumio upmpdcli[1687]: Could not open config: /tmp/upmpdcli.conf Oct 14 10:06:46 adivolumio systemd[1]: upmpdcli.service: Main process exited, code=exited, status=1/FAILURE Oct 14 10:06:46 adivolumio systemd[1]: upmpdcli.service: Failed with result 'exit-code'. Oct 14 10:06:47 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:47 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:47 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:47 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:47 adivolumio volumio-remote-updater[834]: [2026-10-14 10:06:47] [connect] Successful connection Oct 14 10:06:48 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:48 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:48 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:48 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:49 adivolumio volumio[1291]: info: Loading plugin "peppymeterbasic"... Oct 14 10:06:49 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:49 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:49 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:49 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:50 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:50 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:50 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:50 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:51 adivolumio volumio[1291]: info: Loading plugin "touch_display"... Oct 14 10:06:51 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:51 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:51 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:51 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:51 adivolumio volumio[1291]: info: Applying required configuration parameters for plugin touch_display Oct 14 10:06:52 adivolumio volumio[1291]: info: Loading i18n strings for locale hu Oct 14 10:06:52 adivolumio volumio[1291]: error: ir_controller: Fetching language file: Error: i18n file complementing the system language not found. Oct 14 10:06:52 adivolumio volumio[1291]: error: touch_display: Fetching language file: Error: i18n file complementing the system language not found. Oct 14 10:06:52 adivolumio volumio[1291]: Updating browse sources language Oct 14 10:06:52 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Oct 14 10:06:52 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:52 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:52 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:52 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:53 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 14 10:06:53 adivolumio volumio[1291]: info: CoreCommandRouter::initPlayerControls Oct 14 10:06:53 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:06:53 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:06:53 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:06:53 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:06:53 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:06:53 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:06:53 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:06:53 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:06:53 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 14 10:06:53 adivolumio volumio[1291]: Express server listening on port 3000 Oct 14 10:06:53 adivolumio volumio[1291]: [Metrics] WebUI: 29s 263.96ms Oct 14 10:06:53 adivolumio volumio[1291]: info: CoreStateMachine::resetVolumioState Oct 14 10:06:53 adivolumio volumio[1291]: info: CoreStateMachine::getcurrentVolume Oct 14 10:06:53 adivolumio volumio[1291]: info: CoreCommandRouter::volumioRetrievevolume Oct 14 10:06:53 adivolumio sudo[1737]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Oct 14 10:06:53 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:53 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:53 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:53 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:53 adivolumio sudo[1739]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Oct 14 10:06:53 adivolumio sudo[1737]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:53 adivolumio sudo[1739]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:53 adivolumio volumio[1291]: info: Volumio Network Manager: Network status updated: 2 Oct 14 10:06:53 adivolumio sudo[1737]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:53 adivolumio sudo[1739]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:54 adivolumio volumio[1291]: info: VolumeController:: Volume=83 Mute =false Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreStateMachine::pushState Oct 14 10:06:54 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreCommandRouter::volumioPushState Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreStateMachine::updateTrackBlock Oct 14 10:06:54 adivolumio volumio[1291]: info: CorePlayQueue::getTrackBlock Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreCommandRouter::volumioRetrievevolume Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreCommandRouter::volumioGetState Oct 14 10:06:54 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 14 10:06:54 adivolumio volumio[1291]: info: Reloading queue from file Oct 14 10:06:54 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:54 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:54 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:54 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreStateMachine::setRepeat null single undefined Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreStateMachine::pushState Oct 14 10:06:54 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreCommandRouter::volumioPushState Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreStateMachine::setRandom false Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreStateMachine::pushState Oct 14 10:06:54 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Oct 14 10:06:54 adivolumio volumio[1291]: info: CoreCommandRouter::volumioPushState Oct 14 10:06:54 adivolumio volumio[1291]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 1 Oct 14 10:06:54 adivolumio volumio[1291]: info: Setting Device type: Raspberry PI Oct 14 10:06:54 adivolumio volumio[1291]: info: Completed loading Core Plugins Oct 14 10:06:54 adivolumio volumio[1291]: info: Preparing to generate the ALSA configuration file Oct 14 10:06:54 adivolumio volumio[1291]: info: USB Boot Capable - Checking Install to Disk functions for: bootusb Oct 14 10:06:54 adivolumio volumio[1291]: info: USB Boot Capable - System SBC Revision found in cpuinfo: c03115 Oct 14 10:06:54 adivolumio volumio[1291]: info: USB Boot Capable - Found matching device in SBC capable list: Raspberry PI Oct 14 10:06:54 adivolumio volumio[1291]: info: Listing playlists Oct 14 10:06:54 adivolumio volumio[1291]: info: Listing playlists Oct 14 10:06:55 adivolumio volumio[1291]: info: VolumeController:: Volume=83 Mute =false Oct 14 10:06:55 adivolumio volumio[1291]: info: CoreStateMachine::pushState Oct 14 10:06:55 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:06:55 adivolumio volumio[1291]: info: CoreCommandRouter::volumioPushState Oct 14 10:06:55 adivolumio volumio[1291]: info: The plugin peppymeterbasic has an ALSA contribution file peppy_in.peppy_out.6.conf Oct 14 10:06:55 adivolumio volumio[1291]: info: Reading ALSA contributions from plugins. Oct 14 10:06:55 adivolumio sudo[1759]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start upmpdcli.service Oct 14 10:06:55 adivolumio sudo[1759]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:55 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:55 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:55 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:55 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:55 adivolumio volumio[1291]: info: Discovery: adding ef5ff196-6c17-43d5-8faa-b6d447bc4a5a Oct 14 10:06:55 adivolumio volumio[1291]: info: Discovery: Found device AdiVolumio Oct 14 10:06:55 adivolumio volumio[1291]: info: CoreCommandRouter::volumioGetState Oct 14 10:06:55 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:06:55 adivolumio volumio[1291]: info: Discovery: this is already registered, ef5ff196-6c17-43d5-8faa-b6d447bc4a5a Oct 14 10:06:55 adivolumio volumio[1291]: info: Discovery: Found device AdiVolumio Oct 14 10:06:55 adivolumio volumio[1291]: info: CoreCommandRouter::volumioGetState Oct 14 10:06:55 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:06:56 adivolumio volumio[1291]: info: Asound.conf file unchanged, so no further update is needed Oct 14 10:06:56 adivolumio volumio[1291]: info: Output device has changed, restarting MPD Oct 14 10:06:56 adivolumio volumio[1291]: info: Output device has changed, restarting Shairport Sync Oct 14 10:06:56 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:06:56 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 14 10:06:56 adivolumio sudo[1766]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Oct 14 10:06:56 adivolumio sudo[1766]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:56 adivolumio sudo[1764]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Oct 14 10:06:56 adivolumio sudo[1764]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:56 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:56 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:56 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:56 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:56 adivolumio systemd[1]: volumio-autoplay.service: Control process exited, code=killed, status=15/TERM Oct 14 10:06:56 adivolumio systemd[1]: volumio-autoplay.service: Failed with result 'signal'. Oct 14 10:06:56 adivolumio systemd[1]: Stopped volumio-autoplay.service - Restore Volumio playback after boot when audio path and network are ready. Oct 14 10:06:56 adivolumio systemd[1]: Stopping mpd.service - Music Player Daemon... Oct 14 10:06:56 adivolumio sudo[1764]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:56 adivolumio volumio[1291]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Oct 14 10:06:56 adivolumio volumio[1291]: info: ___________ START PLUGINS ___________ Oct 14 10:06:56 adivolumio volumio[1291]: info: pi_screen_setup: Starting plugin Oct 14 10:06:56 adivolumio volumio[1291]: info: pi_screen_setup: Loaded cached presets v1.5.6 Oct 14 10:06:56 adivolumio volumio[1291]: info: pi_screen_setup: Active presets source: cached, 227 presets loaded Oct 14 10:06:56 adivolumio volumio[1291]: info: pi_screen_setup: Detected model: Raspberry Pi 4 Model B Rev 1.5 Oct 14 10:06:56 adivolumio volumio[1291]: info: pi_screen_setup: Detected SoC: bcm2711 Oct 14 10:06:56 adivolumio volumio[1291]: info: pi_screen_setup: Detected RAM: 3783 MB Oct 14 10:06:56 adivolumio volumio[1291]: info: pi_screen_setup: Hardware detection complete - {"model":"Pi 4","model_raw":"Raspberry Pi 4 Model B Rev 1.5","soc":"bcm2711","ram_mb":3783,"hdmi_ports":2,"dsi_ports":["dsi0","dsi1"],"has_composite":true,"kms_supported":true,"kms_overlay":"vc4-kms-v3d-pi4","is_pi":true} Oct 14 10:06:56 adivolumio volumio[1291]: info: ControllerMpd::onStart: Initializing MPD Oct 14 10:06:56 adivolumio volumio[1291]: info: Creating MPD Configuration file Oct 14 10:06:56 adivolumio systemd[1]: mpd.service: Deactivated successfully. Oct 14 10:06:56 adivolumio systemd[1]: Stopped mpd.service - Music Player Daemon. Oct 14 10:06:56 adivolumio systemd[1]: mpd.service: Consumed 3.323s CPU time. Oct 14 10:06:56 adivolumio systemd[1]: mpd.socket: Deactivated successfully. Oct 14 10:06:56 adivolumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. Oct 14 10:06:56 adivolumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... Oct 14 10:06:56 adivolumio sudo[1774]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start volumio5-onboarding.service Oct 14 10:06:56 adivolumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. Oct 14 10:06:56 adivolumio systemd[1]: Starting mpd.service - Music Player Daemon... Oct 14 10:06:56 adivolumio sudo[1774]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:56 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Oct 14 10:06:56 adivolumio volumio[1291]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Oct 14 10:06:56 adivolumio volumio[1291]: info: [1791965216893] CoreMusicLibrary::Adding element Médiaszerverek Oct 14 10:06:56 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Oct 14 10:06:56 adivolumio sudo[1778]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Oct 14 10:06:56 adivolumio volumio[1291]: info: UPNP Browser: Client initialized successfully Oct 14 10:06:56 adivolumio sudo[1778]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:56 adivolumio sudo[1780]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Oct 14 10:06:56 adivolumio sudo[1780]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Oct 14 10:06:56 adivolumio sudo[1782]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Oct 14 10:06:56 adivolumio sudo[1780]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:57 adivolumio sudo[1778]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:57 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:06:57 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 14 10:06:57 adivolumio sudo[1782]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:57 adivolumio systemd[1]: Started volumio5-onboarding.service - Volumio5 Onboarding Server. Oct 14 10:06:57 adivolumio sudo[1774]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:57 adivolumio volumio[1291]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Oct 14 10:06:57 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:06:57 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 14 10:06:57 adivolumio systemd[1]: mpd.service: Deactivated successfully. Oct 14 10:06:57 adivolumio systemd[1]: Stopped mpd.service - Music Player Daemon. Oct 14 10:06:57 adivolumio systemd[1]: mpd.socket: Deactivated successfully. Oct 14 10:06:57 adivolumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. Oct 14 10:06:57 adivolumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... Oct 14 10:06:57 adivolumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. Oct 14 10:06:57 adivolumio systemd[1]: Starting mpd.service - Music Player Daemon... Oct 14 10:06:57 adivolumio volumio[1291]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Oct 14 10:06:57 adivolumio volumio[1291]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Oct 14 10:06:57 adivolumio volumio[1291]: info: [1791965217404] CoreMusicLibrary::Adding element Last_100 Oct 14 10:06:57 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Oct 14 10:06:57 adivolumio volumio[1291]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Oct 14 10:06:57 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:57 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:57 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:57 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:57 adivolumio volumio[1291]: info: [1791965217420] CoreMusicLibrary::Adding element Webradio Oct 14 10:06:57 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Oct 14 10:06:57 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Oct 14 10:06:57 adivolumio volumio[1291]: info: Initializing BBC Radios Oct 14 10:06:57 adivolumio sudo[1803]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Oct 14 10:06:57 adivolumio sudo[1803]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Oct 14 10:06:57 adivolumio sudo[1803]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:57 adivolumio volumio5-onboarding[1790]: time=2026-10-14T10:06:57.584+02:00 level=INFO msg="running volumio5-device-gateway" version=6370e0a8+CHANGES buildDate=2026-03-06T16:29:42Z Oct 14 10:06:58 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Oct 14 10:06:58 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 14 10:06:58 adivolumio volumio[1291]: info: AutoStart - onStart Oct 14 10:06:58 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:58 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:58 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:58 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:58 adivolumio volumio[1291]: info: [now-playing] ConfigUpdater: config is up to date. Oct 14 10:06:58 adivolumio volumio[1291]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Oct 14 10:06:58 adivolumio volumio[1291]: info: [1791965218544] CoreMusicLibrary::Adding element 80s80s Radio Oct 14 10:06:58 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Oct 14 10:06:58 adivolumio volumio[1291]: Cannot find translation for source 80s80s Radio Oct 14 10:06:58 adivolumio volumio[1291]: info: Loading i18n strings for locale hu Oct 14 10:06:58 adivolumio volumio[1291]: error: ir_controller: Fetching language file: Error: i18n file complementing the system language not found. Oct 14 10:06:58 adivolumio volumio[1291]: error: touch_display: Fetching language file: Error: i18n file complementing the system language not found. Oct 14 10:06:58 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Oct 14 10:06:58 adivolumio volumio[1291]: info: [ROTARYENCODER2] loadI18nStrings: /data/plugins/system_hardware/rotaryencoder2/i18n/strings_hu.json Oct 14 10:06:58 adivolumio volumio[1291]: info: [ROTARYENCODER2] loadI18nStrings: hu not found. Fallback to en Oct 14 10:06:58 adivolumio volumio[1291]: info: [ROTARYENCODER2] onStart: Config loaded: Oct 14 10:06:58 adivolumio volumio[1291]: info: [ROTARYENCODER2] dtoverlayL Oct 14 10:06:58 adivolumio mpd[1807]: 2026-10-14T10:06:58 decoder: Decoder plugin "wildmidi" is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Oct 14 10:06:58 adivolumio systemd[1]: Started mpd.service - Music Player Daemon. Oct 14 10:06:59 adivolumio sudo[1766]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:59 adivolumio sudo[1782]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:59 adivolumio systemd[1]: Starting volumio-autoplay.service - Restore Volumio playback after boot when audio path and network are ready... Oct 14 10:06:59 adivolumio sudo[1827]: volumio : PWD=/ ; USER=root ; COMMAND=/usr/bin/dtoverlay -l Oct 14 10:06:59 adivolumio sudo[1827]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:59 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , updateALSAConfigFile Oct 14 10:06:59 adivolumio sudo[1827]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:59 adivolumio volumio[1291]: info: Loading i18n strings for locale hu Oct 14 10:06:59 adivolumio volumio[1291]: error: ir_controller: Fetching language file: Error: i18n file complementing the system language not found. Oct 14 10:06:59 adivolumio volumio[1291]: error: touch_display: Fetching language file: Error: i18n file complementing the system language not found. Oct 14 10:06:59 adivolumio sudo[1832]: volumio : PWD=/ ; USER=root ; COMMAND=/sbin/modprobe snd_aloop index=7 pcm_substreams=2 Oct 14 10:06:59 adivolumio sudo[1832]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:59 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Oct 14 10:06:59 adivolumio volumio[1291]: info: Volumio Calling Home Oct 14 10:06:59 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:59 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:59 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:06:59 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:06:59 adivolumio sudo[1832]: pam_unix(sudo:session): session closed for user root Oct 14 10:06:59 adivolumio sudo[1836]: volumio : PWD=/ ; USER=root ; COMMAND=/usr/bin/mkdir -p /data/volumiokioskextensions/IframeKeyboardBridge Oct 14 10:06:59 adivolumio sudo[1836]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:06:59 adivolumio volumio[1291]: info: pi_screen_setup: Detected prior configuration (backup=false, banner=true) - restoring wizard_complete Oct 14 10:06:59 adivolumio volumio[1291]: info: pi_screen_setup: Boot validation - {"valid":false,"drift_detected":true,"missing_videoconfig":false,"missing_include":true,"config_mismatch":false,"volumioconfig_mismatch":false,"errors":["ERR_INCLUDE_MISSING"]} Oct 14 10:06:59 adivolumio sudo[1836]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:00 adivolumio volumio[1291]: info: Preparing to generate the ALSA configuration file Oct 14 10:07:00 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:00 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:00 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:00 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:00 adivolumio sudo[1864]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod -R a+rwX /etc/lirc/irexec.lircrc /etc/lirc/irexec.lircrc.before-ir-long-play-20260819 /etc/lirc/irexec.lircrc.before-volume-up-down-20260819 /etc/lirc/lirc_options.conf /etc/lirc/lircd.conf /etc/lirc/lircd.conf.d /etc/lirc/lircmd.conf /etc/lirc/lircrc /etc/lirc/lircrc.before-ir-long-play-20260819 /etc/lirc/lircrc.before-volume-up-down-20260819 Oct 14 10:07:00 adivolumio sudo[1864]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:00 adivolumio sudo[1864]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:00 adivolumio volumio[1291]: info: pi_screen_setup: Management server started on port 4567 Oct 14 10:07:00 adivolumio sudo[1871]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl daemon-reload Oct 14 10:07:00 adivolumio sudo[1867]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop getty@tty1.service Oct 14 10:07:00 adivolumio sudo[1867]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:00 adivolumio sudo[1872]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl disable getty@tty1.service Oct 14 10:07:00 adivolumio sudo[1872]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:00 adivolumio sudo[1871]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:01 adivolumio sudo[1867]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:01 adivolumio systemd[1]: Reloading. Oct 14 10:07:01 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:01 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:01 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:01 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:02 adivolumio systemd[1]: Reloading. Oct 14 10:07:02 adivolumio sudo[1871]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:02 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:02 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:02 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:02 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:02 adivolumio volumio-remote-updater[834]: [2026-10-14 10:07:02] [connect] Successful connection Oct 14 10:07:03 adivolumio systemd[1]: upmpdcli.service: Scheduled restart job, restart counter is at 4. Oct 14 10:07:03 adivolumio systemd[1]: Stopped upmpdcli.service - UPnP Renderer front-end to MPD. Oct 14 10:07:03 adivolumio sudo[1872]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:03 adivolumio systemd[1]: Started upmpdcli.service - UPnP Renderer front-end to MPD. Oct 14 10:07:03 adivolumio sudo[1759]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:03 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:03 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:03 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:03 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:03 adivolumio volumio[1291]: info: [now-playing] Fetching API key... Oct 14 10:07:03 adivolumio volumio[1291]: info: [now-playing] App is listening on port 4004. Oct 14 10:07:03 adivolumio volumio[1291]: warn: [now-playing] MyBackgroundMonitor is now watching /data/INTERNAL/NowPlayingPlugin/My Backgrounds Oct 14 10:07:03 adivolumio volumio[1291]: info: AutoStart - Plugin is starting Oct 14 10:07:03 adivolumio volumio[1291]: info: CoreCommandRouter::volumioGetQueue Oct 14 10:07:03 adivolumio volumio[1291]: info: CoreStateMachine::getQueue Oct 14 10:07:03 adivolumio volumio[1291]: info: CorePlayQueue::getQueue Oct 14 10:07:03 adivolumio volumio[1291]: info: AutoStart - start playing Oct 14 10:07:03 adivolumio volumio[1291]: info: AutoStart - start playing with no specific position Oct 14 10:07:03 adivolumio volumio[1291]: info: CoreCommandRouter::volumioPlay Oct 14 10:07:03 adivolumio volumio[1291]: info: CoreStateMachine::play index 0 Oct 14 10:07:03 adivolumio volumio[1291]: info: CoreStateMachine::setConsumeUpdateService undefined Oct 14 10:07:03 adivolumio volumio[1291]: info: CoreStateMachine::stop Oct 14 10:07:03 adivolumio volumio[1291]: info: CoreStateMachine::setConsumeUpdateService undefined Oct 14 10:07:03 adivolumio volumio[1291]: info: CoreStateMachine::play index undefined Oct 14 10:07:03 adivolumio volumio[1291]: info: CoreStateMachine::setConsumeUpdateService undefined Oct 14 10:07:03 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:07:03 adivolumio volumio[1291]: info: CoreStateMachine::startPlaybackTimer Oct 14 10:07:03 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:07:03 adivolumio volumio[1291]: info: [1791965223857] ControllerWebradio::clearAddPlayTrack Oct 14 10:07:03 adivolumio volumio[1291]: verbose: ControllerMpd::sendMpdCommand stop Oct 14 10:07:03 adivolumio volumio[1291]: info: The plugin peppymeterbasic has an ALSA contribution file peppy_in.peppy_out.6.conf Oct 14 10:07:03 adivolumio volumio[1291]: info: Reading ALSA contributions from plugins. Oct 14 10:07:03 adivolumio volumio[1291]: info: touch_display: No backlight interface detected. Oct 14 10:07:04 adivolumio volumio[1291]: info: touch_display: systemctl daemon-reload succeeded. Oct 14 10:07:04 adivolumio volumio[1291]: info: touch_display: systemctl disable getty@tty1.service succeeded. Oct 14 10:07:04 adivolumio volumio[1291]: info: touch_display: systemctl stop getty@tty1.service succeeded. Oct 14 10:07:04 adivolumio volumio[1291]: info: ir_controller: File permissions successfully set on /etc/lirc/*. Oct 14 10:07:04 adivolumio volumio[1291]: info: snd_dummy loaded Oct 14 10:07:04 adivolumio volumio[1291]: info: [ROTARYENCODER2] dtoverlayL returned: [] Oct 14 10:07:04 adivolumio volumio[1291]: info: [ROTARYENCODER2] installAllOverlays: 2 Oct 14 10:07:04 adivolumio volumio[1291]: info: [ROTARYENCODER2] installAllOverlays: 1 Oct 14 10:07:04 adivolumio volumio[1291]: info: [ROTARYENCODER2] installAllOverlays: 0 Oct 14 10:07:04 adivolumio volumio[1291]: info: [ROTARYENCODER2] installAllOverlays: end of recursion. Oct 14 10:07:04 adivolumio volumio[1291]: info: [ROTARYENCODER2] dtoverlayAdd Oct 14 10:07:04 adivolumio sudo[1929]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl start volumio-kiosk.service Oct 14 10:07:04 adivolumio sudo[1929]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:04 adivolumio volumio[1291]: info: MPD Permissions set Oct 14 10:07:04 adivolumio volumio[1291]: info: MPD Permissions set Oct 14 10:07:04 adivolumio volumio[1291]: info: Upmpdcli Daemon Started Oct 14 10:07:04 adivolumio sudo[1934]: volumio : PWD=/ ; USER=root ; COMMAND=/usr/bin/dtoverlay rotary-encoder pin_a=22 pin_b=27 relative_axis=true steps-per-period=2 Oct 14 10:07:04 adivolumio sudo[1934]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:04 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:04 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:04 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:04 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:04 adivolumio systemd[1]: Started volumio-kiosk.service - Volumio Kiosk. Oct 14 10:07:04 adivolumio sudo[1929]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:04 adivolumio volumio[1291]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: Go-http-client/1.1 Engine version: 3 Transport: websocket Total Clients: 2 Oct 14 10:07:04 adivolumio volumio[1291]: info: Volumio called home Oct 14 10:07:04 adivolumio sudo[1932]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/cp -r /data/plugins/user_interface/touch_display/iframe_keyboard_bridge/content.js /data/plugins/user_interface/touch_display/iframe_keyboard_bridge/manifest.json /data/volumiokioskextensions/IframeKeyboardBridge/ Oct 14 10:07:04 adivolumio sudo[1932]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:04 adivolumio sudo[1932]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:04 adivolumio kernel: rotary-encoder rotary@16: gray Oct 14 10:07:04 adivolumio kernel: input: rotary@16 as /devices/platform/rotary@16/input/input4 Oct 14 10:07:04 adivolumio volumio[1291]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: Go-http-client/1.1 Engine version: 3 Transport: websocket Total Clients: 2 Oct 14 10:07:04 adivolumio volumio[1291]: info: Received Get System Info Oct 14 10:07:04 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 14 10:07:04 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 14 10:07:04 adivolumio volumio[1291]: info: Discovery: Getting this device information Oct 14 10:07:04 adivolumio volumio[1291]: info: CoreCommandRouter::volumioGetState Oct 14 10:07:04 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:07:04 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 14 10:07:04 adivolumio sudo[1934]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:04 adivolumio startx[1967]: X.Org X Server 1.21.1.7 Oct 14 10:07:04 adivolumio startx[1967]: X Protocol Version 11, Revision 0 Oct 14 10:07:04 adivolumio startx[1967]: Current Operating System: Linux adivolumio 6.12.74-v7l+ #1948 SMP Mon Mar 2 11:27:49 GMT 2026 armv7l Oct 14 10:07:04 adivolumio startx[1967]: Kernel command line: coherent_pool=1M 8250.nr_uarts=0 snd_bcm2835.enable_headphones=0 cgroup_disable=memory numa_policy=interleave nvme.max_host_mem_size_mb=0 snd_bcm2835.enable_hdmi=0 video=HDMI-A-1:1920x480M@60D numa=fake=2 system_heap.max_order=0 iommu_dma_numa_policy=interleave smsc95xx.macaddr=88:A2:9E:69:AE:04 vc_mem.mem_base=0x3ec00000 vc_mem.mem_size=0x40000000 splash plymouth.ignore-serial-consoles dwc_otg.fiq_enable=1 dwc_otg.fiq_fsm_enable=1 dwc_otg.fiq_fsm_mask=0xF dwc_otg.nak_holdoff=1 quiet console=ttyS0,115200 console=tty1 imgpart=UUID=cafa11af-4043-4b82-b2f1-cf9789a0d0ff imgfile=/volumio_current.sqsh bootpart=UUID=EFEC-2342 datapart=UUID=3bba9da0-7f1b-4d9e-aef5-c0cdf6d74a8c uuidconfig=cmdline.txt rootwait bootdelay=7 logo.nologo vt.global_cursor_default=0 net.ifnames=0 snd_bcm2835.enable_hdmi=1 snd_bcm2835.enable_headphones=1 loglevel=0 nodebug use_kmsg=no Oct 14 10:07:04 adivolumio startx[1967]: xorg-server 2:21.1.7-3+rpt3+deb12u11 (https://www.debian.org/support) Oct 14 10:07:04 adivolumio startx[1967]: Current version of pixman: 0.44.0 Oct 14 10:07:04 adivolumio startx[1967]: Before reporting problems, check http://wiki.x.org Oct 14 10:07:04 adivolumio startx[1967]: to make sure that you have the latest version. Oct 14 10:07:04 adivolumio startx[1967]: Markers: (--) probed, (**) from config file, (==) default setting, Oct 14 10:07:04 adivolumio startx[1967]: (++) from command line, (!!) notice, (II) informational, Oct 14 10:07:04 adivolumio startx[1967]: (WW) warning, (EE) error, (NI) not implemented, (??) unknown. Oct 14 10:07:04 adivolumio startx[1967]: (==) Log file: "/var/log/Xorg.0.log", Time: Wed Oct 14 10:07:04 2026 Oct 14 10:07:04 adivolumio startx[1967]: (==) Using config directory: "/etc/X11/xorg.conf.d" Oct 14 10:07:04 adivolumio startx[1967]: (==) Using system config directory "/usr/share/X11/xorg.conf.d" Oct 14 10:07:04 adivolumio volumio5-onboarding[1790]: time=2026-10-14T10:07:04.953+02:00 level=INFO msg="system info for d9c9c8c9ed24b01f43e005bffba2c0f8" deviceName=AdiVolumio deviceVariant=volumio deviceModel= softwareVersion=4.119 Oct 14 10:07:04 adivolumio volumio5-onboarding[1790]: time=2026-10-14T10:07:04.978+02:00 level=INFO msg="bootstrapping state" hasInternet=true Oct 14 10:07:05 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:05 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:05 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:05 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:05 adivolumio volumio[1291]: error: MPD error: The expression evaluated to a falsy value: Oct 14 10:07:05 adivolumio volumio[1291]: assert.ok(self.idling) Oct 14 10:07:05 adivolumio volumio[1291]: error: The expression evaluated to a falsy value: Oct 14 10:07:05 adivolumio volumio[1291]: assert.ok(self.idling) Oct 14 10:07:05 adivolumio volumio-remote-updater[834]: [2026-10-14 10:07:05] [connect] WebSocket Connection 127.0.0.1:3000 v-2 "WebSocket++/0.8.2" /socket.io/?EIO=3&transport=websocket&t=1791965222 101 Oct 14 10:07:05 adivolumio volumio[1291]: verbose: New Socket.io Connection to 127.0.0.1:3000 from 127.0.0.1 UA: WebSocket++/0.8.2 Engine version: 3 Transport: websocket Total Clients: 3 Oct 14 10:07:05 adivolumio volumio[1291]: info: MPD running with PID1807 Oct 14 10:07:05 adivolumio volumio[1291]: ,establishing connection Oct 14 10:07:05 adivolumio volumio[1291]: info: touch_display: systemctl start volumio-kiosk.service succeeded. Oct 14 10:07:05 adivolumio volumio[1291]: info: touch_display: Volumio Kiosk started. Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::volumioGetState Oct 14 10:07:06 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 14 10:07:06 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:06 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:06 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:06 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:06 adivolumio volumio[1291]: info: Received Get System Info Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Oct 14 10:07:06 adivolumio volumio[1291]: info: Discovery: Getting this device information Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::volumioGetState Oct 14 10:07:06 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:07:06 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Oct 14 10:07:06 adivolumio volumio[1291]: error: updateQueue error: null Oct 14 10:07:07 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:07 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:07 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:07 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:07 adivolumio volumio[1291]: info: CoreCommandRouter::volumioGetState Oct 14 10:07:07 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:07:07 adivolumio volumio[1291]: info: [ROTARYENCODER2] dtoverlayAdd executed: /usr/bin/sudo /usr/bin/dtoverlay rotary-encoder pin_a=22 pin_b=27 relative_axis=true steps-per-period=2 Oct 14 10:07:08 adivolumio volumio[1291]: info: touch_display: IframeKeyboardBridge extension installed successfully Oct 14 10:07:08 adivolumio volumio[1291]: info: CoreCommandRouter::volumioGetState Oct 14 10:07:08 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:07:08 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:08 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:08 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:08 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:08 adivolumio volumio-remote-updater[834]: Test mode disabled Oct 14 10:07:08 adivolumio volumio-remote-updater[834]: Alpha mode disabled Oct 14 10:07:08 adivolumio volumio-remote-updater[834]: Alpha legacy test mode disabled Oct 14 10:07:09 adivolumio volumio[1291]: Upnp client error: Error: This socket has been ended by the other party Oct 14 10:07:09 adivolumio volumio[1291]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 4 Oct 14 10:07:09 adivolumio volumio[1291]: info: touch_display: X display number found: 0 Oct 14 10:07:09 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:09 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:09 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:09 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:09 adivolumio volumio[1291]: info: [ROTARYENCODER2] attachEventEmitter: path: /dev/input/by-path/platform-rotary@16-event, type: rotary-encoder Oct 14 10:07:09 adivolumio volumio[1291]: info: [ROTARYENCODER2] addEventListeners for rotary: {"pinA":22,"type":"rotary-encoder"} Oct 14 10:07:09 adivolumio volumio[1291]: info: [ROTARYENCODER2] dtoverlayAdd Oct 14 10:07:09 adivolumio volumio[1291]: error: updateQueue error: null Oct 14 10:07:09 adivolumio sudo[2093]: volumio : PWD=/ ; USER=root ; COMMAND=/usr/bin/dtoverlay gpio-key gpio=17 active_low=true gpio_pull=up keycode=20 Oct 14 10:07:09 adivolumio sudo[2093]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:09 adivolumio volumio[1291]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 5 Oct 14 10:07:09 adivolumio volumio[1291]: info: touch_display: Using Xserver unix domain socket /tmp/.X11-unix/X0 Oct 14 10:07:09 adivolumio sudo[2093]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:09 adivolumio kernel: input: button@11 as /devices/platform/button@11/input/input5 Oct 14 10:07:10 adivolumio volumio[1291]: info: Starting Shairport Sync Oct 14 10:07:10 adivolumio volumio[1291]: info: Starting Shairport Sync Oct 14 10:07:10 adivolumio volumio[1291]: info: Starting Shairport Sync Oct 14 10:07:10 adivolumio sudo[2120]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Oct 14 10:07:10 adivolumio sudo[2120]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:10 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:10 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:10 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:10 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:10 adivolumio volumio[1291]: info: touch_display: No Raspberry Pi Foundation touch screen detected. Oct 14 10:07:10 adivolumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... Oct 14 10:07:10 adivolumio systemd[1]: shairport-sync.service: Deactivated successfully. Oct 14 10:07:10 adivolumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Oct 14 10:07:10 adivolumio systemd[1]: shairport-sync.service: Consumed 1.293s CPU time. Oct 14 10:07:10 adivolumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Oct 14 10:07:10 adivolumio sudo[2120]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:10 adivolumio sudo[2136]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod a+rw /etc/X11/xorg.conf.d/99-vc4.conf Oct 14 10:07:10 adivolumio sudo[2136]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:10 adivolumio sudo[2125]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Oct 14 10:07:10 adivolumio sudo[2123]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Oct 14 10:07:10 adivolumio sudo[2123]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:10 adivolumio sudo[2139]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod a+rw /etc/X11/xorg.conf.d/95-touch_display-plugin.conf Oct 14 10:07:10 adivolumio sudo[2139]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:10 adivolumio sudo[2136]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:10 adivolumio sudo[2139]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:10 adivolumio sudo[2125]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:10 adivolumio volumio[1291]: info: Update Ready: {"changeLogLink":"","description":"You're already on the latest version","title":"No Updates Available","updateavailable":false} Oct 14 10:07:10 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache Oct 14 10:07:11 adivolumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... Oct 14 10:07:11 adivolumio systemd[1]: shairport-sync.service: Deactivated successfully. Oct 14 10:07:11 adivolumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Oct 14 10:07:11 adivolumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Oct 14 10:07:11 adivolumio systemd[1]: Stopping shairport-sync.service - Shairport Sync - AirPlay Audio Receiver... Oct 14 10:07:11 adivolumio sudo[2123]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:11 adivolumio systemd[1]: shairport-sync.service: Deactivated successfully. Oct 14 10:07:11 adivolumio systemd[1]: Stopped shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Oct 14 10:07:11 adivolumio systemd[1]: Started shairport-sync.service - Shairport Sync - AirPlay Audio Receiver. Oct 14 10:07:11 adivolumio sudo[2125]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:11 adivolumio volumio[1291]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 6 Oct 14 10:07:11 adivolumio volumio[1291]: info: [ROTARYENCODER2] dtoverlayAdd executed: /usr/bin/sudo /usr/bin/dtoverlay gpio-key gpio=17 active_low=true gpio_pull=up keycode=20 Oct 14 10:07:11 adivolumio volumio[1291]: info: touch_display: X display number found: 0 Oct 14 10:07:11 adivolumio volumio[1291]: info: ir_controller: LIRC correctly updated. Oct 14 10:07:11 adivolumio volumio[1291]: info: ir_controller: HAT did not load /proc/device-tree/ir_receiver! Oct 14 10:07:11 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:11 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:11 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:11 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:11 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getMyVolumioStatus Oct 14 10:07:11 adivolumio volumio5-onboarding[1790]: time=2026-10-14T10:07:11.612+02:00 level=WARN msg="could not read OAuth data for music provider" component=volumio provider=tidal error="could not open plugin config file for \"tidal\": open /data/configuration/music_service/tidal/config.json: no such file or directory" Oct 14 10:07:11 adivolumio volumio5-onboarding[1790]: time=2026-10-14T10:07:11.613+02:00 level=WARN msg="could not read OAuth data for music provider" component=volumio provider=qobuz error="could not open plugin config file for \"qobuz\": open /data/configuration/music_service/qobuz/config.json: no such file or directory" Oct 14 10:07:11 adivolumio volumio5-onboarding[1790]: time=2026-10-14T10:07:11.613+02:00 level=WARN msg="could not read username/password data for music provider" component=volumio provider=hi_res_audio error="could not open plugin config file for \"hi_res_audio\": open /data/configuration/music_service/hi_res_audio/config.json: no such file or directory" Oct 14 10:07:11 adivolumio volumio[1291]: error: Failed LSINFO: Error: [50@0] {lsinfo} No such directory Oct 14 10:07:12 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:12 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:12 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:12 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:13 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:13 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:13 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:13 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:14 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:14 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:14 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:14 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:15 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:15 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:15 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:15 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:16 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:16 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:16 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:16 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:16 adivolumio volumio[1291]: info: CoreCommandRouter::volumioGetState Oct 14 10:07:16 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:07:16 adivolumio volumio[1291]: info: touch_display: File permissions for /etc/X11/xorg.conf.d/95-touch_display-plugin.conf set. Oct 14 10:07:17 adivolumio volumio[1291]: info: touch_display: File permissions for /etc/X11/xorg.conf.d/99-vc4.conf set. Oct 14 10:07:17 adivolumio volumio[1291]: info: Shairport-Sync Started Oct 14 10:07:17 adivolumio volumio[1291]: Error adding Membership: Error: addMembership EINVAL Oct 14 10:07:17 adivolumio volumio[1291]: info: Shairport-Sync Started Oct 14 10:07:17 adivolumio volumio[1291]: info: Shairport-Sync Started Oct 14 10:07:17 adivolumio sudo[2276]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart lircd.service Oct 14 10:07:17 adivolumio sudo[2276]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:17 adivolumio systemd[1]: Stopping ir-play-long-handler.service - IR PLAY short and long press handler... Oct 14 10:07:17 adivolumio volumio[1291]: error: [ROTARYENCODER2] dtoverlayAdd failed: Device /dev/input/by-path/platform-button@11-event did not appear after waiting for 5000ms. Oct 14 10:07:17 adivolumio volumio[1291]: info: [ROTARYENCODER2] attachEventEmitter: path: /dev/input/by-path/platform-button@11-event, type: gpio-key Oct 14 10:07:17 adivolumio lircd[1130]: lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:17 adivolumio lircd-0.10.1[1130]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:17 adivolumio lircd[1130]: lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:17 adivolumio lircd-0.10.1[1130]: default_init(): No such file or directory Oct 14 10:07:17 adivolumio lircd[1130]: lircd-0.10.1[1130]: Info: removed client Oct 14 10:07:17 adivolumio lircd-0.10.1[1130]: Info: removed client Oct 14 10:07:17 adivolumio systemd[1]: ir-play-long-handler.service: Deactivated successfully. Oct 14 10:07:17 adivolumio systemd[1]: Stopped ir-play-long-handler.service - IR PLAY short and long press handler. Oct 14 10:07:17 adivolumio systemd[1]: ir-play-long-handler.service: Consumed 1min 12.414s CPU time. Oct 14 10:07:17 adivolumio lircd[1130]: lircd-0.10.1[1130]: Notice: caught signal Oct 14 10:07:17 adivolumio lircd-0.10.1[1130]: Notice: caught signal Oct 14 10:07:17 adivolumio systemd[1]: Stopping lircd.service - Flexible IR remote input/output application support... Oct 14 10:07:17 adivolumio systemd[1]: lircd.service: Deactivated successfully. Oct 14 10:07:17 adivolumio systemd[1]: Stopped lircd.service - Flexible IR remote input/output application support. Oct 14 10:07:17 adivolumio volumio[1291]: info: [ROTARYENCODER2] addEventListeners for rotary: {"pinA":17,"type":"gpio-key"} Oct 14 10:07:17 adivolumio volumio[1291]: info: [ROTARYENCODER2] dtoverlayL Oct 14 10:07:17 adivolumio systemd[1]: Starting lircd-setup.service - lircd(8) initialization helper tool... Oct 14 10:07:17 adivolumio volumio[1291]: info: Asound.conf file unchanged, so no further update is needed Oct 14 10:07:17 adivolumio volumio[1291]: info: Output device has changed, restarting MPD Oct 14 10:07:17 adivolumio sudo[2286]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Oct 14 10:07:17 adivolumio sudo[2286]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:17 adivolumio sudo[2286]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:17 adivolumio sudo[2284]: volumio : PWD=/ ; USER=root ; COMMAND=/usr/bin/dtoverlay -l Oct 14 10:07:17 adivolumio sudo[2284]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:17 adivolumio volumio[1291]: info: Output device has changed, restarting Shairport Sync Oct 14 10:07:17 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Oct 14 10:07:17 adivolumio volumio[1291]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Oct 14 10:07:17 adivolumio sudo[2289]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.service Oct 14 10:07:17 adivolumio sudo[2289]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:17 adivolumio lircd-setup[2282]: /usr/sbin/lircd-setup:37: DeprecationWarning: The SafeConfigParser class has been renamed to ConfigParser in Python 3.2. This alias will be removed in Python 3.12. Use ConfigParser directly instead. Oct 14 10:07:17 adivolumio lircd-setup[2282]: parser = configparser.SafeConfigParser() Oct 14 10:07:17 adivolumio volumio[1291]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Oct 14 10:07:17 adivolumio sudo[2284]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:17 adivolumio systemd[1]: lircd-setup.service: Deactivated successfully. Oct 14 10:07:17 adivolumio systemd[1]: Finished lircd-setup.service - lircd(8) initialization helper tool. Oct 14 10:07:17 adivolumio systemd[1]: Starting lircd.service - Flexible IR remote input/output application support... Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Info: lircd: Opening log, level: Info Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Version: lircd 0.10.1 Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: System info: Linux adivolumio 6.12.74-v7l+ #1948 SMP Mon Mar 2 11:27:49 GMT 2026 armv7l GNU/Linux Oct 14 10:07:17 adivolumio systemd[1]: volumio-autoplay.service: Control process exited, code=killed, status=15/TERM Oct 14 10:07:17 adivolumio systemd[1]: volumio-autoplay.service: Failed with result 'signal'. Oct 14 10:07:17 adivolumio systemd[1]: Stopped volumio-autoplay.service - Restore Volumio playback after boot when audio path and network are ready. Oct 14 10:07:17 adivolumio systemd[1]: Stopping mpd.service - Music Player Daemon... Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Info: Initial device: /dev/lirc0 Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Warning: Cannot access device: /dev/lirc0 Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Info: Initial device: /dev/lirc0 Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Warning: Cannot access device: /dev/lirc0 Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: driver: default Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: output: /var/run/lirc/lircd Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: nodaemon: 1 Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: plugindir: /usr/lib/arm-linux-gnueabihf/lirc/plugins Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: logfile: syslog Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: immediate-init: 0 Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: permission: 666 Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: driver-options: Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: pidfile: /var/run/lirc/lircd.pid Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: listen: 0 Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: connect: (null) Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: userelease: 0 Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: effective_user: (null) Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: release_suffix: _EVUP Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: allow_simulate: 0 Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: repeat_max: 600 Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: configfile: /etc/lirc/lircd.conf Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Options: dynamic_codes: (null) Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Current driver: default Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Driver API version: 3 Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Driver version: 0.10.0 Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Driver info: See file:///usr/share/doc/lirc/plugindocs/default.html Oct 14 10:07:17 adivolumio lircd[2296]: lircd-0.10.1[2296]: Info: lircd: Opening log, level: Info Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Info: lircd: Opening log, level: Info Oct 14 10:07:17 adivolumio lircd[2296]: lircd-0.10.1[2296]: Notice: Using systemd fd Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: Using systemd fd Oct 14 10:07:17 adivolumio lircd[2296]: lircd-0.10.1[2296]: Warning: Running as root Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Warning: Running as root Oct 14 10:07:17 adivolumio lircd[2296]: lircd-0.10.1[2296]: Info: Using remote: iremote. Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Info: Using remote: iremote. Oct 14 10:07:17 adivolumio lircd[2296]: lircd-0.10.1[2296]: Notice: lircd(default) ready, using /var/run/lirc/lircd Oct 14 10:07:17 adivolumio systemd[1]: Started lircd.service - Flexible IR remote input/output application support. Oct 14 10:07:17 adivolumio lircd-0.10.1[2296]: Notice: lircd(default) ready, using /var/run/lirc/lircd Oct 14 10:07:17 adivolumio systemd[1]: Started ir-play-long-handler.service - IR PLAY short and long press handler. Oct 14 10:07:17 adivolumio volumio[1291]: info: CoreCommandRouter::volumioGetState Oct 14 10:07:17 adivolumio volumio[1291]: info: CorePlayQueue::getTrack 0 Oct 14 10:07:17 adivolumio sudo[2276]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:17 adivolumio systemd[1]: mpd.service: Deactivated successfully. Oct 14 10:07:17 adivolumio systemd[1]: Stopped mpd.service - Music Player Daemon. Oct 14 10:07:17 adivolumio systemd[1]: mpd.service: Consumed 1.466s CPU time. Oct 14 10:07:17 adivolumio systemd[1]: mpd.socket: Deactivated successfully. Oct 14 10:07:17 adivolumio systemd[1]: Closed mpd.socket - Music Player Daemon Socket. Oct 14 10:07:17 adivolumio systemd[1]: Stopping mpd.socket - Music Player Daemon Socket... Oct 14 10:07:17 adivolumio systemd[1]: Listening on mpd.socket - Music Player Daemon Socket. Oct 14 10:07:17 adivolumio systemd[1]: Starting mpd.service - Music Player Daemon... Oct 14 10:07:17 adivolumio volumio[1291]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Oct 14 10:07:17 adivolumio volumio[1291]: Error: Unable to resolve or reject the same promise twice Oct 14 10:07:17 adivolumio volumio[1291]: at Promise.resolve (/data/plugins/system_hardware/rotaryencoder2/node_modules/kew/kew.js:140:43) Oct 14 10:07:17 adivolumio volumio[1291]: at /data/plugins/system_hardware/rotaryencoder2/index.js:1021:23 Oct 14 10:07:17 adivolumio volumio[1291]: at FSReqCallback.oncomplete (node:fs:190:23) Oct 14 10:07:17 adivolumio volumio[1291]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Oct 14 10:07:18 adivolumio sudo[2312]: root : PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Oct 14 10:07:18 adivolumio sudo[2312]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=0) Oct 14 10:07:18 adivolumio sudo[2312]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:18 adivolumio lircd[2296]: lircd-0.10.1[2296]: Notice: accepted new client on /var/run/lirc/lircd Oct 14 10:07:18 adivolumio lircd[2296]: lircd-0.10.1[2296]: Info: Cannot configure the rc device for /dev/lirc0 Oct 14 10:07:18 adivolumio lircd[2296]: lircd-0.10.1[2296]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:18 adivolumio lircd[2296]: lircd-0.10.1[2296]: default_init(): No such file or directory Oct 14 10:07:18 adivolumio lircd[2296]: lircd-0.10.1[2296]: Warning: Failed to initialize hardware Oct 14 10:07:18 adivolumio lircd-0.10.1[2296]: Notice: accepted new client on /var/run/lirc/lircd Oct 14 10:07:18 adivolumio lircd-0.10.1[2296]: Info: Cannot configure the rc device for /dev/lirc0 Oct 14 10:07:18 adivolumio lircd-0.10.1[2296]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:18 adivolumio lircd-0.10.1[2296]: default_init(): No such file or directory Oct 14 10:07:18 adivolumio lircd-0.10.1[2296]: Warning: Failed to initialize hardware Oct 14 10:07:19 adivolumio mpd[2319]: 2026-10-14T10:07:19 decoder: Decoder plugin "wildmidi" is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Oct 14 10:07:19 adivolumio systemd[1]: Started mpd.service - Music Player Daemon. Oct 14 10:07:19 adivolumio sudo[2289]: pam_unix(sudo:session): session closed for user root Oct 14 10:07:19 adivolumio systemd[1]: Starting volumio-autoplay.service - Restore Volumio playback after boot when audio path and network are ready... Oct 14 10:07:19 adivolumio lircd-0.10.1[2296]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:19 adivolumio lircd[2296]: lircd-0.10.1[2296]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:19 adivolumio lircd[2296]: lircd-0.10.1[2296]: default_init(): No such file or directory Oct 14 10:07:19 adivolumio lircd-0.10.1[2296]: default_init(): No such file or directory Oct 14 10:07:20 adivolumio lircd[2296]: lircd-0.10.1[2296]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:20 adivolumio lircd[2296]: lircd-0.10.1[2296]: default_init(): No such file or directory Oct 14 10:07:20 adivolumio lircd-0.10.1[2296]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:20 adivolumio lircd-0.10.1[2296]: default_init(): No such file or directory Oct 14 10:07:21 adivolumio sudo[2363]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-10-14 10:06' Oct 14 10:07:21 adivolumio sudo[2363]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Oct 14 10:07:21 adivolumio lircd[2296]: lircd-0.10.1[2296]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:21 adivolumio lircd-0.10.1[2296]: Error: could not get file information for /dev/lirc0 Oct 14 10:07:21 adivolumio lircd[2296]: lircd-0.10.1[2296]: default_init(): No such file or directory Oct 14 10:07:21 adivolumio lircd-0.10.1[2296]: default_init(): No such file or directory PRETTY_NAME="Raspbian GNU/Linux 12 (bookworm)" NAME="Raspbian GNU/Linux" VERSION_ID="12" VERSION="12 (bookworm)" VERSION_CODENAME=bookworm 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="18952480e8d8c63f22208e9007a0f47a9563eae6" VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd" VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2" VOLUMIO_BE_VERSION="0e58f1861fa88e02087981b8d91f7511f0e7011b" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Tue Mar 24 17:20:52 UTC 2026" VOLUMIO_VERSION="4.119" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="d0c2fd9dbc5e70e58c32413c12353563"