-- Logs begin at Thu 2019-02-14 10:11:58 UTC, end at Fri 2026-01-09 23:08:38 UTC. -- Jan 09 23:07:58 ifi-zen-stream ntpd[1157]: receive: Unexpected origin timestamp 0xecc2a3b8.4a0c089a does not match aorg 0000000000.00000000 from server@23.186.168.126 xmt 0xed0c08ce.d7a4e778 Jan 09 23:07:58 ifi-zen-stream ntpd[1157]: receive: Unexpected origin timestamp 0xecc2a3b8.49fecdd9 does not match aorg 0000000000.00000000 from server@23.186.168.129 xmt 0xed0c08ce.d7de319c Jan 09 23:07:58 ifi-zen-stream ntpd[1157]: receive: Unexpected origin timestamp 0xecc2a3b8.4a06b2a3 does not match aorg 0000000000.00000000 from server@23.186.168.128 xmt 0xed0c08ce.d8781638 Jan 09 23:07:58 ifi-zen-stream systemd[1]: Starting Daily apt download activities... Jan 09 23:07:59 ifi-zen-stream networkaudiod[1384]: [/usr/sbin/networkaudiod] (1384): listen discovery on 0.0.0.0 Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: Loading plugin "qobuz_connect"... Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: [1768000079278] Starting Qobuz Connect Service Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: Loading plugin "alarm-clock"... Jan 09 23:07:59 ifi-zen-stream kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc03df72000 drv_status 0x0 e_type 69 e_states 8 Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: Loading plugin "last_100"... Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: Loading plugin "roon_ready"... Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: Starting RoonReady Sync Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: Loading plugin "webradio"... Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: Loading plugin "i2s_dacs"... Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: I2S DAC not set, start Auto-detection Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: Loading plugin "volumiodiscovery"... Jan 09 23:07:59 ifi-zen-stream volumio[1179]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Jan 09 23:07:59 ifi-zen-stream volumio[1179]: *** WARNING *** Please fix your application to use the native API of Avahi! Jan 09 23:07:59 ifi-zen-stream volumio[1179]: *** WARNING *** For more information see Jan 09 23:07:59 ifi-zen-stream volumio[1179]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Jan 09 23:07:59 ifi-zen-stream volumio[1179]: *** WARNING *** Please fix your application to use the native API of Avahi! Jan 09 23:07:59 ifi-zen-stream node[1179]: *** WARNING *** The program 'node' uses the Apple Bonjour compatibility layer of Avahi. Jan 09 23:07:59 ifi-zen-stream volumio[1179]: *** WARNING *** For more information see Jan 09 23:07:59 ifi-zen-stream node[1179]: *** WARNING *** Please fix your application to use the native API of Avahi! Jan 09 23:07:59 ifi-zen-stream node[1179]: *** WARNING *** For more information see Jan 09 23:07:59 ifi-zen-stream node[1179]: *** WARNING *** The program 'node' called 'DNSServiceRegister()' which is not supported (or only supported partially) in the Apple Bonjour compatibility layer of Avahi. Jan 09 23:07:59 ifi-zen-stream node[1179]: *** WARNING *** Please fix your application to use the native API of Avahi! Jan 09 23:07:59 ifi-zen-stream node[1179]: *** WARNING *** For more information see Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: Applying required configuration parameters for plugin volumiodiscovery Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , registerCallback Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: Plugin spotify_connect is not enabled Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: Loading plugin "airplay1_switch"... Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: Plugin airplay2_switch is not enabled Jan 09 23:07:59 ifi-zen-stream volumio[1179]: info: Loading plugin "airplay_emulation"... Jan 09 23:07:59 ifi-zen-stream systemd[1]: apt-daily.service: Succeeded. Jan 09 23:07:59 ifi-zen-stream systemd[1]: Started Daily apt download activities. Jan 09 23:08:00 ifi-zen-stream systemd[1]: Starting Daily apt upgrade and clean activities... Jan 09 23:08:00 ifi-zen-stream kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc03df72000 drv_status 0x0 e_type 69 e_states 8 Jan 09 23:08:00 ifi-zen-stream volumio[1179]: info: Starting Shairport Sync Jan 09 23:08:00 ifi-zen-stream volumio[1179]: info: Loading plugin "outputs"... Jan 09 23:08:00 ifi-zen-stream volumio[1179]: info: Loading plugin "albumart"... Jan 09 23:08:00 ifi-zen-stream volumio[1179]: info: Plugin example_plugin is not enabled Jan 09 23:08:00 ifi-zen-stream volumio[1179]: info: Loading plugin "inputs"... Jan 09 23:08:00 ifi-zen-stream volumio[1179]: info: Loading plugin "updater_comm"... Jan 09 23:08:00 ifi-zen-stream kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc03df72000 drv_status 0x0 e_type 69 e_states 8 Jan 09 23:08:00 ifi-zen-stream volumio[1179]: info: Plugin mpdemulation is not enabled Jan 09 23:08:00 ifi-zen-stream volumio[1179]: info: Loading plugin "rest_api"... Jan 09 23:08:00 ifi-zen-stream volumio[1179]: info: Loading plugin "websocket"... Jan 09 23:08:00 ifi-zen-stream volumio[1179]: info: Starting Socket.io Server version 2.3.0 Jan 09 23:08:00 ifi-zen-stream volumio[1179]: info: Plugin ifi-cdplayer is not enabled Jan 09 23:08:00 ifi-zen-stream volumio[1179]: info: Loading i18n strings for locale en Jan 09 23:08:00 ifi-zen-stream volumio[1179]: Updating browse sources language Jan 09 23:08:00 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Jan 09 23:08:00 ifi-zen-stream kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc03df72000 drv_status 0x0 e_type 69 e_states 8 Jan 09 23:08:00 ifi-zen-stream volumio[1179]: Forking 3 albumart workers Jan 09 23:08:00 ifi-zen-stream kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc03df72000 drv_status 0x0 e_type 69 e_states 8 Jan 09 23:08:01 ifi-zen-stream systemd[1]: apt-daily-upgrade.service: Succeeded. Jan 09 23:08:01 ifi-zen-stream systemd[1]: Started Daily apt upgrade and clean activities. Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::initPlayerControls Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getAlsaCards Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jan 09 23:08:01 ifi-zen-stream volumio[1179]: Express server listening on port 3000 Jan 09 23:08:01 ifi-zen-stream volumio[1179]: [Metrics] WebUI: 8s 855.92ms Jan 09 23:08:01 ifi-zen-stream kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc03df72000 drv_status 0x0 e_type 69 e_states 8 Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreStateMachine::resetVolumioState Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreStateMachine::getcurrentVolume Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioRetrievevolume Jan 09 23:08:01 ifi-zen-stream volumio[1179]: Meta server listening Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , saveCurrentVolume Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreStateMachine::pushState Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CorePlayQueue::getTrack 0 Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioPushState Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: Server listening on port 6599 Jan 09 23:08:01 ifi-zen-stream kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc03df72000 drv_status 0x0 e_type 69 e_states 8 Jan 09 23:08:01 ifi-zen-stream volumio[1179]: error: Cannot read config.txt file: Error: ENOENT: no such file or directory, open '/boot/config.txt' Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: Completed loading Core Plugins Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: Preparing to generate the ALSA configuration file Jan 09 23:08:01 ifi-zen-stream sudo[1541]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start ifi-streamer-qobuz-connect.service Jan 09 23:08:01 ifi-zen-stream sudo[1541]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: Cannot read play queue from file Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: ConvSwitch: Connected to server Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: MetaClient: Connected to server Jan 09 23:08:01 ifi-zen-stream node[483]: ConvSwitch: Add client volumio Jan 09 23:08:01 ifi-zen-stream systemd[1]: Started iFi Streamer Qobuz Connect Service. Jan 09 23:08:01 ifi-zen-stream sudo[1541]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: Volumio Network Manager: Network status updated: 2 Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: NAA Service Started Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: Cannot read proc/cpuinfo: Error: Command failed: cat /proc/cpuinfo | grep Revision Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: ConvSwitch: Get message: success Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: MetaClient: Get message: success Jan 09 23:08:01 ifi-zen-stream volumio[1179]: info: Qobuz Connect Service Started Jan 09 23:08:02 ifi-zen-stream volumio[1179]: MPD error: Connection refused Jan 09 23:08:02 ifi-zen-stream kernel: CFG80211-ERROR) wl_escan_handler : escan is not ready ndev ffffffc03df72000 drv_status 0x0 e_type 69 e_states 0 Jan 09 23:08:02 ifi-zen-stream ethernet-detect[495]: Updating avahi-daemon configuration: allow-interfaces=wlan0 Jan 09 23:08:02 ifi-zen-stream sudo[1321]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: Asound.conf file unchanged, so no further update is needed Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: Output device has changed, restarting MPD Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1263]: Files changed, reloading. Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1263]: Files changed, reloading. Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.331 [1599.1599] DEBUG SampleApp: Starting sample application Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.332 [1599.1599] DEBUG SampleApp: Device Name: ZEN Stream Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.332 [1599.1599] DEBUG SampleApp: Manufacturer: Sample manufacturer Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.332 [1599.1599] DEBUG SampleApp: Model: iFi Streamer Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.332 [1599.1599] DEBUG SampleApp: Serial Number: ifi:42:7d:78:f9:67:97 Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.332 [1599.1599] DEBUG SampleApp: Audio output device: volumio Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.332 [1599.1599] DEBUG SampleApp: Volume control device: default Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.332 [1599.1599] DEBUG SampleApp: Volume control element: Master Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.332 [1599.1599] DEBUG SampleApp: Local config server port: 8000 Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: Qobuz connect: Output device has changed Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: Roon Ready: Output device has changed Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.350 [1599.1599] ERROR SampleApp: Unable to find ALSA mixer element 'Master' on index 0 Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.352 [1599.1599] DEBUG SampleApp: Maximum supported audio quality: HIRES_L3 Jan 09 23:08:02 ifi-zen-stream play[1544]: [Info] MetaClient: MetaClient SDK -- v1.02 Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: ___________ START PLUGINS ___________ Jan 09 23:08:02 ifi-zen-stream node[468]: A new connection has been established. Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1263]: Got SIGTERM, quitting. Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1263]: Leaving mDNS multicast group on interface wlan0.IPv4 with address 192.168.86.249. Jan 09 23:08:02 ifi-zen-stream nmbd[615]: [2026/01/09 23:08:02.377387, 0] ../source3/libsmb/nmblib.c:917(send_udp) Jan 09 23:08:02 ifi-zen-stream systemd[1]: Stopping Avahi mDNS/DNS-SD Stack... Jan 09 23:08:02 ifi-zen-stream nmbd[615]: Packet send failed to 169.254.255.255(138) ERRNO=Invalid argument Jan 09 23:08:02 ifi-zen-stream nmbd[615]: [2026/01/09 23:08:02.378167, 0] ../source3/libsmb/nmblib.c:917(send_udp) Jan 09 23:08:02 ifi-zen-stream nmbd[615]: Packet send failed to 127.0.0.1(137) ERRNO=Invalid argument Jan 09 23:08:02 ifi-zen-stream nmbd[615]: [2026/01/09 23:08:02.378520, 0] ../source3/nmbd/nmbd_packets.c:180(send_netbios_packet) Jan 09 23:08:02 ifi-zen-stream nmbd[615]: send_netbios_packet: send_packet() to IP 127.0.0.1 port 137 failed Jan 09 23:08:02 ifi-zen-stream nmbd[615]: [2026/01/09 23:08:02.378743, 0] ../source3/libsmb/nmblib.c:917(send_udp) Jan 09 23:08:02 ifi-zen-stream nmbd[615]: Packet send failed to 127.0.0.1(137) ERRNO=Invalid argument Jan 09 23:08:02 ifi-zen-stream nmbd[615]: [2026/01/09 23:08:02.378941, 0] ../source3/nmbd/nmbd_packets.c:180(send_netbios_packet) Jan 09 23:08:02 ifi-zen-stream nmbd[615]: send_netbios_packet: send_packet() to IP 127.0.0.1 port 137 failed Jan 09 23:08:02 ifi-zen-stream nmbd[615]: [2026/01/09 23:08:02.379103, 0] ../source3/libsmb/nmblib.c:917(send_udp) Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1263]: avahi-daemon 0.7 exiting. Jan 09 23:08:02 ifi-zen-stream play[1544]: [Info] MetaClient: MetaClientInit Jan 09 23:08:02 ifi-zen-stream play[1544]: [Info] ConvSwitch: ConvSwitch SDK -- v1.03 Jan 09 23:08:02 ifi-zen-stream systemd[1]: avahi-daemon.service: Succeeded. Jan 09 23:08:02 ifi-zen-stream nmbd[615]: Packet send failed to 127.0.0.1(137) ERRNO=Invalid argument Jan 09 23:08:02 ifi-zen-stream systemd[1]: Stopped Avahi mDNS/DNS-SD Stack. Jan 09 23:08:02 ifi-zen-stream nmbd[615]: [2026/01/09 23:08:02.389475, 0] ../source3/nmbd/nmbd_packets.c:180(send_netbios_packet) Jan 09 23:08:02 ifi-zen-stream nmbd[615]: send_netbios_packet: send_packet() to IP 127.0.0.1 port 137 failed Jan 09 23:08:02 ifi-zen-stream nmbd[615]: [2026/01/09 23:08:02.389824, 0] ../source3/libsmb/nmblib.c:917(send_udp) Jan 09 23:08:02 ifi-zen-stream nmbd[615]: Packet send failed to 127.0.0.1(137) ERRNO=Invalid argument Jan 09 23:08:02 ifi-zen-stream nmbd[615]: [2026/01/09 23:08:02.390007, 0] ../source3/nmbd/nmbd_packets.c:180(send_netbios_packet) Jan 09 23:08:02 ifi-zen-stream node[483]: ConvSwitch: Add client qobuz-connect Jan 09 23:08:02 ifi-zen-stream nmbd[615]: send_netbios_packet: send_packet() to IP 127.0.0.1 port 137 failed Jan 09 23:08:02 ifi-zen-stream nmbd[615]: [2026/01/09 23:08:02.390175, 0] ../source3/libsmb/nmblib.c:917(send_udp) Jan 09 23:08:02 ifi-zen-stream nmbd[615]: Packet send failed to 127.0.0.1(137) ERRNO=Invalid argument Jan 09 23:08:02 ifi-zen-stream nmbd[615]: [2026/01/09 23:08:02.390507, 0] ../source3/nmbd/nmbd_packets.c:180(send_netbios_packet) Jan 09 23:08:02 ifi-zen-stream nmbd[615]: send_netbios_packet: send_packet() to IP 127.0.0.1 port 137 failed Jan 09 23:08:02 ifi-zen-stream dbus-daemon[511]: [system] Activating via systemd: service name='org.freedesktop.Avahi' unit='dbus-org.freedesktop.Avahi.service' requested by ':1.13' (uid=0 pid=1089 comm="/usr/sbin/smbd --foreground --no-process-group ") Jan 09 23:08:02 ifi-zen-stream sudo[1604]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Jan 09 23:08:02 ifi-zen-stream sudo[1604]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:02 ifi-zen-stream systemd[1]: Starting Avahi mDNS/DNS-SD Stack... Jan 09 23:08:02 ifi-zen-stream play[1544]: [Info] ConvSwitch: ConvSwitchInit Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: ControllerMpd::onStart: Initializing MPD Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: Creating MPD Configuration file Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.488 [1599.1599] DEBUG ActiveStateManager: [0xab380f40]: Creating new Active State Manager Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.488 [1599.1599] DEBUG NetworkActivityTracker: [0xab380fb0]: Creating new Network Activity Tracker Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1608]: Process 1263 died: No such process; trying to remove PID file. (/run/avahi-daemon//pid) Jan 09 23:08:02 ifi-zen-stream sudo[1604]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1608]: Found user 'avahi' (UID 111) and group 'avahi' (GID 113). Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1608]: Successfully dropped root privileges. Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1608]: avahi-daemon 0.7 starting up. Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.497 [1599.1599] DEBUG EndpointManager: [0xab381f28]: Creating Endpoint Manager Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.497 [1599.1599] DEBUG PlaybackSessionManager: [0xab382318]: Creating Playback Session Manager Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.497 [1599.1599] DEBUG BackoffTimer: [0xab382490]: Creating Backoff Timer Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.497 [1599.1599] DEBUG MediaEngine: [0xab3825b0]: Creating new Media Engine Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.497 [1599.1599] DEBUG AudioRenderer: [0xab3827d0]: Creating Audio Renderer Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] TRACE MediaEngineCommandSequencer: [0xab382928]: Creating Media Engine Command Sequencer Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] DEBUG PlaybackControlsManager: [0xab382988]: Creating new Playback Controls Manager Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] DEBUG VolumeManager: [0xab382a18]: Creating new Volume Manager Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] DEBUG ProtocolHandler: [0xab382cf0]: Creating Protocol Handler Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] DEBUG MessageReceiver: [0xab382d90]: Creating Message Receiver Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] DEBUG RendererActivationController: [0xab382f08]: Creating new Renderer Activation Controller Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] TRACE RendererActivationCommandSequencer: [0xab382fb0]: Creating Renderer Activation Command Sequencer Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] DEBUG ReportingManager: [0xab3830c0]: Creating new Reporting Manager Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] DEBUG StreamingEventReporter: [0xab383108]: Creating Streaming Event Reporter Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] DEBUG BackoffTimer: [0xab3831e8]: Creating Backoff Timer Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] DEBUG TokenExpiryController: [0xab3832f8]: Creating Token Expiry Controller Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] DEBUG UserInactivityManager: [0xab383348]: Creating new User Inactivity Manager Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] INFO VolumeManager: [0xab382a18]: Setting new playback volume: 100 Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] INFO VolumeManager: [0xab382a18]: Setting new mute state: 1 Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] DEBUG SampleApp: Qobuz Connect has been initialized Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] TRACE SampleApp: Running event loop Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] INFO QobuzConnect: [0xab3833e8]: Client initialized! Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.498 [1599.1599] INFO SampleApp: Starting Avahi advertising, name: ZEN Stream, service name: _qobuz-connect._tcp Jan 09 23:08:02 ifi-zen-stream dbus-daemon[511]: [system] Successfully activated service 'org.freedesktop.Avahi' Jan 09 23:08:02 ifi-zen-stream systemd[1]: Started Avahi mDNS/DNS-SD Stack. Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: mpd , getConfigParam Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1608]: Successfully called chroot(). Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1608]: Successfully dropped remaining capabilities. Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1608]: Loading service file /services/volumio.service. Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1608]: Joining mDNS multicast group on interface wlan0.IPv4 with address 192.168.86.249. Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1608]: New relevant interface wlan0.IPv4 for mDNS. Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1608]: Network interface enumeration completed. Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1608]: Registering new address record for 192.168.86.249 on wlan0.IPv4. Jan 09 23:08:02 ifi-zen-stream avahi-daemon[1608]: Registering HINFO record with values 'AARCH64'/'LINUX'. Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: [1768000082556] CoreMusicLibrary::Adding element Media Servers Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.582 [1599.1599] DEBUG SampleApp: Avahi client state changed: REGISTERING Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.583 [1599.1599] INFO LocalConfigManager: [0xab3822f8]: Starting Local Configuration server Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.583 [1599.1599] INFO SampleApp: Starting Local configuration server Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.584 [1599.1599] INFO SampleApp: Playback mute state changed: 1 Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.584 [1599.1599] ERROR SampleApp: Unable to set mute state, no ALSA volume element Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.585 [1599.1599] INFO SampleApp: Playback volume changed: 100 Jan 09 23:08:02 ifi-zen-stream play[1544]: 20260109 23:08:02.585 [1599.1599] ERROR SampleApp: Unable to set volume, no ALSA volume element Jan 09 23:08:02 ifi-zen-stream sudo[1612]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chmod 777 /etc/mpd.conf Jan 09 23:08:02 ifi-zen-stream sudo[1612]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:02 ifi-zen-stream sudo[1615]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop mpd.socket mpd.service Jan 09 23:08:02 ifi-zen-stream sudo[1615]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:02 ifi-zen-stream sudo[1612]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: [1768000082669] CoreMusicLibrary::Adding element Last_100 Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: Starting RoonReady Sync Jan 09 23:08:02 ifi-zen-stream volumio[1179]: Starting albumart workers Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioAddToBrowseSources[object Object] Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: [1768000082708] CoreMusicLibrary::Adding element Webradio Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: Initializing BBC Radios Jan 09 23:08:02 ifi-zen-stream volumio[1179]: Starting albumart workers Jan 09 23:08:02 ifi-zen-stream sudo[1621]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart ifi-streamer-roon-ready.service Jan 09 23:08:02 ifi-zen-stream sudo[1621]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:02 ifi-zen-stream sudo[1615]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:02 ifi-zen-stream systemd[1]: Started iFi Streamer Roon Ready Service. Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Jan 09 23:08:02 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 09 23:08:02 ifi-zen-stream systemd[1]: Starting Internet Detect for iFi Streamer... Jan 09 23:08:02 ifi-zen-stream sudo[1621]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 09 23:08:03 ifi-zen-stream play[1631]: /usr/ifi/ifi-roonready-release/play: line 18: warning: command substitution: ignored null byte in input Jan 09 23:08:03 ifi-zen-stream volumio[1179]: Starting albumart workers Jan 09 23:08:03 ifi-zen-stream sudo[1638]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/ln -snf /usr/local/bin/airplay1 /usr/local/bin/shairport-sync Jan 09 23:08:03 ifi-zen-stream sudo[1638]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 09 23:08:03 ifi-zen-stream sudo[1638]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: Could not detect Primo: Error: Command failed: aplay -l | grep es90x8q2m-dac-dai-0 Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: Volumio Calling Home Jan 09 23:08:03 ifi-zen-stream systemd[1]: ifi-system-internet.service: Succeeded. Jan 09 23:08:03 ifi-zen-stream systemd[1]: Started Internet Detect for iFi Streamer. Jan 09 23:08:03 ifi-zen-stream avahi-daemon[1608]: Server startup complete. Host name is ifi-zen-stream.local. Local service cookie is 826029876. Jan 09 23:08:03 ifi-zen-stream play[1544]: 20260109 23:08:03.532 [1599.1599] DEBUG SampleApp: Avahi client state changed: RUNNING Jan 09 23:08:03 ifi-zen-stream play[1544]: 20260109 23:08:03.541 [1599.1599] DEBUG SampleApp: Avahi entry group state changed: UNCOMMITED Jan 09 23:08:03 ifi-zen-stream play[1544]: 20260109 23:08:03.555 [1599.1599] DEBUG SampleApp: Avahi entry group state changed: REGISTERING Jan 09 23:08:03 ifi-zen-stream node[483]: ConvSwitch: Add client roon-ready Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setRepeat undefined single undefined Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CoreStateMachine::pushState Jan 09 23:08:03 ifi-zen-stream node[468]: avahi-daemon had restarted Jan 09 23:08:03 ifi-zen-stream node[468]: avahi-daemon service has restarted Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CorePlayQueue::getTrack 0 Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioPushState Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setRandom undefined Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CoreStateMachine::pushState Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CorePlayQueue::getTrack 0 Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioPushState Jan 09 23:08:03 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 09 23:08:03 ifi-zen-stream node[468]: checkSystemServiceSync error: Command failed: systemctl is-active ifi-streamer-tidal-connect.service Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: Starting RoonReady Sync Jan 09 23:08:04 ifi-zen-stream sudo[1708]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop ifi-streamer-qobuz-connect.service Jan 09 23:08:04 ifi-zen-stream sudo[1708]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: ConvSwitch: Get message: request:pause Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioStop Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreStateMachine::stop Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioStop Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreStateMachine::stop Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:04 ifi-zen-stream systemd[1]: Stopping iFi Streamer Qobuz Connect Service... Jan 09 23:08:04 ifi-zen-stream sudo[1715]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart ifi-streamer-roon-ready.service Jan 09 23:08:04 ifi-zen-stream systemd[1]: ifi-streamer-qobuz-connect.service: Main process exited, code=killed, status=15/TERM Jan 09 23:08:04 ifi-zen-stream systemd[1]: ifi-streamer-qobuz-connect.service: Succeeded. Jan 09 23:08:04 ifi-zen-stream sudo[1715]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:04 ifi-zen-stream systemd[1]: Stopped iFi Streamer Qobuz Connect Service. Jan 09 23:08:04 ifi-zen-stream node[483]: ConvSwitch: Drop client qobuz-connect Jan 09 23:08:04 ifi-zen-stream node[468]: Closing connection with the client qobuz-connect Jan 09 23:08:04 ifi-zen-stream sudo[1708]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: Airplay1 Started Jan 09 23:08:04 ifi-zen-stream volumio[1179]: error: Could not retrieve plugin music_service airplay2_switch Jan 09 23:08:04 ifi-zen-stream node[483]: ConvSwitch: Drop client roon-ready Jan 09 23:08:04 ifi-zen-stream systemd[1]: Stopping iFi Streamer Roon Ready Service... Jan 09 23:08:04 ifi-zen-stream systemd[1]: ifi-streamer-roon-ready.service: Main process exited, code=killed, status=15/TERM Jan 09 23:08:04 ifi-zen-stream systemd[1]: ifi-streamer-roon-ready.service: Succeeded. Jan 09 23:08:04 ifi-zen-stream systemd[1]: Stopped iFi Streamer Roon Ready Service. Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: Disabling plugin airplay2_switch Jan 09 23:08:04 ifi-zen-stream systemd[1]: Started iFi Streamer Roon Ready Service. Jan 09 23:08:04 ifi-zen-stream sudo[1715]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: Done. Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: RoonReady Started Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: MPD Permissions set Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: MPD Permissions set Jan 09 23:08:04 ifi-zen-stream sudo[1731]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop shairport-sync Jan 09 23:08:04 ifi-zen-stream sudo[1731]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:04 ifi-zen-stream play[1730]: /usr/ifi/ifi-roonready-release/play: line 18: warning: command substitution: ignored null byte in input Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: Discovery: adding f6ec9d28-da1f-4e71-a8dd-6cf8d3de49cb Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: Discovery: Found device ZEN Stream Jan 09 23:08:04 ifi-zen-stream avahi-daemon[1608]: Service "ZEN Stream" (/services/volumio.service) successfully established. Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioGetState Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CorePlayQueue::getTrack 0 Jan 09 23:08:04 ifi-zen-stream sudo[1737]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.socket mpd.service Jan 09 23:08:04 ifi-zen-stream volumio[1179]: error: Could not retrieve plugin audio_interface multiroom Jan 09 23:08:04 ifi-zen-stream sudo[1737]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:04 ifi-zen-stream sudo[1731]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:04 ifi-zen-stream sudo[1743]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop mpd.socket mpd.service Jan 09 23:08:04 ifi-zen-stream sudo[1743]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:04 ifi-zen-stream systemd[1]: Listening on mpd.socket. Jan 09 23:08:04 ifi-zen-stream systemd[1]: Starting Music Player Daemon... Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: RoonReady Started Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: Volumio called home Jan 09 23:08:04 ifi-zen-stream sudo[1737]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:04 ifi-zen-stream systemd[1]: mpd.service: Control process exited, code=killed, status=15/TERM Jan 09 23:08:04 ifi-zen-stream systemd[1]: mpd.service: Succeeded. Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: Jan 09 23:08:04 ifi-zen-stream volumio[1179]: ---------------------------- Client requests Start RoonReady PlaybackRoutine Jan 09 23:08:04 ifi-zen-stream systemd[1]: Stopped Music Player Daemon. Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: roon_ready , startRoonReadyPlayback Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: Roon Ready playback start Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioStop Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreStateMachine::stop Jan 09 23:08:04 ifi-zen-stream systemd[1]: mpd.socket: Succeeded. Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: Starting Roon Ready metadata receiver Jan 09 23:08:04 ifi-zen-stream systemd[1]: Closed mpd.socket. Jan 09 23:08:04 ifi-zen-stream volumio[1179]: Error adding Membership: Error: addMembership EINVAL Jan 09 23:08:04 ifi-zen-stream volumio[1179]: error: Discovery: Advertisement error: Error: dns service error: unknown Jan 09 23:08:04 ifi-zen-stream volumio[1179]: error: Discovery: advertisement error: Error: dns service error: unknown Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: Discovery: Advertisement raised the following error Error: dns service error: unknown Jan 09 23:08:04 ifi-zen-stream sudo[1743]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:04 ifi-zen-stream node[483]: ConvSwitch: Add client roon-ready Jan 09 23:08:04 ifi-zen-stream volumio[1179]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 1 Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: Shairport-Sync Stopped Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getCPUCoresNumber Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:04 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getCPUCoresNumber Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: Discovery: Browse raised the following error Error: dns service error: unknown Jan 09 23:08:05 ifi-zen-stream volumio[1179]: error: Cannot start MPD on system Start: Error: Command failed: /usr/bin/sudo /bin/systemctl restart mpd.socket mpd.service Jan 09 23:08:05 ifi-zen-stream volumio[1179]: Job for mpd.service canceled. Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: Completed starting Core Plugins Jan 09 23:08:05 ifi-zen-stream volumio[1179]: [Metrics] CommandRouter: 11s 721.89ms Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::Close All Modals sent Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumiosetStartupVolume Jan 09 23:08:05 ifi-zen-stream sudo[1794]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart mpd.socket mpd.service Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:05 ifi-zen-stream sudo[1794]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: warning: volume is underfined, set volume to 100 Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: VolumeController::SetAlsaVolume100 Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 09 23:08:05 ifi-zen-stream systemd[1]: Listening on mpd.socket. Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , saveCurrentVolume Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreStateMachine::pushState Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CorePlayQueue::getTrack 0 Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioPushState Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 09 23:08:05 ifi-zen-stream kernel: wm8804 0-003b: wm8804_hw_params rate: 0xac44 format: 0x2 Jan 09 23:08:05 ifi-zen-stream systemd[1]: Starting Music Player Daemon... Jan 09 23:08:05 ifi-zen-stream volumio[1179]: error: MPD error: Error: connect ECONNREFUSED /run/mpd/socket Jan 09 23:08:05 ifi-zen-stream volumio[1179]: error: connect ECONNREFUSED /run/mpd/socket {"errno":-111,"code":"ECONNREFUSED","syscall":"connect","address":"/run/mpd/socket"} Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: ConvSwitch: Get message: request:pause Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioStop Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreStateMachine::stop Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioStop Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreStateMachine::stop Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:05 ifi-zen-stream sudo[1798]: root : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/chown mpd:audio /var/log/mpd.log Jan 09 23:08:05 ifi-zen-stream sudo[1798]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:05 ifi-zen-stream sudo[1798]: /bin/chown: cannot access '/var/log/mpd.log': No such file or directory Jan 09 23:08:05 ifi-zen-stream sudo[1798]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: Starting Shairport Sync Jan 09 23:08:05 ifi-zen-stream sudo[1802]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl start ifi-streamer-qobuz-connect.service Jan 09 23:08:05 ifi-zen-stream sudo[1802]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: Starting Shairport Sync Jan 09 23:08:05 ifi-zen-stream sudo[1805]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Jan 09 23:08:05 ifi-zen-stream systemd[1]: Started iFi Streamer Qobuz Connect Service. Jan 09 23:08:05 ifi-zen-stream sudo[1805]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:05 ifi-zen-stream sudo[1802]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: Jan 09 23:08:05 ifi-zen-stream volumio[1179]: ---------------------------- Client requests Start RoonReady PlaybackRoutine Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: roon_ready , startRoonReadyPlayback Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: Roon Ready playback start Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: Roon Ready metadata receiver is on Jan 09 23:08:05 ifi-zen-stream sudo[1808]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart shairport-sync Jan 09 23:08:05 ifi-zen-stream sudo[1808]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:05 ifi-zen-stream systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Jan 09 23:08:05 ifi-zen-stream sudo[1805]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:05 ifi-zen-stream systemd[1]: Stopping Shairport Sync - AirPlay Audio Receiver... Jan 09 23:08:05 ifi-zen-stream systemd[1]: shairport-sync.service: Main process exited, code=killed, status=15/TERM Jan 09 23:08:05 ifi-zen-stream systemd[1]: shairport-sync.service: Succeeded. Jan 09 23:08:05 ifi-zen-stream systemd[1]: Stopped Shairport Sync - AirPlay Audio Receiver. Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: ++++--++++ getState Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioGetState Jan 09 23:08:05 ifi-zen-stream volumio[1179]: info: CorePlayQueue::getTrack 0 Jan 09 23:08:05 ifi-zen-stream systemd[1]: Started Shairport Sync - AirPlay Audio Receiver. Jan 09 23:08:05 ifi-zen-stream sudo[1808]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:06 ifi-zen-stream volumio[1179]: info: Shairport-Sync Started Jan 09 23:08:06 ifi-zen-stream volumio[1179]: Error adding Membership: Error: addMembership EINVAL Jan 09 23:08:06 ifi-zen-stream volumio[1179]: info: Shairport-Sync Started Jan 09 23:08:06 ifi-zen-stream volumio[1179]: info: Qobuz Connect Service Started Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.145 [1838.1838] DEBUG SampleApp: Starting sample application Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.146 [1838.1838] DEBUG SampleApp: Device Name: ZEN Stream Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.146 [1838.1838] DEBUG SampleApp: Manufacturer: Sample manufacturer Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.146 [1838.1838] DEBUG SampleApp: Model: iFi Streamer Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.146 [1838.1838] DEBUG SampleApp: Serial Number: ifi:42:7d:78:f9:67:97 Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.146 [1838.1838] DEBUG SampleApp: Audio output device: volumio Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.146 [1838.1838] DEBUG SampleApp: Volume control device: default Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.146 [1838.1838] DEBUG SampleApp: Volume control element: Master Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.146 [1838.1838] DEBUG SampleApp: Local config server port: 8000 Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.153 [1838.1838] ERROR SampleApp: Unable to find ALSA mixer element 'Master' on index 0 Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.153 [1838.1838] DEBUG SampleApp: Maximum supported audio quality: HIRES_L3 Jan 09 23:08:06 ifi-zen-stream play[1807]: [Info] MetaClient: MetaClient SDK -- v1.02 Jan 09 23:08:06 ifi-zen-stream node[468]: A new connection has been established. Jan 09 23:08:06 ifi-zen-stream play[1807]: [Info] MetaClient: MetaClientInit Jan 09 23:08:06 ifi-zen-stream play[1807]: [Info] ConvSwitch: ConvSwitch SDK -- v1.03 Jan 09 23:08:06 ifi-zen-stream node[483]: ConvSwitch: Add client qobuz-connect Jan 09 23:08:06 ifi-zen-stream play[1807]: [Info] ConvSwitch: ConvSwitchInit Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.261 [1838.1838] DEBUG ActiveStateManager: [0xab655f40]: Creating new Active State Manager Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.263 [1838.1838] DEBUG NetworkActivityTracker: [0xab655fb0]: Creating new Network Activity Tracker Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.264 [1838.1838] DEBUG EndpointManager: [0xab656f28]: Creating Endpoint Manager Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.264 [1838.1838] DEBUG PlaybackSessionManager: [0xab657318]: Creating Playback Session Manager Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.264 [1838.1838] DEBUG BackoffTimer: [0xab657490]: Creating Backoff Timer Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.264 [1838.1838] DEBUG MediaEngine: [0xab6575b0]: Creating new Media Engine Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.273 [1838.1838] DEBUG AudioRenderer: [0xab6577d0]: Creating Audio Renderer Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.273 [1838.1838] TRACE MediaEngineCommandSequencer: [0xab657928]: Creating Media Engine Command Sequencer Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.273 [1838.1838] DEBUG PlaybackControlsManager: [0xab657988]: Creating new Playback Controls Manager Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.273 [1838.1838] DEBUG VolumeManager: [0xab657a18]: Creating new Volume Manager Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.273 [1838.1838] DEBUG ProtocolHandler: [0xab657cf0]: Creating Protocol Handler Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.273 [1838.1838] DEBUG MessageReceiver: [0xab657d90]: Creating Message Receiver Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.273 [1838.1838] DEBUG RendererActivationController: [0xab657f08]: Creating new Renderer Activation Controller Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.273 [1838.1838] TRACE RendererActivationCommandSequencer: [0xab657fb0]: Creating Renderer Activation Command Sequencer Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.273 [1838.1838] DEBUG ReportingManager: [0xab6580c0]: Creating new Reporting Manager Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.273 [1838.1838] DEBUG StreamingEventReporter: [0xab658108]: Creating Streaming Event Reporter Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.273 [1838.1838] DEBUG BackoffTimer: [0xab6581e8]: Creating Backoff Timer Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.274 [1838.1838] DEBUG TokenExpiryController: [0xab6582f8]: Creating Token Expiry Controller Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.274 [1838.1838] DEBUG UserInactivityManager: [0xab658348]: Creating new User Inactivity Manager Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.281 [1838.1838] INFO VolumeManager: [0xab657a18]: Setting new playback volume: 100 Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.281 [1838.1838] INFO VolumeManager: [0xab657a18]: Setting new mute state: 1 Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.281 [1838.1838] DEBUG SampleApp: Qobuz Connect has been initialized Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.281 [1838.1838] TRACE SampleApp: Running event loop Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.281 [1838.1838] INFO QobuzConnect: [0xab6583e8]: Client initialized! Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.281 [1838.1838] INFO SampleApp: Starting Avahi advertising, name: ZEN Stream, service name: _qobuz-connect._tcp Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.296 [1838.1838] DEBUG SampleApp: Avahi client state changed: RUNNING Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.300 [1838.1838] DEBUG SampleApp: Avahi entry group state changed: UNCOMMITED Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.314 [1838.1838] INFO LocalConfigManager: [0xab6572f8]: Starting Local Configuration server Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.314 [1838.1838] INFO SampleApp: Starting Local configuration server Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.315 [1838.1838] INFO SampleApp: Playback mute state changed: 1 Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.315 [1838.1838] ERROR SampleApp: Unable to set mute state, no ALSA volume element Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.315 [1838.1838] DEBUG SampleApp: Avahi entry group state changed: REGISTERING Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.316 [1838.1838] INFO SampleApp: Playback volume changed: 100 Jan 09 23:08:06 ifi-zen-stream play[1807]: 20260109 23:08:06.316 [1838.1838] ERROR SampleApp: Unable to set volume, no ALSA volume element Jan 09 23:08:06 ifi-zen-stream node[483]: ConvSwitch: Drop client roon-ready Jan 09 23:08:06 ifi-zen-stream systemd[1]: ifi-streamer-roon-ready.service: Main process exited, code=exited, status=1/FAILURE Jan 09 23:08:06 ifi-zen-stream systemd[1]: ifi-streamer-roon-ready.service: Failed with result 'exit-code'. Jan 09 23:08:06 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkAudioDeviceAvailable Jan 09 23:08:06 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus Jan 09 23:08:06 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , versionChangeDetect Jan 09 23:08:07 ifi-zen-stream play[1807]: 20260109 23:08:07.281 [1838.1838] DEBUG SampleApp: Avahi entry group state changed: ESTABLISHED Jan 09 23:08:07 ifi-zen-stream systemd[1]: ifi-streamer-roon-ready.service: Service RestartSec=1s expired, scheduling restart. Jan 09 23:08:07 ifi-zen-stream systemd[1]: ifi-streamer-roon-ready.service: Scheduled restart job, restart counter is at 1. Jan 09 23:08:07 ifi-zen-stream systemd[1]: Stopped iFi Streamer Roon Ready Service. Jan 09 23:08:07 ifi-zen-stream systemd[1]: Started iFi Streamer Roon Ready Service. Jan 09 23:08:07 ifi-zen-stream play[1868]: /usr/ifi/ifi-roonready-release/play: line 18: warning: command substitution: ignored null byte in input Jan 09 23:08:07 ifi-zen-stream node[483]: ConvSwitch: Add client roon-ready Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: ConvSwitch: Get message: request:pause Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioStop Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreStateMachine::stop Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreStateMachine::serviceStop Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::serviceStop Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioStop Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreStateMachine::stop Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: Roon Ready Stop Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioStop Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreStateMachine::stop Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: Jan 09 23:08:07 ifi-zen-stream volumio[1179]: ---------------------------- Client requests Start RoonReady PlaybackRoutine Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: roon_ready , startRoonReadyPlayback Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: Roon Ready playback start Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioStop Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreStateMachine::stop Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:07 ifi-zen-stream volumio[1179]: info: Roon Ready metadata receiver is on Jan 09 23:08:08 ifi-zen-stream sudo[1905]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Jan 09 23:08:08 ifi-zen-stream sudo[1905]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:08 ifi-zen-stream sudo[1905]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:08 ifi-zen-stream sudo[1907]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Jan 09 23:08:08 ifi-zen-stream sudo[1907]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:08 ifi-zen-stream sudo[1907]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:08 ifi-zen-stream sudo[1911]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart upmpdcli.service Jan 09 23:08:08 ifi-zen-stream sudo[1911]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:08 ifi-zen-stream systemd[1]: Starting Internet Detect for iFi Streamer... Jan 09 23:08:08 ifi-zen-stream systemd[1]: Starting UPnP Renderer front-end to MPD... Jan 09 23:08:08 ifi-zen-stream systemd[1]: ifi-system-internet.service: Succeeded. Jan 09 23:08:08 ifi-zen-stream systemd[1]: Started Internet Detect for iFi Streamer. Jan 09 23:08:09 ifi-zen-stream mpd[1800]: Jan 09 23:08 : decoder: Decoder plugin 'wildmidi' is unavailable: configuration file does not exist: /etc/timidity/timidity.cfg Jan 09 23:08:09 ifi-zen-stream node[483]: ConvSwitch: Drop client roon-ready Jan 09 23:08:09 ifi-zen-stream systemd[1]: ifi-streamer-roon-ready.service: Main process exited, code=exited, status=1/FAILURE Jan 09 23:08:09 ifi-zen-stream systemd[1]: ifi-streamer-roon-ready.service: Failed with result 'exit-code'. Jan 09 23:08:09 ifi-zen-stream systemd[1]: Started Music Player Daemon. Jan 09 23:08:09 ifi-zen-stream sudo[1794]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:09 ifi-zen-stream volumio[1179]: info: Restarted MPD. Jan 09 23:08:09 ifi-zen-stream volumio[1179]: error: updateQueue error: null Jan 09 23:08:09 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioStop Jan 09 23:08:09 ifi-zen-stream volumio[1179]: info: CoreStateMachine::stop Jan 09 23:08:09 ifi-zen-stream volumio[1179]: info: CoreStateMachine::serviceStop Jan 09 23:08:09 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::serviceStop Jan 09 23:08:09 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioStop Jan 09 23:08:09 ifi-zen-stream volumio[1179]: info: CoreStateMachine::stop Jan 09 23:08:09 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:09 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:09 ifi-zen-stream volumio[1179]: info: Roon Ready Stop Jan 09 23:08:10 ifi-zen-stream systemd[1]: ifi-streamer-roon-ready.service: Service RestartSec=1s expired, scheduling restart. Jan 09 23:08:10 ifi-zen-stream systemd[1]: ifi-streamer-roon-ready.service: Scheduled restart job, restart counter is at 2. Jan 09 23:08:10 ifi-zen-stream systemd[1]: Stopped iFi Streamer Roon Ready Service. Jan 09 23:08:10 ifi-zen-stream systemd[1]: Started iFi Streamer Roon Ready Service. Jan 09 23:08:10 ifi-zen-stream play[1960]: /usr/ifi/ifi-roonready-release/play: line 18: warning: command substitution: ignored null byte in input Jan 09 23:08:10 ifi-zen-stream node[483]: ConvSwitch: Add client roon-ready Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: ConvSwitch: Get message: request:pause Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioStop Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: CoreStateMachine::stop Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioStop Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: CoreStateMachine::stop Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: Jan 09 23:08:10 ifi-zen-stream volumio[1179]: ---------------------------- Client requests Start RoonReady PlaybackRoutine Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: roon_ready , startRoonReadyPlayback Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: Roon Ready playback start Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioStop Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: CoreStateMachine::stop Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: CoreStateMachine::setConsumeUpdateService undefined Jan 09 23:08:10 ifi-zen-stream volumio[1179]: info: Roon Ready metadata receiver is on Jan 09 23:08:12 ifi-zen-stream node[468]: A new connection has been established. Jan 09 23:08:12 ifi-zen-stream volumio[1179]: info: BOOT COMPLETED Jan 09 23:08:12 ifi-zen-stream sudo[2009]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Jan 09 23:08:12 ifi-zen-stream sudo[2009]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:12 ifi-zen-stream sudo[2015]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Jan 09 23:08:12 ifi-zen-stream sudo[2015]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:12 ifi-zen-stream sudo[2015]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:12 ifi-zen-stream sudo[2009]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:12 ifi-zen-stream volumio[1179]: verbose: New Socket.io Connection to 192.168.86.249 from 192.168.86.33 UA: Mozilla/5.0 (Macintosh; Intel Mac OS X 10_15_7) AppleWebKit/605.1.15 (KHTML, like Gecko) Engine version: 3 Transport: polling Total Clients: 2 Jan 09 23:08:13 ifi-zen-stream systemd[1]: Started UPnP Renderer front-end to MPD. Jan 09 23:08:13 ifi-zen-stream sudo[1911]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:13 ifi-zen-stream volumio[1179]: info: Upmpdcli Daemon Started Jan 09 23:08:13 ifi-zen-stream systemd[1]: Starting Internet Detect for iFi Streamer... Jan 09 23:08:13 ifi-zen-stream volumio[1179]: New connection from ::ffff:127.0.0.1:55540 Jan 09 23:08:13 ifi-zen-stream volumio[1179]: Connected to MPD server Jan 09 23:08:13 ifi-zen-stream volumio[1179]: New connection from ::ffff:127.0.0.1:55544 Jan 09 23:08:13 ifi-zen-stream volumio[1179]: Connected to MPD server Jan 09 23:08:13 ifi-zen-stream systemd[1]: ifi-system-internet.service: Succeeded. Jan 09 23:08:13 ifi-zen-stream systemd[1]: Started Internet Detect for iFi Streamer. Jan 09 23:08:13 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::servicePushState Jan 09 23:08:13 ifi-zen-stream volumio[1179]: info: CoreStateMachine::pushState Jan 09 23:08:13 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 09 23:08:13 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioPushState Jan 09 23:08:13 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , saveDeviceInfo Jan 09 23:08:13 ifi-zen-stream volumio[2037]: unable to load Private Key Jan 09 23:08:13 ifi-zen-stream volumio[2037]: 4146749456:error:0909006C:PEM routines:get_name:no start line:../crypto/pem/pem_lib.c:745:Expecting: ANY PRIVATE KEY Jan 09 23:08:13 ifi-zen-stream sudo[2083]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig eth0 Jan 09 23:08:13 ifi-zen-stream sudo[2083]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:13 ifi-zen-stream sudo[2083]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:13 ifi-zen-stream sudo[2085]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/sbin/ifconfig wlan0 Jan 09 23:08:13 ifi-zen-stream sudo[2085]: pam_unix(sudo:session): session opened for user root by (uid=0) Jan 09 23:08:13 ifi-zen-stream sudo[2085]: pam_unix(sudo:session): session closed for user root Jan 09 23:08:14 ifi-zen-stream volumio[1179]: verbose: New Socket.io Connection to 192.168.86.249 from 192.168.86.33 UA: Mozilla/5.0 (Macintosh; Intel Mac OS X 10_15_7) AppleWebKit/605.1.15 (KHTML, like Gecko) Engine version: 3 Transport: polling Total Clients: 3 Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: ++++--++++ getState Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioGetState Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: ++++--++++ getMultiRoomDevices: null Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: ++++--++++ getMultiroom: null Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: multiroom , getMultiroom Jan 09 23:08:14 ifi-zen-stream volumio[1179]: error: Could not retrieve plugin audio_interface multiroom Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: ++++--++++ getAudioOutputs: null Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: ++++--++++ getBrowseSources: null Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioGetVisibleSources Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: my_music , getDisabledSources Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: ++++--++++ getMenuItems Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: ++++--++++ listPlaylist: null Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: Listing playlists Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: ++++--++++ getUiSettings Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: appearance , getUiSettings Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: ++++--++++ getWizard Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: ++++--++++ getPrivacySettings Jan 09 23:08:14 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Jan 09 23:08:15 ifi-zen-stream volumio[1179]: info: ++++--++++ getMenuItems Jan 09 23:08:30 ifi-zen-stream volumiologrotate[474]: ls: cannot access '/var/log/samba/log.wb-ZEN': No such file or directory Jan 09 23:08:30 ifi-zen-stream volumiologrotate[474]: ls: cannot access 'STREAM': No such file or directory Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: ++++--++++ getPrivacySettings Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: ++++--++++ callMethod: {"type":"plugin","endpoint":"system_controller/my_volumio","method":"retreiveBackendEventStates"} Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: CALLMETHOD: system_controller my_volumio retreiveBackendEventStates undefined Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: my_volumio , retreiveBackendEventStates Jan 09 23:08:32 ifi-zen-stream volumio[1179]: error: Could not retrieve plugin system_controller my_volumio Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: ++++--++++ getSystemVersion Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: Received Get System Version Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: ++++--++++ getSystemInfo Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: Received Get System Info Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: Discovery: Getting this device information Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioGetState Jan 09 23:08:32 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses Jan 09 23:08:33 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion Jan 09 23:08:33 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam Jan 09 23:08:33 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled Jan 09 23:08:33 ifi-zen-stream volumio[1179]: error: Could not retrieve plugin system_controller my_volumio Jan 09 23:08:33 ifi-zen-stream volumio[1179]: info: ++++--++++ browseLibrary: {"uri":"music-library"} Jan 09 23:08:33 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Jan 09 23:08:33 ifi-zen-stream volumio[1179]: info: CURURI: music-library Jan 09 23:08:33 ifi-zen-stream volumio[1179]: info: ++++--++++ getQueue Jan 09 23:08:33 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::volumioGetQueue Jan 09 23:08:33 ifi-zen-stream volumio[1179]: info: CoreStateMachine::getQueue Jan 09 23:08:33 ifi-zen-stream volumio[1179]: info: CorePlayQueue::getQueue Jan 09 23:08:33 ifi-zen-stream volumio[1179]: info: Preload queue cleared Jan 09 23:08:36 ifi-zen-stream volumio[1179]: info: ++++--++++ browseLibrary: {"uri":"artists://"} Jan 09 23:08:36 ifi-zen-stream volumio[1179]: info: CoreCommandRouter::executeOnPlugin: mpd , handleBrowseUri Jan 09 23:08:36 ifi-zen-stream volumio[1179]: info: CURURI: artists:// Jan 09 23:08:36 ifi-zen-stream volumio[1179]: info: Preload queue cleared Jan 09 23:08:37 ifi-zen-stream volumio[1179]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jan 09 23:08:37 ifi-zen-stream volumio[1179]: TypeError: Cannot read property 'slice' of null Jan 09 23:08:37 ifi-zen-stream volumio[1179]: at download (/volumio/app/plugins/miscellanea/albumart/albumart.js:718:41) Jan 09 23:08:37 ifi-zen-stream volumio[1179]: at ClientRequest. (/volumio/app/plugins/miscellanea/albumart/albumart.js:728:7) Jan 09 23:08:37 ifi-zen-stream volumio[1179]: at Object.onceWrapper (events.js:520:26) Jan 09 23:08:37 ifi-zen-stream volumio[1179]: at ClientRequest.emit (events.js:400:28) Jan 09 23:08:37 ifi-zen-stream volumio[1179]: at HTTPParser.parserOnIncomingClient [as onIncoming] (_http_client.js:647:27) Jan 09 23:08:37 ifi-zen-stream volumio[1179]: at HTTPParser.parserOnHeadersComplete (_http_common.js:127:17) Jan 09 23:08:37 ifi-zen-stream volumio[1179]: at TLSSocket.socketOnData (_http_client.js:515:22) Jan 09 23:08:37 ifi-zen-stream volumio[1179]: at TLSSocket.emit (events.js:400:28) Jan 09 23:08:37 ifi-zen-stream volumio[1179]: at addChunk (internal/streams/readable.js:293:12) Jan 09 23:08:37 ifi-zen-stream volumio[1179]: at readableAddChunk (internal/streams/readable.js:267:9) Jan 09 23:08:37 ifi-zen-stream volumio[1179]: at TLSSocket.Readable.push (internal/streams/readable.js:206:10) Jan 09 23:08:37 ifi-zen-stream volumio[1179]: at TLSWrap.onStreamRead (internal/stream_base_commons.js:188:23) Jan 09 23:08:37 ifi-zen-stream volumio[1179]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Jan 09 23:08:38 ifi-zen-stream sudo[2335]: volumio : TTY=unknown ; PWD=/ ; USER=root ; COMMAND=/bin/journalctl --since=2026-01-09 23:07 Jan 09 23:08:38 ifi-zen-stream sudo[2335]: pam_unix(sudo:session): session opened for user root by (uid=0) PRETTY_NAME="Debian GNU/Linux 10 (buster)" NAME="Debian GNU/Linux" VERSION_ID="10" VERSION="10 (buster)" VERSION_CODENAME=buster ID=debian HOME_URL="https://www.debian.org/" SUPPORT_URL="https://www.debian.org/support" BUG_REPORT_URL="https://bugs.debian.org/" VOLUMIO_BUILD_VERSION="45aad196ab181636cec04ab79f52572f8ba3c549" VOLUMIO_FE_VERSION="8a7c1663e5becc06293ef92fd46324fc2cb9ce6e" VOLUMIO_FE3_VERSION="c5cad6acce062070373bc18affd0d2a1a9956a16" VOLUMIO_BE_VERSION="0fad662d4c47d7729fc677cd069fd5e675bebf9c" VOLUMIO_ARCH="armv7" VOLUMIO_VARIANT="ifi" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Sat Nov 15 15:05:02 CST 2025" VOLUMIO_VERSION="3.00.6" VOLUMIO_HARDWARE="zen-stream" VOLUMIO_DEVICENAME="ZEN Stream" VOLUMIO_HASH="3350ed41a04d50b70f39bebb8e49f746"