Feb 25 18:42:33 volumio ntpd[1070]: CLOCK: time stepped by 252607.452379 Feb 25 18:42:33 volumio ntpd[1070]: CLOCK: time changed from 2026-02-22 to 2026-02-25 Feb 25 18:42:33 volumio ntpd[1070]: INIT: MRU 13107 entries, 13 hash bits, 32768 bytes Feb 25 18:42:33 volumio systemd[1]: Starting dpkg-db-backup.service - Daily dpkg database backup service... Feb 25 18:42:33 volumio systemd[1]: Started ntpsec-rotate-stats.service - Rotate ntpd stats. Feb 25 18:42:33 volumio systemd[1]: ntpsec-rotate-stats.service: Deactivated successfully. Feb 25 18:42:33 volumio systemd[1]: dpkg-db-backup.service: Deactivated successfully. Feb 25 18:42:33 volumio systemd[1]: Finished dpkg-db-backup.service - Daily dpkg database backup service. Feb 25 18:42:34 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 17. Feb 25 18:42:34 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon. Feb 25 18:42:34 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon. Feb 25 18:42:34 volumio go-librespot[2297]: go-librespot daemon starting... Feb 25 18:42:34 volumio go-librespot[2298]: time="2026-02-25T18:42:34+01:00" level=info msg="running go-librespot 0.4.0" Feb 25 18:42:34 volumio go-librespot[2298]: time="2026-02-25T18:42:34+01:00" level=debug msg="app state loaded" Feb 25 18:42:34 volumio go-librespot[2298]: time="2026-02-25T18:42:34+01:00" level=info msg="api server listening on 127.0.0.1:9879" Feb 25 18:42:34 volumio go-librespot[2298]: time="2026-02-25T18:42:34+01:00" level=debug msg="fetched new accesspoints: [ap-gew1.spotify.com:4070 ap-gew1.spotify.com:443 ap-gew1.spotify.com:80 ap-gue1.spotify.com:4070 ap-gew4.spotify.com:443 ap-gae2.spotify.com:80]" Feb 25 18:42:34 volumio go-librespot[2298]: time="2026-02-25T18:42:34+01:00" level=debug msg="fetched new dealers: [gew1-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gew4-dealer.spotify.com:443 gae2-dealer.spotify.com:443]" Feb 25 18:42:34 volumio go-librespot[2298]: time="2026-02-25T18:42:34+01:00" level=debug msg="fetched new spclients: [gew1-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gew4-spclient.spotify.com:443 gae2-spclient.spotify.com:443]" Feb 25 18:42:34 volumio go-librespot[2298]: time="2026-02-25T18:42:34+01:00" level=info msg="zeroconf server listening on port 45815" Feb 25 18:42:34 volumio go-librespot[2298]: time="2026-02-25T18:42:34+01:00" level=debug msg="obtained new client token: AABTPfYrR51OFZqbkp8UmN9BxkqGt1dBtGTjvLgAOOnDpbo6xjYJiFODoequsrxuNra04PbCtISFMK+NxeIVIgxb67TRO0XV5Y9GqTkU/eiVBjOYB+CbaoYL1zy0dSxpAtfkYR0oBSb1yfMo7sYi3hA7w1xQj3sT33i7D1/fnQhz+KYrJqnfRwYg9wRA/sOVTh7DnXeUSrY7fOlVZg8gQnI/yYPvSKFvOOlA9An3ws+F4akyHFM+xoGo" Feb 25 18:42:34 volumio go-librespot[2298]: time="2026-02-25T18:42:34+01:00" level=debug msg="connected to ap-gew1.spotify.com:4070" Feb 25 18:42:34 volumio go-librespot[2298]: time="2026-02-25T18:42:34+01:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with stored credentials: failed performing keyexchange: failed reading APResponseMessage message: failed reading message length: EOF" Feb 25 18:42:34 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE Feb 25 18:42:34 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'. Feb 25 18:42:35 volumio volumio[1175]: info: [MyVolumio PluginManager] Streaming Services plugin successfully loaded Feb 25 18:42:35 volumio volumio[1175]: info: [MyVolumio PluginManager] Starting plugin music_service.streaming_services Feb 25 18:42:35 volumio volumio[1175]: info: Streaming services startup Feb 25 18:42:35 volumio volumio[1175]: info: Starting Streaming Daemon Feb 25 18:42:35 volumio volumio[1175]: info: [MyVolumio PluginManager] Streaming Services plugin successfully started Feb 25 18:42:35 volumio sudo[2306]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/systemctl restart volumio-streaming-daemon.service Feb 25 18:42:35 volumio sudo[2306]: pam_unix(sudo:session): session opened for user root(uid=0) by (uid=1000) Feb 25 18:42:35 volumio sudo[2306]: pam_unix(sudo:session): session closed for user root Feb 25 18:42:35 volumio volumio[1175]: info: Getting Spotify volume Feb 25 18:42:35 volumio volumio[1175]: info: Initializing connection to go-librespot Websocket Feb 25 18:42:35 volumio volumio[1175]: |||||||||||||||||||||||| WARNING: FATAL ERROR ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Feb 25 18:42:35 volumio volumio[1175]: Error: connect ECONNREFUSED 127.0.0.1:9879 Feb 25 18:42:35 volumio volumio[1175]: at TCPConnectWrap.afterConnect [as oncomplete] (node:net:1595:16) { Feb 25 18:42:35 volumio volumio[1175]: errno: -111, Feb 25 18:42:35 volumio volumio[1175]: code: 'ECONNREFUSED', Feb 25 18:42:35 volumio volumio[1175]: syscall: 'connect', Feb 25 18:42:35 volumio volumio[1175]: address: '127.0.0.1', Feb 25 18:42:35 volumio volumio[1175]: port: 9879, Feb 25 18:42:35 volumio volumio[1175]: response: undefined Feb 25 18:42:35 volumio volumio[1175]: } Feb 25 18:42:35 volumio volumio[1175]: ||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||||| Feb 25 18:42:37 volumio systemd[1]: go-librespot-daemon.service: Scheduled restart job, restart counter is at 18. Feb 25 18:42:37 volumio systemd[1]: Stopped go-librespot-daemon.service - go-librespot Daemon. Feb 25 18:42:37 volumio systemd[1]: Started go-librespot-daemon.service - go-librespot Daemon. Feb 25 18:42:38 volumio go-librespot[2325]: go-librespot daemon starting... Feb 25 18:42:38 volumio go-librespot[2326]: time="2026-02-25T18:42:38+01:00" level=info msg="running go-librespot 0.4.0" Feb 25 18:42:38 volumio go-librespot[2326]: time="2026-02-25T18:42:38+01:00" level=debug msg="app state loaded" Feb 25 18:42:38 volumio go-librespot[2326]: time="2026-02-25T18:42:38+01:00" level=info msg="api server listening on 127.0.0.1:9879" Feb 25 18:42:38 volumio go-librespot[2326]: time="2026-02-25T18:42:38+01:00" level=debug msg="fetched new accesspoints: [ap-gew1.spotify.com:4070 ap-gew1.spotify.com:443 ap-gew1.spotify.com:80 ap-guc3.spotify.com:4070 ap-gue1.spotify.com:443 ap-gae2.spotify.com:80]" Feb 25 18:42:38 volumio go-librespot[2326]: time="2026-02-25T18:42:38+01:00" level=debug msg="fetched new dealers: [gew1-dealer.spotify.com:443 guc3-dealer.spotify.com:443 gue1-dealer.spotify.com:443 gae2-dealer.spotify.com:443]" Feb 25 18:42:38 volumio go-librespot[2326]: time="2026-02-25T18:42:38+01:00" level=debug msg="fetched new spclients: [gew1-spclient.spotify.com:443 guc3-spclient.spotify.com:443 gue1-spclient.spotify.com:443 gae2-spclient.spotify.com:443]" Feb 25 18:42:38 volumio go-librespot[2326]: time="2026-02-25T18:42:38+01:00" level=info msg="zeroconf server listening on port 33435" Feb 25 18:42:38 volumio go-librespot[2326]: time="2026-02-25T18:42:38+01:00" level=debug msg="obtained new client token: AABpFt0bI3ATHihnJeoITDIjbF+tVJSiZTQdc0wue/8Iq62rHJeoIablg27XpXyow/983QPSsLVMEu4ZHJZuKxgc9+JuW1GPT7br87zKgq6rE0nExlHatf/ZOWoy98fveZuFmYg0r1L1hXhZkQN6llAtZzO5j44/p2x6zIEJtd7a9jIJL5EHsOGBnHogfHKtP1A8ezOZCpZwmSxVj/kQUUlLLm57AvftQLo6FZ2QYYLbev+I4TdVvv3n" Feb 25 18:42:38 volumio go-librespot[2326]: time="2026-02-25T18:42:38+01:00" level=debug msg="connected to ap-gew1.spotify.com:4070" Feb 25 18:42:38 volumio go-librespot[2326]: time="2026-02-25T18:42:38+01:00" level=fatal msg="failed running with username and spotify token" error="failed authenticating accesspoint with stored credentials: failed performing keyexchange: failed reading APResponseMessage message: failed reading message length: EOF" Feb 25 18:42:38 volumio systemd[1]: go-librespot-daemon.service: Main process exited, code=exited, status=1/FAILURE Feb 25 18:42:38 volumio systemd[1]: go-librespot-daemon.service: Failed with result 'exit-code'. Feb 25 18:42:39 volumio sudo[2349]: volumio : PWD=/ ; USER=root ; COMMAND=/bin/journalctl '--since=2026-02-25 18:41' Feb 25 18:42:39 volumio sudo[2349]: 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="a78d359cf1dc63ac74e9d151015afd30d31a709a" VOLUMIO_FE_VERSION="35f8f4439f0076a62fefa72fd80b70701b3d6cbd" VOLUMIO_FE3_VERSION="bcca17b6b6b26edfb999e6fd7da1b222a88a61d2" VOLUMIO_BE_VERSION="c1ffe93b2136013fc1b5903a4ed7e3f34e0a7bec" VOLUMIO_ARCH="arm" VOLUMIO_VARIANT="volumio" VOLUMIO_TEST="FALSE" VOLUMIO_BUILD_DATE="Thu Feb 5 14:07:07 UTC 2026" VOLUMIO_VERSION="4.096" VOLUMIO_HARDWARE="pi" VOLUMIO_DEVICENAME="Raspberry Pi" VOLUMIO_HASH="5e37060f9823263a753eb5e84030104f"