Aug 26 14:08:00 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:08:00 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:08:05 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:08:05 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:08:10 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:08:10 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:08:15 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:08:15 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:08:20 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:08:20 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:08:25 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:08:25 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:08:30 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:08:30 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:08:35 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:08:35 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:08:40 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:08:40 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:08:45 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:08:45 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:08:50 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:08:50 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:08:55 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:08:55 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:09:00 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:09:00 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:09:04 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:04.609+02:00 level=INFO msg="check connectivity" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=183.347037ms timeout=10s
Aug 26 14:09:05 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:05.073+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=183.347037ms timeout=10s endpoint=https://radio-directory.firebaseapp.com duration=463.471896ms
Aug 26 14:09:05 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:05.104+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=183.347037ms timeout=10s endpoint=http://pushupdates.volumio.org duration=494.498759ms
Aug 26 14:09:05 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:05.151+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=183.347037ms timeout=10s endpoint=https://browsing-performer.dfs.volumio.org duration=541.526645ms
Aug 26 14:09:05 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:05.154+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=183.347037ms timeout=10s endpoint=https://oauth-performer.dfs.volumio.org duration=544.77879ms
Aug 26 14:09:05 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:05.154+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=183.347037ms timeout=10s endpoint=https://www.googleapis.com duration=544.618607ms
Aug 26 14:09:05 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Aug 26 14:09:05 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Aug 26 14:09:05 volumio volumio[1235]: info: Discovery: Getting this device information
Aug 26 14:09:05 volumio volumio[1235]: info: CoreCommandRouter::volumioGetState
Aug 26 14:09:05 volumio volumio[1235]: info: CorePlayQueue::getTrack 16
Aug 26 14:09:05 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Aug 26 14:09:05 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:05.198+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=183.347037ms timeout=10s endpoint=https://securetoken.googleapis.com duration=588.06367ms
Aug 26 14:09:05 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:05.242+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=183.347037ms timeout=10s endpoint=https://myvolumio.firebaseio.com duration=631.328014ms
Aug 26 14:09:05 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:05.388+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=183.347037ms timeout=10s endpoint=https://functions.volumio.cloud duration=778.902111ms
Aug 26 14:09:05 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:05.389+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=183.347037ms timeout=10s endpoint=https://functions.volumio.cloud duration=778.456619ms
Aug 26 14:09:05 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:09:05 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:09:05 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:05.523+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=183.347037ms timeout=10s endpoint=https://google.com duration=913.622146ms
Aug 26 14:09:05 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:05.566+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=183.347037ms timeout=10s endpoint=http://cddb.volumio.org duration=956.286797ms
Aug 26 14:09:05 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:05.735+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=183.347037ms timeout=10s endpoint=https://database.volumio.cloud duration=1.124737293s
Aug 26 14:09:06 volumio volumio[1235]: verbose: New Socket.io Connection to 192.168.0.16:3000 from 192.168.0.9 UA: Dart/3.12 (dart:io) Engine version: 3 Transport: websocket Total Clients: 5
Aug 26 14:09:06 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard
Aug 26 14:09:06 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard
Aug 26 14:09:06 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:06.763+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=183.347037ms timeout=10s endpoint=http://plugins.volumio.org duration=2.152522235s
Aug 26 14:09:10 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:09:10 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:09:15 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:09:15 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:09:20 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:09:20 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:09:22 volumio volumio[1235]: info: MyVolumio Plan changed: premium
Aug 26 14:09:22 volumio volumio[1235]: info: [MyVolumio PluginManager] Subscribed plan changed to premium
Aug 26 14:09:22 volumio volumio[1235]: info: Removing browser output: myVolumio user plan is not superstar
Aug 26 14:09:22 volumio volumio[1235]: info: Removing audio output:
Aug 26 14:09:22 volumio volumio[1235]: info: MYVOLUMIO: Adding device
Aug 26 14:09:22 volumio volumio[1235]: info: MYVOLUMIO: Evaluating Server
Aug 26 14:09:22 volumio volumio[1235]: info: Remote config written successfully
Aug 26 14:09:22 volumio volumio[1235]: info: Starting Tunnel 1
Aug 26 14:09:22 volumio volumio[1235]: info: Starting Tunnel Connection Checker
Aug 26 14:09:22 volumio volumio[1235]: info: MYVolumio Device disabled
Aug 26 14:09:22 volumio volumio[1235]: info: Setting Geolocation for MyVolumio to eu8
Aug 26 14:09:22 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Aug 26 14:09:22 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Aug 26 14:09:22 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Aug 26 14:09:23 volumio volumio[1235]: error: Failed to add MyVolumio device: {"message":"USER_NOT_FOUND"}
Aug 26 14:09:23 volumio volumio[1235]: info: Updating MyVolumio device info
Aug 26 14:09:23 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Aug 26 14:09:23 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Aug 26 14:09:23 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Aug 26 14:09:24 volumio volumio[1235]: error: Failed to update MyVolumio device: {"message":"DEVICE_NOT_FOUND"}
Aug 26 14:09:25 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:09:25 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:09:27 volumio sudo[19418]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart sshtunnel.service
Aug 26 14:09:27 volumio sudo[19418]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Aug 26 14:09:27 volumio systemd[1]: /lib/systemd/system/sshtunnel.service:6: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether.
Aug 26 14:09:27 volumio systemd[1]: /lib/systemd/system/sshtunnel.service:7: Standard output type syslog is obsolete, automatically updating to journal. Please update your unit file, and consider removing the setting altogether.
Aug 26 14:09:27 volumio systemd[1]: Started sshtunnel.service - MyVolumio SSH Tunnel.
Aug 26 14:09:27 volumio sudo[19418]: pam_unix(sudo:session): session closed for user root
Aug 26 14:09:27 volumio volumio[1235]: info: Remote SSH Started
Aug 26 14:09:27 volumio autossh[19423]: port set to 0, monitoring disabled
Aug 26 14:09:27 volumio autossh[19423]: starting ssh (count 1)
Aug 26 14:09:27 volumio autossh[19423]: ssh child pid is 19427
Aug 26 14:09:27 volumio volumio[1235]: info: MYVOLUMIO: Adding device
Aug 26 14:09:27 volumio volumio[1235]: info: MYVOLUMIO: Evaluating Server
Aug 26 14:09:27 volumio volumio[1235]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 5
Aug 26 14:09:27 volumio volumio[1235]: info: CoreCommandRouter::volumioGetState
Aug 26 14:09:27 volumio volumio[1235]: info: CorePlayQueue::getTrack 16
Aug 26 14:09:27 volumio volumiossh-tunnel[19427]: Warning: Permanently added '[eu8.myvolumio.org]:2222' (RSA) to the list of known hosts.
Aug 26 14:09:28 volumio volumio[1235]: info: Setting Geolocation for MyVolumio to eu8
Aug 26 14:09:28 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Aug 26 14:09:28 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Aug 26 14:09:28 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Aug 26 14:09:28 volumio volumio[1235]: info: MYVolumio Device enabled
Aug 26 14:09:28 volumio volumio[1235]: info: [MyVolumio PluginManager] Device activated, enabling myvolumio plugins...
Aug 26 14:09:28 volumio volumio[1235]: info: MyVolumio status changed
Aug 26 14:09:28 volumio volumio[1235]: info: Streaming services startup
Aug 26 14:09:28 volumio volumio[1235]: info: Starting Streaming Daemon
Aug 26 14:09:28 volumio volumio[1235]: error: [MyVolumio PluginManager] Could not read cache file: ENOENT: no such file or directory, open '/data/myvolumio/cache.data'
Aug 26 14:09:28 volumio sudo[19449]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service
Aug 26 14:09:28 volumio sudo[19449]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Aug 26 14:09:28 volumio sudo[19449]: pam_unix(sudo:session): session closed for user root
Aug 26 14:09:28 volumio volumio[1235]: error: Cannot start Volumio Streaming Daemon
Aug 26 14:09:28 volumio volumio[1235]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service
Aug 26 14:09:28 volumio volumio[1235]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found.
Aug 26 14:09:28 volumio volumio[1235]: info: Successfully Added MyVolumio device
Aug 26 14:09:29 volumio volumio[1235]: info: Updating MyVolumio device info
Aug 26 14:09:29 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Aug 26 14:09:29 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Aug 26 14:09:29 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Aug 26 14:09:29 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:29.505+02:00 level=INFO msg="check connectivity" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=177.648317ms timeout=10s
Aug 26 14:09:29 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:29.566+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=177.648317ms timeout=10s endpoint=https://radio-directory.firebaseapp.com duration=58.969411ms
Aug 26 14:09:29 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:29.574+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=177.648317ms timeout=10s endpoint=https://browsing-performer.dfs.volumio.org duration=67.737085ms
Aug 26 14:09:29 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:29.588+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=177.648317ms timeout=10s endpoint=https://oauth-performer.dfs.volumio.org duration=81.580705ms
Aug 26 14:09:29 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:29.594+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=177.648317ms timeout=10s endpoint=http://pushupdates.volumio.org duration=86.708649ms
Aug 26 14:09:29 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:29.661+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=177.648317ms timeout=10s endpoint=https://www.googleapis.com duration=155.402847ms
Aug 26 14:09:29 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getSystemInfo
Aug 26 14:09:29 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: volumiodiscovery , getThisDevice
Aug 26 14:09:29 volumio volumio[1235]: info: Discovery: Getting this device information
Aug 26 14:09:29 volumio volumio[1235]: info: CoreCommandRouter::volumioGetState
Aug 26 14:09:29 volumio volumio[1235]: info: CorePlayQueue::getTrack 16
Aug 26 14:09:29 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: network , getCachedIPAddresses
Aug 26 14:09:29 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:29.705+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=177.648317ms timeout=10s endpoint=https://myvolumio.firebaseio.com duration=199.194108ms
Aug 26 14:09:29 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:29.706+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=177.648317ms timeout=10s endpoint=https://securetoken.googleapis.com duration=199.575026ms
Aug 26 14:09:29 volumio volumio[1235]: verbose: New Socket.io Connection to 192.168.0.16:3000 from 192.168.0.9 UA: Dart/3.12 (dart:io) Engine version: 3 Transport: websocket Total Clients: 6
Aug 26 14:09:29 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: wizard , getShowWizard
Aug 26 14:09:29 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: system , getShowWizard
Aug 26 14:09:29 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:29.802+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=177.648317ms timeout=10s endpoint=https://functions.volumio.cloud duration=295.694764ms
Aug 26 14:09:29 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:29.808+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=177.648317ms timeout=10s endpoint=https://functions.volumio.cloud duration=302.148758ms
Aug 26 14:09:29 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:29.819+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=177.648317ms timeout=10s endpoint=https://database.volumio.cloud duration=312.005672ms
Aug 26 14:09:29 volumio volumio[1235]: info: Successfully Updated MyVolumio device
Aug 26 14:09:29 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:29.900+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=177.648317ms timeout=10s endpoint=https://google.com duration=393.906315ms
Aug 26 14:09:30 volumio volumio5-onboarding[1957]: time=2026-08-26T14:09:30.167+02:00 level=INFO msg="endpoint is reachable" component=server type=REQUEST_TYPE_CHECK_INTERNET_CONNECTIVITY peer="192.168.0.9:47770 @ 0x1c018f0" latency=177.648317ms timeout=10s endpoint=http://plugins.volumio.org duration=660.011876ms
Aug 26 14:09:30 volumio volumio[1235]: info: [MyVolumio PluginManager] Loading plugin "bluetooth"...
Aug 26 14:09:30 volumio volumio[1235]: ------------------------------------ BT MESSAGE: [FUNC] onVolumioStart
Aug 26 14:09:30 volumio volumio[1235]: info: [MyVolumio PluginManager] Loading plugin "multiroom"...
Aug 26 14:09:31 volumio sudo[19455]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/rm -rf /tmp/multiroom
Aug 26 14:09:31 volumio sudo[19455]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Aug 26 14:09:31 volumio sudo[19455]: pam_unix(sudo:session): session closed for user root
Aug 26 14:09:31 volumio volumio[1235]: info: MRS: MultiRoom plugin initialized
Aug 26 14:09:31 volumio volumio[1235]: info: MRS: STOPPING SNAPCLIENT
Aug 26 14:09:31 volumio volumio[1235]: info: MRS: Snap server stop
Aug 26 14:09:31 volumio sudo[19474]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioSnapclient
Aug 26 14:09:31 volumio sudo[19474]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Aug 26 14:09:31 volumio volumio[1235]: info: MRS: STOPPING volumioStreaming
Aug 26 14:09:31 volumio sudo[19477]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioSnapserver
Aug 26 14:09:31 volumio sudo[19477]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Aug 26 14:09:31 volumio sudo[19480]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop volumioStreaming
Aug 26 14:09:31 volumio sudo[19480]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Aug 26 14:09:31 volumio volumio[1235]: info: [MyVolumio PluginManager] Loading plugin "metavolumio"...
Aug 26 14:09:31 volumio sudo[19483]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/rm -f /tmp/hls/*
Aug 26 14:09:31 volumio sudo[19483]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Aug 26 14:09:31 volumio sudo[19483]: pam_unix(sudo:session): session closed for user root
Aug 26 14:09:31 volumio sudo[19474]: pam_unix(sudo:session): session closed for user root
Aug 26 14:09:31 volumio volumio[1235]: info: [MyVolumio PluginManager] Loading plugin "manifestui"...
Aug 26 14:09:31 volumio volumio[1235]: info: [MyVolumio PluginManager] Loading plugin "cd_controller"...
Aug 26 14:09:31 volumio volumio[1235]: info: [MyVolumio PluginManager] Loading plugin "smart_inputs"...
Aug 26 14:09:31 volumio sudo[19477]: pam_unix(sudo:session): session closed for user root
Aug 26 14:09:31 volumio volumio[1235]: info: [MyVolumio PluginManager] Loading plugin "hi_res_audio"...
Aug 26 14:09:31 volumio sudo[19480]: pam_unix(sudo:session): session closed for user root
Aug 26 14:09:31 volumio volumio[1235]: info: [MyVolumio PluginManager] Loading plugin "tidal"...
Aug 26 14:09:31 volumio volumio[1235]: info: [MyVolumio PluginManager] Loading plugin "qobuz"...
Aug 26 14:09:31 volumio volumio[1235]: info: [MyVolumio PluginManager] Loading plugin "tidalconnect"...
Aug 26 14:09:31 volumio volumio[1235]: info: [MyVolumio PluginManager] Loading plugin "qobuzconnect"...
Aug 26 14:09:31 volumio volumio[1235]: info: Preparing to generate the ALSA configuration file
Aug 26 14:09:31 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:09:31 volumio volumio[1235]: info: Discovery: Restarting Browsing
Aug 26 14:09:31 volumio volumio[1235]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getHwuuid
Aug 26 14:09:31 volumio volumio[1235]: info: The plugin alsa_controller has an ALSA contribution file softvolume.postVolume.conf
Aug 26 14:09:31 volumio volumio[1235]: info: Reading ALSA contributions from plugins.
Aug 26 14:09:31 volumio volumio[1235]: info: MRS: Removed streaming files
Aug 26 14:09:31 volumio volumio[1235]: info: MRS: volumioStreaming STOPPED
Aug 26 14:09:31 volumio volumio[1235]: info: MRS: SNAPSERVER STOPPED
Aug 26 14:09:31 volumio volumio[1235]: info: MRS: SNAPCLIENT STOPPED
Aug 26 14:09:31 volumio dbus-daemon[785]: [system] The maximum number of active connections for UID 1000 has been reached (max_connections_per_user=256)
Aug 26 14:09:31 volumio volumio[1235]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Aug 26 14:09:31 volumio volumio[1235]: DBusError: The maximum number of active connections for UID 1000 has been reached
Aug 26 14:09:31 volumio volumio[1235]: at _methodReturnHandlers. (/myvolumio/plugins/audio_interface/bluetooth/node_modules/dbus-next/lib/bus.js:343:27)
Aug 26 14:09:31 volumio volumio[1235]: at handleMessage (/myvolumio/plugins/audio_interface/bluetooth/node_modules/dbus-next/lib/bus.js:101:11)
Aug 26 14:09:31 volumio volumio[1235]: at EventEmitter. (/myvolumio/plugins/audio_interface/bluetooth/node_modules/dbus-next/lib/bus.js:151:9)
Aug 26 14:09:31 volumio volumio[1235]: at EventEmitter.emit (node:events:514:28)
Aug 26 14:09:31 volumio volumio[1235]: at /myvolumio/plugins/audio_interface/bluetooth/node_modules/dbus-next/lib/connection.js:132:14
Aug 26 14:09:31 volumio volumio[1235]: at Socket. (/myvolumio/plugins/audio_interface/bluetooth/node_modules/dbus-next/lib/message.js:65:9)
Aug 26 14:09:31 volumio volumio[1235]: at Socket.emit (node:events:514:28)
Aug 26 14:09:31 volumio volumio[1235]: at emitReadable_ (node:internal/streams/readable:609:12)
Aug 26 14:09:31 volumio volumio[1235]: at process.processTicksAndRejections (node:internal/process/task_queues:81:21) {
Aug 26 14:09:31 volumio volumio[1235]: type: 'org.freedesktop.DBus.Error.LimitsExceeded',
Aug 26 14:09:31 volumio volumio[1235]: text: 'The maximum number of active connections for UID 1000 has been reached',
Aug 26 14:09:31 volumio volumio[1235]: reply: Message {
Aug 26 14:09:31 volumio volumio[1235]: type: 3,
Aug 26 14:09:31 volumio volumio[1235]: _sent: false,
Aug 26 14:09:31 volumio volumio[1235]: _serial: 1,
Aug 26 14:09:31 volumio volumio[1235]: path: undefined,
Aug 26 14:09:31 volumio volumio[1235]: interface: undefined,
Aug 26 14:09:31 volumio volumio[1235]: member: undefined,
Aug 26 14:09:31 volumio volumio[1235]: errorName: 'org.freedesktop.DBus.Error.LimitsExceeded',
Aug 26 14:09:31 volumio volumio[1235]: replySerial: 1,
Aug 26 14:09:31 volumio volumio[1235]: destination: ':not.active.yet',
Aug 26 14:09:31 volumio volumio[1235]: sender: 'org.freedesktop.DBus',
Aug 26 14:09:31 volumio volumio[1235]: signature: 's',
Aug 26 14:09:31 volumio volumio[1235]: body: [
Aug 26 14:09:31 volumio volumio[1235]: 'The maximum number of active connections for UID 1000 has been reached'
Aug 26 14:09:31 volumio volumio[1235]: ],
Aug 26 14:09:31 volumio volumio[1235]: flags: 1
Aug 26 14:09:31 volumio volumio[1235]: }
Aug 26 14:09:31 volumio volumio[1235]: }
Aug 26 14:09:31 volumio volumio[1235]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Aug 26 14:09:32 volumio sudo[19504]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-08-26 14:08'
Aug 26 14:09:32 volumio sudo[19504]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
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"