Feb 12 07:36:00 volumio go-librespot[2181]: time="2026-02-12T07:36:00-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gue1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:36:00 volumio go-librespot[2181]: time="2026-02-12T07:36:00-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:36:00 volumio go-librespot[2181]: time="2026-02-12T07:36:00-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:36:00 volumio go-librespot[2181]: time="2026-02-12T07:36:00-06:00" level=info msg="zeroconf server listening on port 35045"
Feb 12 07:36:00 volumio go-librespot[2181]: time="2026-02-12T07:36:00-06:00" level=debug msg="obtained new client token: AABZFUNtaKnm3bQKNRt9F4bKk7LRMAQvHEmQHiocGnfsUuCnZyAdnxMtX/vcpq6H/ZNt7HKTWPmYeFqrWVuljGY+i+bvE0IBCWY/YY4bDJ2nRSD6TS+UoJHfLV6woNaBziu8kXCbZLlQIcnBnyZkgwjdL+LXpb/PjJ8lI1r7xdevSE+vwykL+g8j8QzDN5iP/Dk2yGb4AJL4MifSQ/g380IVgSfc496ZCZN9X9XaXbCByFUvXz4zM1M="
Feb 12 07:36:00 volumio go-librespot[2181]: time="2026-02-12T07:36:00-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:36:00 volumio go-librespot[2181]: time="2026-02-12T07:36:00-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:00 volumio go-librespot[2181]: time="2026-02-12T07:36:00-06:00" level=debug msg="completed challenge"
Feb 12 07:36:00 volumio go-librespot[2181]: time="2026-02-12T07:36:00-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:00 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:00 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:01 volumio volumio[1690]: info: [MyVolumio PluginManager] MyVolumio plugin successfully loaded
Feb 12 07:36:01 volumio volumio[1690]: info: [MyVolumio PluginManager] Starting plugin system_controller.my_volumio
Feb 12 07:36:01 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:01 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:01 volumio volumio[1690]: info: Starting MyVolumio Remote Streaming Endpoints
Feb 12 07:36:01 volumio volumio[1690]: info: MyVolumio login type: Token
Feb 12 07:36:01 volumio volumio[1690]: info: [MyVolumio PluginManager] MyVolumio plugin successfully started
Feb 12 07:36:01 volumio volumio[1690]: info: [MyVolumio PluginManager] Loading plugin "streaming_services"...
Feb 12 07:36:02 volumio volumio[1690]: info: [MyVolumio PluginManager] Streaming Services plugin successfully loaded
Feb 12 07:36:02 volumio volumio[1690]: info: [MyVolumio PluginManager] Starting plugin music_service.streaming_services
Feb 12 07:36:02 volumio volumio[1690]: info: Streaming services startup
Feb 12 07:36:02 volumio volumio[1690]: info: Starting Streaming Daemon
Feb 12 07:36:02 volumio sudo[2190]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service
Feb 12 07:36:02 volumio sudo[2190]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Feb 12 07:36:02 volumio volumio[1690]: info: [MyVolumio PluginManager] Streaming Services plugin successfully started
Feb 12 07:36:02 volumio sudo[2190]: pam_unix(sudo:session): session closed for user root
Feb 12 07:36:02 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:02 volumio volumio[1690]: error: Cannot start Volumio Streaming Daemon
Feb 12 07:36:02 volumio volumio[1690]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service
Feb 12 07:36:02 volumio volumio[1690]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found.
Feb 12 07:36:02 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:02 volumio volumio[1690]: info: MYVOLUMIO SUCCESSFULLY LOGGED IN
Feb 12 07:36:03 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 215.
Feb 12 07:36:03 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:03 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:03 volumio go-librespot[2197]: go-librespot daemon starting...
Feb 12 07:36:03 volumio go-librespot[2198]: time="2026-02-12T07:36:03-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:03 volumio go-librespot[2198]: time="2026-02-12T07:36:03-06:00" level=debug msg="app state loaded"
Feb 12 07:36:03 volumio go-librespot[2198]: time="2026-02-12T07:36:03-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:03 volumio go-librespot[2198]: time="2026-02-12T07:36:03-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:03 volumio go-librespot[2198]: time="2026-02-12T07:36:03-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gue1.spotify.com:443 ap-gew1.spotify.com:80]"
Feb 12 07:36:03 volumio go-librespot[2198]: time="2026-02-12T07:36:03-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew1-dealer.spotify.com:443]"
Feb 12 07:36:03 volumio go-librespot[2198]: time="2026-02-12T07:36:03-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew1-spclient.spotify.com:443]"
Feb 12 07:36:03 volumio go-librespot[2198]: time="2026-02-12T07:36:03-06:00" level=info msg="zeroconf server listening on port 34231"
Feb 12 07:36:03 volumio kernel: hwmon hwmon1: Voltage normalised
Feb 12 07:36:03 volumio go-librespot[2198]: time="2026-02-12T07:36:03-06:00" level=debug msg="obtained new client token: AACONHegwQnlDxI1Z9hq0JrB0mk+6HmT8lUCmdZYqR1btEd638JLQgfIg/Z66BqylwMmktKHEwCrjfvtDTcCHb7hIwir657zsR0oZnj2r5AJAWWWCS0o6bn+Ixyx5vr7dfEZIPPK4X7OhobpmxtLQUjnU8DfLOcXQ9X406wLUUnvY+2vKxVZ1F5aso65jMTbPEBRGMONtUrd3WLjFsTiMnyf7Zvn0jPcOAUEHfYROfvgmc2iOSaiklTtDg=="
Feb 12 07:36:03 volumio go-librespot[2198]: time="2026-02-12T07:36:03-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:36:04 volumio go-librespot[2198]: time="2026-02-12T07:36:04-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:04 volumio go-librespot[2198]: time="2026-02-12T07:36:04-06:00" level=debug msg="completed challenge"
Feb 12 07:36:04 volumio go-librespot[2198]: time="2026-02-12T07:36:04-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:04 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:04 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:04 volumio volumio[1690]: info: MyVolumio token set successfully
Feb 12 07:36:04 volumio volumio[1690]: info: MYVOLUMIO: Adding device
Feb 12 07:36:04 volumio volumio[1690]: info: MYVOLUMIO: Evaluating Server
Feb 12 07:36:04 volumio volumio[1690]: info: MyVolumio status changed
Feb 12 07:36:04 volumio volumio[1690]: info: Streaming services startup
Feb 12 07:36:04 volumio volumio[1690]: info: Starting Streaming Daemon
Feb 12 07:36:04 volumio volumio[1690]: info: Removing browser output: myVolumio user plan is not superstar
Feb 12 07:36:04 volumio volumio[1690]: info: Removing audio output:
Feb 12 07:36:04 volumio volumio[1690]: info: Stoppping Tunnel 1
Feb 12 07:36:04 volumio sudo[2227]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service
Feb 12 07:36:04 volumio sudo[2227]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Feb 12 07:36:04 volumio sudo[2229]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl stop sshtunnel.service
Feb 12 07:36:04 volumio sudo[2229]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Feb 12 07:36:04 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.
Feb 12 07:36:04 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.
Feb 12 07:36:04 volumio sudo[2227]: pam_unix(sudo:session): session closed for user root
Feb 12 07:36:04 volumio volumio[1690]: error: Cannot start Volumio Streaming Daemon
Feb 12 07:36:04 volumio volumio[1690]: error: Failed initialization of streaming services: Error: Error: Command failed: /usr/bin/sudo systemctl restart volumio-streaming-daemon.service
Feb 12 07:36:04 volumio volumio[1690]: Failed to restart volumio-streaming-daemon.service: Unit volumio-streaming-daemon.service not found.
Feb 12 07:36:04 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.
Feb 12 07:36:04 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.
Feb 12 07:36:04 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.
Feb 12 07:36:04 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.
Feb 12 07:36:04 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.
Feb 12 07:36:04 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.
Feb 12 07:36:04 volumio sudo[2229]: pam_unix(sudo:session): session closed for user root
Feb 12 07:36:04 volumio volumio[1690]: info: Remote SSH Stopped
Feb 12 07:36:04 volumio volumio[1690]: info: Setting Geolocation for MyVolumio to us1
Feb 12 07:36:04 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:04 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:04 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:04 volumio volumio[1690]: error: Failed to add MyVolumio device: {"message":"USER_NOT_FOUND"}
Feb 12 07:36:05 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:05 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:05 volumio volumio[1690]: info: Updating MyVolumio device info
Feb 12 07:36:05 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:05 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:05 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:06 volumio volumio[1690]: error: Failed to update MyVolumio device: {"message":"DEVICE_NOT_FOUND"}
Feb 12 07:36:07 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 216.
Feb 12 07:36:07 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:07 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:07 volumio go-librespot[2232]: go-librespot daemon starting...
Feb 12 07:36:07 volumio go-librespot[2234]: time="2026-02-12T07:36:07-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:07 volumio go-librespot[2234]: time="2026-02-12T07:36:07-06:00" level=debug msg="app state loaded"
Feb 12 07:36:07 volumio go-librespot[2234]: time="2026-02-12T07:36:07-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:07 volumio go-librespot[2234]: time="2026-02-12T07:36:07-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:07 volumio go-librespot[2234]: time="2026-02-12T07:36:07-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gue1.spotify.com:443 ap-gew1.spotify.com:80]"
Feb 12 07:36:07 volumio go-librespot[2234]: time="2026-02-12T07:36:07-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew1-dealer.spotify.com:443]"
Feb 12 07:36:07 volumio go-librespot[2234]: time="2026-02-12T07:36:07-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew1-spclient.spotify.com:443]"
Feb 12 07:36:07 volumio go-librespot[2234]: time="2026-02-12T07:36:07-06:00" level=info msg="zeroconf server listening on port 46407"
Feb 12 07:36:07 volumio go-librespot[2234]: time="2026-02-12T07:36:07-06:00" level=debug msg="obtained new client token: AAD+lzYcO3VZYm214h9M7crGlA6LQCfV9L1TJYgHMFxqclZzi3/u/zs+RunUwwoegL+z4XOgNatKuSE653uAGLnxkFrME2G7+bgVJAeUouhUG1IOiuWEnxrMGoT/CvX9i27jIif6h3aDOKMnNC1obYMZFzvBJuJNWBeVqS/v4dS95f9xB0r+n5Cm5MTnQXXmpzwrx7b/yZHiI2qNbCA+g9WuPcID+6XB75+aeivI8nKO58jabZ4EslZkOw=="
Feb 12 07:36:07 volumio go-librespot[2234]: time="2026-02-12T07:36:07-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:36:07 volumio go-librespot[2234]: time="2026-02-12T07:36:07-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:07 volumio go-librespot[2234]: time="2026-02-12T07:36:07-06:00" level=debug msg="completed challenge"
Feb 12 07:36:07 volumio go-librespot[2234]: time="2026-02-12T07:36:07-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:07 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:07 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:08 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:08 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:08 volumio volumio[1690]: info: MYVOLUMIO: Adding device
Feb 12 07:36:08 volumio volumio[1690]: info: MYVOLUMIO: Evaluating Server
Feb 12 07:36:09 volumio volumio[1690]: info: Setting Geolocation for MyVolumio to us1
Feb 12 07:36:09 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:09 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:09 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:09 volumio volumio[1690]: error: Failed to add MyVolumio device: {"message":"USER_NOT_FOUND"}
Feb 12 07:36:10 volumio volumio[1690]: info: Updating MyVolumio device info
Feb 12 07:36:10 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:10 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:10 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:10 volumio volumio[1690]: error: Failed to update MyVolumio device: {"message":"DEVICE_NOT_FOUND"}
Feb 12 07:36:11 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 217.
Feb 12 07:36:11 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:11 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:11 volumio go-librespot[2276]: go-librespot daemon starting...
Feb 12 07:36:11 volumio go-librespot[2277]: time="2026-02-12T07:36:11-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:11 volumio go-librespot[2277]: time="2026-02-12T07:36:11-06:00" level=debug msg="app state loaded"
Feb 12 07:36:11 volumio go-librespot[2277]: time="2026-02-12T07:36:11-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:11 volumio go-librespot[2277]: time="2026-02-12T07:36:11-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:11 volumio go-librespot[2277]: time="2026-02-12T07:36:11-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gue1.spotify.com:443 ap-gew1.spotify.com:80]"
Feb 12 07:36:11 volumio go-librespot[2277]: time="2026-02-12T07:36:11-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew1-dealer.spotify.com:443]"
Feb 12 07:36:11 volumio go-librespot[2277]: time="2026-02-12T07:36:11-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew1-spclient.spotify.com:443]"
Feb 12 07:36:11 volumio go-librespot[2277]: time="2026-02-12T07:36:11-06:00" level=info msg="zeroconf server listening on port 38971"
Feb 12 07:36:11 volumio go-librespot[2277]: time="2026-02-12T07:36:11-06:00" level=debug msg="obtained new client token: AADxQuKtns63/Lz8JFJ+gTJFeuoxCgZU3TFTYcdgNnH6NdQ6DIXtRDk/7+o/7dhTnsTJoUOZLMW6ELqX98jF9u/Uk86XkuZk8CiT1/DefO4taja+rnW9pqx6bYefq4DtYv9NVZ6GWaxX+41OoEILygfcAY5JZvCs9zkO+X54pKGp6RFKgtH8fdOAvvHNnI3Zc2leAWFKOC8O/jAgKG7OQqEnnOkx8nD7mYZladYGMx0z7nHfrXfSakY2pw=="
Feb 12 07:36:11 volumio go-librespot[2277]: time="2026-02-12T07:36:11-06:00" level=warning msg="failed to connect to AP ap-guc3.spotify.com:4070, retrying with a different AP" error="dial tcp 104.154.127.247:4070: connect: connection refused"
Feb 12 07:36:11 volumio go-librespot[2277]: time="2026-02-12T07:36:11-06:00" level=debug msg="connected to ap-guc3.spotify.com:443"
Feb 12 07:36:11 volumio go-librespot[2277]: time="2026-02-12T07:36:11-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:11 volumio go-librespot[2277]: time="2026-02-12T07:36:11-06:00" level=debug msg="completed challenge"
Feb 12 07:36:11 volumio go-librespot[2277]: time="2026-02-12T07:36:11-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:11 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:11 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:11 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:11 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:13 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Feb 12 07:36:13 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:13 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateCheckEnabled
Feb 12 07:36:13 volumio volumio-remote-updater[2265]: Test mode disabled
Feb 12 07:36:13 volumio volumio-remote-updater[2265]: Alpha mode disabled
Feb 12 07:36:13 volumio volumio-remote-updater[2265]: Alpha legacy test mode disabled
Feb 12 07:36:13 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: my_volumio , getAutoUpdateEnabled
Feb 12 07:36:14 volumio volumio[1690]: info: Update Ready: {"changeLogLink":"http://volumio.org","description":"FIXES
\n\n- Fix for CPU utilization spike
\n- Fix for triggerhappy input permission
\n
\nNEW ADDITIONS
\n\n- Add BLE onboarding plugin
\n- Enable vc4-kms-v3d for all compatible RPi models
\n- Update Tidal SDK
\n
\n","title":"Update v4.096","updateavailable":true}
Feb 12 07:36:14 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: updater_comm , setUpdateMessageCache
Feb 12 07:36:14 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:14 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:14 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 218.
Feb 12 07:36:14 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:14 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:14 volumio go-librespot[2291]: go-librespot daemon starting...
Feb 12 07:36:14 volumio go-librespot[2292]: time="2026-02-12T07:36:14-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:14 volumio go-librespot[2292]: time="2026-02-12T07:36:14-06:00" level=debug msg="app state loaded"
Feb 12 07:36:14 volumio go-librespot[2292]: time="2026-02-12T07:36:14-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:14 volumio go-librespot[2292]: time="2026-02-12T07:36:14-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:15 volumio go-librespot[2292]: time="2026-02-12T07:36:15-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gue1.spotify.com:4070 ap-gew1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:36:15 volumio go-librespot[2292]: time="2026-02-12T07:36:15-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:36:15 volumio go-librespot[2292]: time="2026-02-12T07:36:15-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:36:15 volumio go-librespot[2292]: time="2026-02-12T07:36:15-06:00" level=info msg="zeroconf server listening on port 43121"
Feb 12 07:36:15 volumio go-librespot[2292]: time="2026-02-12T07:36:15-06:00" level=debug msg="obtained new client token: AAANwUn2m10G59KD6+FbBT6GA0DnPxLmUZ/qySVSn7Z3UUyG46OFYk41IEawp2fl0M7jxTxb3Txvst9Ys5Ut2qKc5fqsRvizg53zPTc6x8fiS9q5enoVjbzfYitC3n6FuGPOjzN7888MP9sMjoqfZ+dApYFOjvVRkLgHuawDLqeuJxZy3vlfskjEVplidrVejVaoLcpwP5FWB1XpXI0/8h5H56Zo1hCrQZJhSWyusvnfIMgxqaoNeyM="
Feb 12 07:36:15 volumio go-librespot[2292]: time="2026-02-12T07:36:15-06:00" level=warning msg="failed to connect to AP ap-guc3.spotify.com:4070, retrying with a different AP" error="dial tcp 104.154.127.247:4070: connect: connection refused"
Feb 12 07:36:15 volumio go-librespot[2292]: time="2026-02-12T07:36:15-06:00" level=debug msg="connected to ap-guc3.spotify.com:443"
Feb 12 07:36:15 volumio go-librespot[2292]: time="2026-02-12T07:36:15-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:15 volumio go-librespot[2292]: time="2026-02-12T07:36:15-06:00" level=debug msg="completed challenge"
Feb 12 07:36:15 volumio go-librespot[2292]: time="2026-02-12T07:36:15-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:15 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:15 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:16 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getPrivacySettings
Feb 12 07:36:16 volumio volumio[1690]: verbose: New Socket.io Connection to localhost:3000 from 127.0.0.1 UA: node-XMLHttpRequest Engine version: 3 Transport: polling Total Clients: 4
Feb 12 07:36:16 volumio volumio[1690]: info: CoreCommandRouter::volumioGetState
Feb 12 07:36:16 volumio volumio[1690]: info: CorePlayQueue::getTrack 0
Feb 12 07:36:17 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:17 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:18 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 219.
Feb 12 07:36:18 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:18 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:18 volumio go-librespot[2299]: go-librespot daemon starting...
Feb 12 07:36:18 volumio go-librespot[2300]: time="2026-02-12T07:36:18-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:18 volumio go-librespot[2300]: time="2026-02-12T07:36:18-06:00" level=debug msg="app state loaded"
Feb 12 07:36:18 volumio go-librespot[2300]: time="2026-02-12T07:36:18-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:18 volumio go-librespot[2300]: time="2026-02-12T07:36:18-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:18 volumio go-librespot[2300]: time="2026-02-12T07:36:18-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gue1.spotify.com:4070 ap-gew1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:36:18 volumio go-librespot[2300]: time="2026-02-12T07:36:18-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:36:18 volumio go-librespot[2300]: time="2026-02-12T07:36:18-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:36:18 volumio go-librespot[2300]: time="2026-02-12T07:36:18-06:00" level=info msg="zeroconf server listening on port 44717"
Feb 12 07:36:18 volumio go-librespot[2300]: time="2026-02-12T07:36:18-06:00" level=debug msg="obtained new client token: AAB72KAD3A+Vilzw7tz7/y4yIa+woOocgH1kqcpQ1Ft4fTIE3sdUoSas1fDIgVbWfzxmQZ5aBD0gehEdP0SFRlITyash6gVm5+ZfmL6qKLS0w4GvJM/mjyEgxdQ9u00e0md8TS4XWyLvD1sIOpFKysHTu3mI78DdHzOmS6M0rsY/HQizGC2hPScjxPolvCfbWsWjsbToVd5+FLJPLOvS/vxpQEd/aLM3AWrDQhUkjCfiQIo698USw364cg=="
Feb 12 07:36:18 volumio go-librespot[2300]: time="2026-02-12T07:36:18-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:36:19 volumio go-librespot[2300]: time="2026-02-12T07:36:19-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:19 volumio go-librespot[2300]: time="2026-02-12T07:36:19-06:00" level=debug msg="completed challenge"
Feb 12 07:36:19 volumio go-librespot[2300]: time="2026-02-12T07:36:19-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:19 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:19 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:20 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:20 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:21 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 12 07:36:21 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 12 07:36:21 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getConfigParam
Feb 12 07:36:21 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: appearance , getConfigParam
Feb 12 07:36:21 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: mpd , getMyCollectionStatsObject
Feb 12 07:36:21 volumio volumio[1690]: info: CoreCommandRouter::volumioGetBrowseSources
Feb 12 07:36:21 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getSystemVersion
Feb 12 07:36:22 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 220.
Feb 12 07:36:22 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:22 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:22 volumio go-librespot[2321]: go-librespot daemon starting...
Feb 12 07:36:22 volumio go-librespot[2322]: time="2026-02-12T07:36:22-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:22 volumio go-librespot[2322]: time="2026-02-12T07:36:22-06:00" level=debug msg="app state loaded"
Feb 12 07:36:22 volumio go-librespot[2322]: time="2026-02-12T07:36:22-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:22 volumio go-librespot[2322]: time="2026-02-12T07:36:22-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:22 volumio volumio[1690]: error: MyVolumio Plugin failed to authenticate in a timely fashion
Feb 12 07:36:22 volumio volumio[1690]: info: Completed starting MyVolumio Plugin
Feb 12 07:36:22 volumio volumio[1690]: [Metrics] CommandRouter: 55s 557.90ms
Feb 12 07:36:22 volumio volumio[1690]: info: CoreCommandRouter::volumiosetStartupVolume
Feb 12 07:36:22 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , getConfigParam
Feb 12 07:36:22 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getConfigParam
Feb 12 07:36:22 volumio go-librespot[2322]: time="2026-02-12T07:36:22-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gue1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:36:22 volumio go-librespot[2322]: time="2026-02-12T07:36:22-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:36:22 volumio go-librespot[2322]: time="2026-02-12T07:36:22-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:36:22 volumio volumio[1690]: info: CoreCommandRouter::Close All Modals sent
Feb 12 07:36:22 volumio go-librespot[2322]: time="2026-02-12T07:36:22-06:00" level=info msg="zeroconf server listening on port 44595"
Feb 12 07:36:22 volumio volumio[1690]: info: CoreCommandRouter::Close All Modals sent
Feb 12 07:36:22 volumio go-librespot[2322]: time="2026-02-12T07:36:22-06:00" level=debug msg="obtained new client token: AACC2ZhgVDy759jMJ/YITATdlWXbyd+VBMuLIYQ7FrSfGMuU9zbDjN2crBepTa1L97hg4LBJfLZ8SE2bkMMpX5AoVt2qWVYCMXQsLsvJW8/DU1hwQQxHSwLypgmgNk1H5apwGoFsfobyhcJiP7plWhyr1/1iwg8eOdOn72XwkknnKiIqDBhyobdOzinutNFd2b8fWlmy0Ag/g5YJmSNjJuObTXZGKk2qj+7+jISI/+PQHF/ZStocf+0a3w=="
Feb 12 07:36:22 volumio go-librespot[2322]: time="2026-02-12T07:36:22-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:36:22 volumio go-librespot[2322]: time="2026-02-12T07:36:22-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:22 volumio go-librespot[2322]: time="2026-02-12T07:36:22-06:00" level=debug msg="completed challenge"
Feb 12 07:36:22 volumio go-librespot[2322]: time="2026-02-12T07:36:22-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:22 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:22 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:23 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: alsa_controller , checkAudioDeviceAvailable
Feb 12 07:36:23 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: i2s_dacs , getI2sStatus
Feb 12 07:36:23 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , versionChangeDetect
Feb 12 07:36:23 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:23 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:26 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 221.
Feb 12 07:36:26 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:26 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:26 volumio go-librespot[2335]: go-librespot daemon starting...
Feb 12 07:36:26 volumio go-librespot[2336]: time="2026-02-12T07:36:26-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:26 volumio go-librespot[2336]: time="2026-02-12T07:36:26-06:00" level=debug msg="app state loaded"
Feb 12 07:36:26 volumio go-librespot[2336]: time="2026-02-12T07:36:26-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:26 volumio go-librespot[2336]: time="2026-02-12T07:36:26-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:26 volumio go-librespot[2336]: time="2026-02-12T07:36:26-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gue1.spotify.com:4070 ap-gew1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:36:26 volumio go-librespot[2336]: time="2026-02-12T07:36:26-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:36:26 volumio go-librespot[2336]: time="2026-02-12T07:36:26-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:36:26 volumio go-librespot[2336]: time="2026-02-12T07:36:26-06:00" level=info msg="zeroconf server listening on port 38499"
Feb 12 07:36:26 volumio go-librespot[2336]: time="2026-02-12T07:36:26-06:00" level=debug msg="obtained new client token: AAAjnzmpLC43D5H9xcUADI1kB8wFt0zhIsduqMWlSuDlPXOwG+gGJW/bh61UXMMFiQ7K5qowiKLgqJ6ZjhReVP/pbwpqogVwmxwQRIU3pymnnX4yx4NWPk33RDsyB3WlsC7kfb5I1TepllVTeNJzEYCNZgoK9AMPnTpW2SokZix5nE55AvLXOTigGxKLoAEyGSA+5QQH05Gw6+d3Iq5qrwtMaVEnPqYnEbJPujcYuAgSAruoLuhLCNWL2g=="
Feb 12 07:36:26 volumio go-librespot[2336]: time="2026-02-12T07:36:26-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:36:26 volumio go-librespot[2336]: time="2026-02-12T07:36:26-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:26 volumio go-librespot[2336]: time="2026-02-12T07:36:26-06:00" level=debug msg="completed challenge"
Feb 12 07:36:26 volumio go-librespot[2336]: time="2026-02-12T07:36:26-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:26 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:26 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:26 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:26 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:29 volumio volumio[1690]: info: BOOT COMPLETED
Feb 12 07:36:29 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:29 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:29 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 222.
Feb 12 07:36:29 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:29 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:29 volumio go-librespot[2358]: go-librespot daemon starting...
Feb 12 07:36:29 volumio go-librespot[2359]: time="2026-02-12T07:36:29-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:29 volumio go-librespot[2359]: time="2026-02-12T07:36:29-06:00" level=debug msg="app state loaded"
Feb 12 07:36:29 volumio go-librespot[2359]: time="2026-02-12T07:36:29-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:29 volumio go-librespot[2359]: time="2026-02-12T07:36:29-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:30 volumio go-librespot[2359]: time="2026-02-12T07:36:30-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gue1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:36:30 volumio go-librespot[2359]: time="2026-02-12T07:36:30-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:36:30 volumio go-librespot[2359]: time="2026-02-12T07:36:30-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:36:30 volumio go-librespot[2359]: time="2026-02-12T07:36:30-06:00" level=info msg="zeroconf server listening on port 45337"
Feb 12 07:36:30 volumio go-librespot[2359]: time="2026-02-12T07:36:30-06:00" level=debug msg="obtained new client token: AACJUsFHhEatJ7cNPGMRKH58IjB83S9oHEVtrOjZTiCHdDTUbd2osXXm01BiTQuFFg/MHGu70qRJVNg39lPU58x1SEP7J6LXIW1gRfKIhyZNnyHhWQV39QYtZz3WQMTpEZANV/TfghXZT8GRTrRKEfbCnnbNK4fbmQn6XFM30QxnyeYbuWmnLK/hUvCoWp4HaoDx3EcXRgG7Z2jD6SVXMTPO8ARwcR/UmZQL4fXHAVAZF6p7uMVM+J4="
Feb 12 07:36:30 volumio go-librespot[2359]: time="2026-02-12T07:36:30-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:36:30 volumio go-librespot[2359]: time="2026-02-12T07:36:30-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:30 volumio go-librespot[2359]: time="2026-02-12T07:36:30-06:00" level=debug msg="completed challenge"
Feb 12 07:36:30 volumio go-librespot[2359]: time="2026-02-12T07:36:30-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:30 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:30 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:32 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:32 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:33 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 223.
Feb 12 07:36:33 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:33 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:33 volumio go-librespot[2366]: go-librespot daemon starting...
Feb 12 07:36:33 volumio go-librespot[2367]: time="2026-02-12T07:36:33-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:33 volumio go-librespot[2367]: time="2026-02-12T07:36:33-06:00" level=debug msg="app state loaded"
Feb 12 07:36:33 volumio go-librespot[2367]: time="2026-02-12T07:36:33-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:33 volumio go-librespot[2367]: time="2026-02-12T07:36:33-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:33 volumio go-librespot[2367]: time="2026-02-12T07:36:33-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gue1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:36:33 volumio go-librespot[2367]: time="2026-02-12T07:36:33-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:36:33 volumio go-librespot[2367]: time="2026-02-12T07:36:33-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:36:33 volumio go-librespot[2367]: time="2026-02-12T07:36:33-06:00" level=info msg="zeroconf server listening on port 41315"
Feb 12 07:36:33 volumio go-librespot[2367]: time="2026-02-12T07:36:33-06:00" level=debug msg="obtained new client token: AAC2jD+v2v1NtoGNJj4XK5VxsnrO3SivFAnvI4rQtxnwXGO1lRtIqlYDCc4wGoJRPDxjozRDIYtoC7ThqR7fCD7vkytNts9gQUORt9ywpKww6FIawTHWEDmdbIWZoLyVw2CqBRJ5ipYUTbEyA8jm6dpUEHue54v3NtfGHXrUqBuBNumHb5/Xt9LnF2h0OEkraMgLp3eOZdXMIcLRhk9pZvl7aMX4qVYvKTUSL9/JasRUxaLgHNjuB///Bw=="
Feb 12 07:36:33 volumio go-librespot[2367]: time="2026-02-12T07:36:33-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:36:34 volumio go-librespot[2367]: time="2026-02-12T07:36:34-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:34 volumio go-librespot[2367]: time="2026-02-12T07:36:34-06:00" level=debug msg="completed challenge"
Feb 12 07:36:34 volumio go-librespot[2367]: time="2026-02-12T07:36:34-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:34 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:34 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:35 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:35 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:37 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 224.
Feb 12 07:36:37 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:37 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:37 volumio go-librespot[2377]: go-librespot daemon starting...
Feb 12 07:36:37 volumio go-librespot[2378]: time="2026-02-12T07:36:37-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:37 volumio go-librespot[2378]: time="2026-02-12T07:36:37-06:00" level=debug msg="app state loaded"
Feb 12 07:36:37 volumio go-librespot[2378]: time="2026-02-12T07:36:37-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:37 volumio go-librespot[2378]: time="2026-02-12T07:36:37-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:37 volumio go-librespot[2378]: time="2026-02-12T07:36:37-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gue1.spotify.com:443 ap-gew1.spotify.com:80]"
Feb 12 07:36:37 volumio go-librespot[2378]: time="2026-02-12T07:36:37-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew1-dealer.spotify.com:443]"
Feb 12 07:36:37 volumio go-librespot[2378]: time="2026-02-12T07:36:37-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew1-spclient.spotify.com:443]"
Feb 12 07:36:37 volumio go-librespot[2378]: time="2026-02-12T07:36:37-06:00" level=info msg="zeroconf server listening on port 43327"
Feb 12 07:36:37 volumio go-librespot[2378]: time="2026-02-12T07:36:37-06:00" level=debug msg="obtained new client token: AAD+5I4SSzo5QWzr4VxD469KFB8OYl4++6vCWnPitFwMPnE9YFrGfCFqJ+jowlnWg4DdSiyccN6sx4thSl6dY0ZInYeJpwXFfuBdLAHhXvg8RmWT7GtBwo+0dQRsbyOUgpnWfeZ13/R425auu3os2MpVup67aQYVtRfqHBFgOng1LzIl2KwSc+X5W//02HH6ChkfVTBrux4ZE5I1dJjSiVNFyBGB9GIsyJdUgKuUOs3Cd0+YHMnglnrXgg=="
Feb 12 07:36:37 volumio go-librespot[2378]: time="2026-02-12T07:36:37-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:36:37 volumio go-librespot[2378]: time="2026-02-12T07:36:37-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:37 volumio go-librespot[2378]: time="2026-02-12T07:36:37-06:00" level=debug msg="completed challenge"
Feb 12 07:36:37 volumio go-librespot[2378]: time="2026-02-12T07:36:37-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:37 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:37 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:38 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:38 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:41 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 225.
Feb 12 07:36:41 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:41 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:41 volumio go-librespot[2399]: go-librespot daemon starting...
Feb 12 07:36:41 volumio go-librespot[2400]: time="2026-02-12T07:36:41-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:41 volumio go-librespot[2400]: time="2026-02-12T07:36:41-06:00" level=debug msg="app state loaded"
Feb 12 07:36:41 volumio go-librespot[2400]: time="2026-02-12T07:36:41-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:41 volumio go-librespot[2400]: time="2026-02-12T07:36:41-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:41 volumio go-librespot[2400]: time="2026-02-12T07:36:41-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gew1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:36:41 volumio go-librespot[2400]: time="2026-02-12T07:36:41-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gew1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:36:41 volumio go-librespot[2400]: time="2026-02-12T07:36:41-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gew1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:36:41 volumio go-librespot[2400]: time="2026-02-12T07:36:41-06:00" level=info msg="zeroconf server listening on port 35085"
Feb 12 07:36:41 volumio go-librespot[2400]: time="2026-02-12T07:36:41-06:00" level=debug msg="obtained new client token: AACoDdVopT7oCAGS+uqx2ZqRCvgyjNrAyFPZ+dbljWJsnDa8OVfXhvSr9/apxMovjWgNk2v2tBcs2nG9GSUROGRgt1Q339OstuxJJcPLPGciX3SASqvjBawjMvAXpqLUKQ2RgE4MJhSeN6aWgtwvxc5eLOpse2ILFu5H38UUosBAh92w7DbcWNnuOZppSg98j/Oi1nXIVnMMWre/K/PC+8OPas+EVDPozEA6VtQVxWFZUmYSy5wtGvA1Vg=="
Feb 12 07:36:41 volumio go-librespot[2400]: time="2026-02-12T07:36:41-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:36:41 volumio go-librespot[2400]: time="2026-02-12T07:36:41-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:41 volumio go-librespot[2400]: time="2026-02-12T07:36:41-06:00" level=debug msg="completed challenge"
Feb 12 07:36:41 volumio go-librespot[2400]: time="2026-02-12T07:36:41-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:41 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:41 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:41 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:41 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:43 volumio volumio[1690]: info: UPDATER: Scheduling automatic update
Feb 12 07:36:43 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getAutoUpdateWindowStartTime
Feb 12 07:36:43 volumio volumio[1690]: info: CoreCommandRouter::executeOnPlugin: system , getAutoUpdateWindowStopTime
Feb 12 07:36:43 volumio volumio[1690]: info: UPDATER: Auto update will take place at: Fri Feb 13 2026 04:14:59 GMT-0600 (Central Standard Time)
Feb 12 07:36:44 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:44 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:44 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 226.
Feb 12 07:36:44 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:44 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:44 volumio go-librespot[2407]: go-librespot daemon starting...
Feb 12 07:36:44 volumio go-librespot[2408]: time="2026-02-12T07:36:44-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:44 volumio go-librespot[2408]: time="2026-02-12T07:36:44-06:00" level=debug msg="app state loaded"
Feb 12 07:36:44 volumio go-librespot[2408]: time="2026-02-12T07:36:44-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:44 volumio go-librespot[2408]: time="2026-02-12T07:36:44-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:45 volumio go-librespot[2408]: time="2026-02-12T07:36:45-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gew1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:36:45 volumio go-librespot[2408]: time="2026-02-12T07:36:45-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gew1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:36:45 volumio go-librespot[2408]: time="2026-02-12T07:36:45-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gew1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:36:45 volumio go-librespot[2408]: time="2026-02-12T07:36:45-06:00" level=info msg="zeroconf server listening on port 44181"
Feb 12 07:36:45 volumio go-librespot[2408]: time="2026-02-12T07:36:45-06:00" level=debug msg="obtained new client token: AACkOn8YupENQjLc8u/yUeQ/TZpXLBu/VHncVY+623Fp66Lkx0zG5yPfeXlBV/1kbtrzlRfNpRW7HuJdCZdWTMCoapsHZrWHVE88xcOR6nPQup7No3RK2yJYtEdnD/xuEnMyisMGXoHEdlaHs0Uw6EnwHSIaHzRpPzvMuGz43913WEwEJScgz9+2wyZohENvK+OByO9lOokAtJ8NQa0geqcBkROdcO+XlFX+qj3itt7BY2BlQZZ/Kkk="
Feb 12 07:36:45 volumio go-librespot[2408]: time="2026-02-12T07:36:45-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:36:45 volumio go-librespot[2408]: time="2026-02-12T07:36:45-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:45 volumio go-librespot[2408]: time="2026-02-12T07:36:45-06:00" level=debug msg="completed challenge"
Feb 12 07:36:45 volumio go-librespot[2408]: time="2026-02-12T07:36:45-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:45 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:45 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:47 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:47 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:48 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 227.
Feb 12 07:36:48 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:48 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:48 volumio go-librespot[2417]: go-librespot daemon starting...
Feb 12 07:36:48 volumio go-librespot[2418]: time="2026-02-12T07:36:48-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:48 volumio go-librespot[2418]: time="2026-02-12T07:36:48-06:00" level=debug msg="app state loaded"
Feb 12 07:36:48 volumio go-librespot[2418]: time="2026-02-12T07:36:48-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:48 volumio go-librespot[2418]: time="2026-02-12T07:36:48-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:48 volumio go-librespot[2418]: time="2026-02-12T07:36:48-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gue1.spotify.com:443 ap-gew1.spotify.com:80]"
Feb 12 07:36:48 volumio go-librespot[2418]: time="2026-02-12T07:36:48-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew1-dealer.spotify.com:443]"
Feb 12 07:36:48 volumio go-librespot[2418]: time="2026-02-12T07:36:48-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew1-spclient.spotify.com:443]"
Feb 12 07:36:48 volumio go-librespot[2418]: time="2026-02-12T07:36:48-06:00" level=info msg="zeroconf server listening on port 39505"
Feb 12 07:36:48 volumio go-librespot[2418]: time="2026-02-12T07:36:48-06:00" level=debug msg="obtained new client token: AADHBtgq3BusMYHI8Bi/MykYNzJSpILhrsoCYhAnhtnS1YckRjbuZHz+IAplG1XqpRik6/WpQiCyvEQUNSQwBDM7U3DMidcFGDn4DQceVYBCtyh6knCBb3Lq4rmdPs3z3JeosL9qR8lJ0j2dka1KGYUhux//vgb8X5NUeVKmFLKF3FDzwGSzgum25VY8kYYbwizcoKluDa9GVWsVm4WO88c8JSOjuXKHSsPDgAblgbyLJnVhVVY4neeHkQ=="
Feb 12 07:36:48 volumio go-librespot[2418]: time="2026-02-12T07:36:48-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:36:49 volumio go-librespot[2418]: time="2026-02-12T07:36:49-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:49 volumio go-librespot[2418]: time="2026-02-12T07:36:49-06:00" level=debug msg="completed challenge"
Feb 12 07:36:49 volumio go-librespot[2418]: time="2026-02-12T07:36:49-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:49 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:49 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:50 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:50 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:52 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 228.
Feb 12 07:36:52 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:52 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:52 volumio go-librespot[2439]: go-librespot daemon starting...
Feb 12 07:36:52 volumio go-librespot[2440]: time="2026-02-12T07:36:52-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:52 volumio go-librespot[2440]: time="2026-02-12T07:36:52-06:00" level=debug msg="app state loaded"
Feb 12 07:36:52 volumio go-librespot[2440]: time="2026-02-12T07:36:52-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:52 volumio go-librespot[2440]: time="2026-02-12T07:36:52-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:52 volumio go-librespot[2440]: time="2026-02-12T07:36:52-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gue1.spotify.com:4070 ap-gew1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:36:52 volumio go-librespot[2440]: time="2026-02-12T07:36:52-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:36:52 volumio go-librespot[2440]: time="2026-02-12T07:36:52-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:36:52 volumio go-librespot[2440]: time="2026-02-12T07:36:52-06:00" level=info msg="zeroconf server listening on port 41395"
Feb 12 07:36:52 volumio go-librespot[2440]: time="2026-02-12T07:36:52-06:00" level=debug msg="obtained new client token: AACdgPR33GBXpsvNKUUQoA8KRJ0BKUDoOSYwPS+CibzM++zD0rtpx1xc4GuKnYtJxRgoY33bSEiYoDEYqGoCUJo5TRt5B1rlrT2CvaMpE7rNGs29mYp8ODWKXu2GmaKG5IHprbmH+EyldiY0uCxUI+C27tjLf2QLTb/Thq5m5tRSMrRr27a2uXvlY8PIuQXloPAt/LoqtiNzbKi4xPUFThsdBn+9HQ9xnsuEycdYU18nk2yC2MmwPc5N5A=="
Feb 12 07:36:52 volumio go-librespot[2440]: time="2026-02-12T07:36:52-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:36:52 volumio go-librespot[2440]: time="2026-02-12T07:36:52-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:52 volumio go-librespot[2440]: time="2026-02-12T07:36:52-06:00" level=debug msg="completed challenge"
Feb 12 07:36:52 volumio go-librespot[2440]: time="2026-02-12T07:36:52-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:52 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:52 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:53 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:53 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:56 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 229.
Feb 12 07:36:56 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:56 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:56 volumio go-librespot[2450]: go-librespot daemon starting...
Feb 12 07:36:56 volumio go-librespot[2451]: time="2026-02-12T07:36:56-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:56 volumio go-librespot[2451]: time="2026-02-12T07:36:56-06:00" level=debug msg="app state loaded"
Feb 12 07:36:56 volumio go-librespot[2451]: time="2026-02-12T07:36:56-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:56 volumio go-librespot[2451]: time="2026-02-12T07:36:56-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:36:56 volumio go-librespot[2451]: time="2026-02-12T07:36:56-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gue1.spotify.com:4070 ap-gew1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:36:56 volumio go-librespot[2451]: time="2026-02-12T07:36:56-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:36:56 volumio go-librespot[2451]: time="2026-02-12T07:36:56-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:36:56 volumio go-librespot[2451]: time="2026-02-12T07:36:56-06:00" level=info msg="zeroconf server listening on port 41489"
Feb 12 07:36:56 volumio go-librespot[2451]: time="2026-02-12T07:36:56-06:00" level=debug msg="obtained new client token: AABL/RrbNmKqH43ydP8vdtpwQBcXli8CIgLRl6uBGEsDC+cuwEEdz/PI//6kZdtcfa+9WxGnZRjc6sZ0y6TRPD/n5O3HHvkoonZS6oCNXMBniPfDhQhoXFUD3fUy1Zc0NBOh6eVKvAuKAOskcw7jn4jk3Y90AodYbz2QbLqWeu5krDYO9P/oUqobnWS1+qTNPscygdVNVo0z+qrcUFy0ecLYqVpC9LSKNfybs39BbtalR1C00mDlxyTNbA=="
Feb 12 07:36:56 volumio go-librespot[2451]: time="2026-02-12T07:36:56-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:36:56 volumio go-librespot[2451]: time="2026-02-12T07:36:56-06:00" level=debug msg="completed keyexchange"
Feb 12 07:36:56 volumio go-librespot[2451]: time="2026-02-12T07:36:56-06:00" level=debug msg="completed challenge"
Feb 12 07:36:56 volumio go-librespot[2451]: time="2026-02-12T07:36:56-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:36:56 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:36:56 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:36:56 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:56 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:59 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:36:59 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:36:59 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 230.
Feb 12 07:36:59 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:59 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:36:59 volumio go-librespot[2472]: go-librespot daemon starting...
Feb 12 07:36:59 volumio go-librespot[2473]: time="2026-02-12T07:36:59-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:36:59 volumio go-librespot[2473]: time="2026-02-12T07:36:59-06:00" level=debug msg="app state loaded"
Feb 12 07:36:59 volumio go-librespot[2473]: time="2026-02-12T07:36:59-06:00" level=debug msg="stored credentials not found"
Feb 12 07:36:59 volumio go-librespot[2473]: time="2026-02-12T07:36:59-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:37:00 volumio go-librespot[2473]: time="2026-02-12T07:37:00-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gew1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:37:00 volumio go-librespot[2473]: time="2026-02-12T07:37:00-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gew1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:37:00 volumio go-librespot[2473]: time="2026-02-12T07:37:00-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gew1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:37:00 volumio go-librespot[2473]: time="2026-02-12T07:37:00-06:00" level=info msg="zeroconf server listening on port 45189"
Feb 12 07:37:00 volumio go-librespot[2473]: time="2026-02-12T07:37:00-06:00" level=debug msg="obtained new client token: AADHyPwmWir+mef3aR/qN/a/97oi0ICz/p8XeS7n9AAkUUEySD1UvfQHwwXhDMGllTV5GMX8pw1iSMa7STfNbq7qdq1j72yYW5Vd+T0c9VAtc5m0+hTKkI2QE0FxdDvH54SuYq2slCOVKXFBMsiPSpSLdWYFwe9rwzSsNthz+qy+1ubKd3do2CTDz9CMmb27eW7BNRDaNl5MYsw4LDLBUEobDpwITW1GtAMzmzsiDHRpHw+6MR02izM="
Feb 12 07:37:00 volumio go-librespot[2473]: time="2026-02-12T07:37:00-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:37:00 volumio go-librespot[2473]: time="2026-02-12T07:37:00-06:00" level=debug msg="completed keyexchange"
Feb 12 07:37:00 volumio go-librespot[2473]: time="2026-02-12T07:37:00-06:00" level=debug msg="completed challenge"
Feb 12 07:37:00 volumio go-librespot[2473]: time="2026-02-12T07:37:00-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:37:00 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:37:00 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:37:02 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:37:02 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:37:03 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 231.
Feb 12 07:37:03 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:37:03 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:37:03 volumio go-librespot[2480]: go-librespot daemon starting...
Feb 12 07:37:03 volumio go-librespot[2481]: time="2026-02-12T07:37:03-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:37:03 volumio go-librespot[2481]: time="2026-02-12T07:37:03-06:00" level=debug msg="app state loaded"
Feb 12 07:37:03 volumio go-librespot[2481]: time="2026-02-12T07:37:03-06:00" level=debug msg="stored credentials not found"
Feb 12 07:37:03 volumio go-librespot[2481]: time="2026-02-12T07:37:03-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:37:03 volumio go-librespot[2481]: time="2026-02-12T07:37:03-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gue1.spotify.com:4070 ap-gew1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:37:03 volumio go-librespot[2481]: time="2026-02-12T07:37:03-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:37:03 volumio go-librespot[2481]: time="2026-02-12T07:37:03-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:37:03 volumio go-librespot[2481]: time="2026-02-12T07:37:03-06:00" level=info msg="zeroconf server listening on port 34345"
Feb 12 07:37:03 volumio go-librespot[2481]: time="2026-02-12T07:37:03-06:00" level=debug msg="obtained new client token: AAB7jZxeyQ2Y3N3VpMk/M3NIrv8gfyNbGMKbjiVzC4nE4TaEp3G53eifZjQUJ+QOHPrVpYFl1odPq20ZmuHaLScrnab2LbdDakh+keeK7r31QIkPAMlhw1EfoCkAX6eaCb+5E9K56bUB7eRO7NWPsqtfSTh/t4qxUx1mVIj7yGnDpmW6NDnkesgqLR+3zK5E4eT1FWxtMu18xz97ddX2KZlGwjMWjo/uW2xMKVyO08Ek0Po1TvuHes3DUQ=="
Feb 12 07:37:03 volumio go-librespot[2481]: time="2026-02-12T07:37:03-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:37:04 volumio go-librespot[2481]: time="2026-02-12T07:37:04-06:00" level=debug msg="completed keyexchange"
Feb 12 07:37:04 volumio go-librespot[2481]: time="2026-02-12T07:37:04-06:00" level=debug msg="completed challenge"
Feb 12 07:37:04 volumio go-librespot[2481]: time="2026-02-12T07:37:04-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:37:04 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:37:04 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:37:05 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:37:05 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:37:07 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 232.
Feb 12 07:37:07 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:37:07 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:37:07 volumio go-librespot[2488]: go-librespot daemon starting...
Feb 12 07:37:07 volumio go-librespot[2489]: time="2026-02-12T07:37:07-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:37:07 volumio go-librespot[2489]: time="2026-02-12T07:37:07-06:00" level=debug msg="app state loaded"
Feb 12 07:37:07 volumio go-librespot[2489]: time="2026-02-12T07:37:07-06:00" level=debug msg="stored credentials not found"
Feb 12 07:37:07 volumio go-librespot[2489]: time="2026-02-12T07:37:07-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:37:07 volumio go-librespot[2489]: time="2026-02-12T07:37:07-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gew1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:37:07 volumio go-librespot[2489]: time="2026-02-12T07:37:07-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gew1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:37:07 volumio go-librespot[2489]: time="2026-02-12T07:37:07-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gew1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:37:07 volumio go-librespot[2489]: time="2026-02-12T07:37:07-06:00" level=info msg="zeroconf server listening on port 34531"
Feb 12 07:37:07 volumio go-librespot[2489]: time="2026-02-12T07:37:07-06:00" level=debug msg="obtained new client token: AAAuPYeZcIneSvKRODhRWkuaSTc20fzc/eh5Y5BMOpmK4VND5DPBYgtRbJCE+jxXN3hXB9ChEEd+/MMvvPytPrWpoIkE19QjWwuIACZ6hSxsu6a65gGTRt5kniuR+NTNr7gCvewx/95txRbfPes2cZSP+M66C/pgFRBaAafl+Oc17cMwSmZ8YOEAOrWXkCY8+g2cKepZ241qZhzWxAPjpR+em/BxXX8430UQEqvq+gmqT2a0eICliQWtQg=="
Feb 12 07:37:07 volumio go-librespot[2489]: time="2026-02-12T07:37:07-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:37:07 volumio go-librespot[2489]: time="2026-02-12T07:37:07-06:00" level=debug msg="completed keyexchange"
Feb 12 07:37:07 volumio go-librespot[2489]: time="2026-02-12T07:37:07-06:00" level=debug msg="completed challenge"
Feb 12 07:37:07 volumio go-librespot[2489]: time="2026-02-12T07:37:07-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:37:07 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:37:07 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:37:08 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:37:08 volumio volumio[1690]: info: Error connecting to go-librespot Websocket: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:37:11 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 233.
Feb 12 07:37:11 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:37:11 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:37:11 volumio go-librespot[2511]: go-librespot daemon starting...
Feb 12 07:37:11 volumio go-librespot[2512]: time="2026-02-12T07:37:11-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:37:11 volumio go-librespot[2512]: time="2026-02-12T07:37:11-06:00" level=debug msg="app state loaded"
Feb 12 07:37:11 volumio go-librespot[2512]: time="2026-02-12T07:37:11-06:00" level=debug msg="stored credentials not found"
Feb 12 07:37:11 volumio go-librespot[2512]: time="2026-02-12T07:37:11-06:00" level=info msg="api server listening on 127.0.0.1:9879"
Feb 12 07:37:11 volumio go-librespot[2512]: time="2026-02-12T07:37:11-06:00" level=debug msg="fetched new accesspoints: [ap-guc3.spotify.com:4070 ap-guc3.spotify.com:443 ap-guc3.spotify.com:80 ap-gae2.spotify.com:4070 ap-gue1.spotify.com:443 ap-gew4.spotify.com:80]"
Feb 12 07:37:11 volumio go-librespot[2512]: time="2026-02-12T07:37:11-06:00" level=debug msg="fetched new dealers: [guc3-dealer.spotify.com:443 gae2-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew4-dealer.spotify.com:443]"
Feb 12 07:37:11 volumio go-librespot[2512]: time="2026-02-12T07:37:11-06:00" level=debug msg="fetched new spclients: [guc3-spclient.spotify.com:443 gae2-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew4-spclient.spotify.com:443]"
Feb 12 07:37:11 volumio go-librespot[2512]: time="2026-02-12T07:37:11-06:00" level=info msg="zeroconf server listening on port 34891"
Feb 12 07:37:11 volumio go-librespot[2512]: time="2026-02-12T07:37:11-06:00" level=debug msg="obtained new client token: AADGch3vw76kMtmf6nctriLt+IctEIwE/PBgtTrpWI55nYBuoHJRSXNMYwA8O9lU8G7ul1HEck4Z0vc5x9dYEsJgozL6sK3nR+BUcFPmtNQnLtQqiy0F4fneco1jE7gfZygzlsfNpJGic437l7RSB1GVw+uGL9nHtqZp5ybXLws4AuWmmsNhpRGp6jmSvut5E97Ib9dBySSctQrFH8a33lhTTV5KNTi1akWn/WwhcnAYm1JY7NipR+SfGA=="
Feb 12 07:37:11 volumio go-librespot[2512]: time="2026-02-12T07:37:11-06:00" level=debug msg="connected to ap-guc3.spotify.com:4070"
Feb 12 07:37:11 volumio volumio[1690]: info: Initializing connection to go-librespot Websocket
Feb 12 07:37:11 volumio go-librespot[2512]: time="2026-02-12T07:37:11-06:00" level=debug msg="new websocket client"
Feb 12 07:37:11 volumio volumio[1690]: info: Connection to go-librespot Websocket established
Feb 12 07:37:12 volumio go-librespot[2512]: time="2026-02-12T07:37:12-06:00" level=debug msg="completed keyexchange"
Feb 12 07:37:12 volumio go-librespot[2512]: time="2026-02-12T07:37:12-06:00" level=debug msg="completed challenge"
Feb 12 07:37:12 volumio go-librespot[2512]: time="2026-02-12T07:37:12-06:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with username and spotify token: failed authenticating: accesspoint login failed: BadCredentials "
Feb 12 07:37:12 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE
Feb 12 07:37:12 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'.
Feb 12 07:37:12 volumio volumio[1690]: info: Connection to go-librespot Websocket closed
Feb 12 07:37:14 volumio volumio[1690]: info: Getting Spotify volume
Feb 12 07:37:14 volumio volumio[1690]: |||||||||||||||||||||||| WARNING: FATAL ERROR |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Feb 12 07:37:14 volumio volumio[1690]: Error: connect ECONNREFUSED 127.0.0.1:9879
Feb 12 07:37:14 volumio volumio[1690]: at TCPConnectWrap.afterConnect [as oncomplete] (node:net:1595:16) {
Feb 12 07:37:14 volumio volumio[1690]: errno: -111,
Feb 12 07:37:14 volumio volumio[1690]: code: 'ECONNREFUSED',
Feb 12 07:37:14 volumio volumio[1690]: syscall: 'connect',
Feb 12 07:37:14 volumio volumio[1690]: address: '127.0.0.1',
Feb 12 07:37:14 volumio volumio[1690]: port: 9879,
Feb 12 07:37:14 volumio volumio[1690]: response: undefined
Feb 12 07:37:14 volumio volumio[1690]: }
Feb 12 07:37:14 volumio volumio[1690]: |||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||
Feb 12 07:37:15 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 234.
Feb 12 07:37:15 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:37:15 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon.
Feb 12 07:37:15 volumio go-librespot[2534]: go-librespot daemon starting...
Feb 12 07:37:15 volumio sudo[2537]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-02-12 07:36'
Feb 12 07:37:15 volumio sudo[2537]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000)
Feb 12 07:37:15 volumio go-librespot[2538]: time="2026-02-12T07:37:15-06:00" level=info msg="running go-librespot 0.4.0"
Feb 12 07:37:15 volumio go-librespot[2538]: time="2026-02-12T07:37:15-06:00" level=debug msg="app state loaded"
Feb 12 07:37:15 volumio go-librespot[2538]: time="2026-02-12T07:37:15-06:00" level=debug msg="stored credentials not found"
Feb 12 07:37:15 volumio go-librespot[2538]: time="2026-02-12T07:37:15-06:00" level=info msg="api server listening on 127.0.0.1:9879"
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="ac7dd5922ede329d1459d48b226ddc71f5209a2c"
VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd"
VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2"
VOLUMIO_BE_VERSION="3441cddd43405c36fe444484553f10f2f5bc830b"
VOLUMIO_ARCH="arm"
VOLUMIO_VARIANT="volumio"
VOLUMIO_TEST="FALSE"
VOLUMIO_BUILD_DATE="Thu Nov 13 11:04:27 UTC 2025"
VOLUMIO_VERSION="4.069"
VOLUMIO_HARDWARE="pi"
VOLUMIO_DEVICENAME="Raspberry Pi"
VOLUMIO_HASH="7da8d6d9f8baf8621af4ec2af5a00f00"