squeezebox-googlemusic icon indicating copy to clipboard operation
squeezebox-googlemusic copied to clipboard

Music Never Plays, no log output :(

Open clark0r opened this issue 10 years ago • 23 comments

When I try and play a track (from my library or from All Access) it goes from stopped, to playing, to stopped again all in a matter of 1 second. No music ever plays.

My Google Music account is set up, and when I clicked apply it populated the device ID field automagically.

There is no output in the server.log when this happens.

Here are my vitals: Logitech Media Server (v7.7.3, 1375965195, Mon Aug 19 11:38:30 PDT 2013) perl 5.010001 CentOS 6.5 (Linux lb 2.6.32-431.23.3.el6.x86_64 #1 SMP Thu Jul 31 17:20:51 UTC 2014 x86_64 x86_64 x86_64 GNU/Linux) python-2.6.6-52.el6.x86_64 python-devel-2.6.6-52.el6.x86_64 App::cpanminus is up to date (1.7004). Inline is up to date. (0.68) Inline::Python is up to date. (0.43)

Also installed the Unofficial Google Music API @develop.

Any help?

clark0r avatar Aug 13 '14 19:08 clark0r

It is quite possible that this is related to issue #43 and #44. An updated version of LMS could help.

hechtus avatar Aug 20 '14 11:08 hechtus

I think I am experiencing the same issue.
Can you suggest a nightly that has worked so I can look at downgrading. I am running; Logitech Media Server Version: 7.8.1 - 1410526679 @ Sat Sep 13 02:58:16 UTC 2014 on a PI B+ playing to a Squeezebox Touch. Radio etc is playing fine.

I installed on my squeezeplug installation using the following sudo apt-get update sudo apt-get install python-pip sudo pip install gmusicapi pip install git+https://github.com/simon-weber/Unoff...PI.git@develop sudo apt-get install python-dev sudo cpan App::cpanminus sudo cpanm --notest Inline sudo cpanm --notest Inline::Python

and installed the plugin from the repository.

DannyKudos avatar Sep 15 '14 10:09 DannyKudos

You should not downgrade, but upgrade LMS. Every version that is past Jun 11 2014 should fix this. See https://github.com/Logitech/slimserver/commit/380a05ae269f6c963a27691437139cac317d4e70 on this.

hechtus avatar Sep 15 '14 10:09 hechtus

Thanks for the swift reply. I am running Logitech Media Server Version: 7.8.1 - 1410526679 @ Sat Sep 13 Is my problem a different issue ?

DannyKudos avatar Sep 15 '14 10:09 DannyKudos

Possibly, yes. Could you please check the file I referenced above in your LMS installation? Could you please check if the modification is already in there?

hechtus avatar Sep 15 '14 11:09 hechtus

I will this evening when I get home.
Do I just open this file on the SD card with a text editor ?

DannyKudos avatar Sep 15 '14 11:09 DannyKudos

It looks like the modification is already there. BTW.. am trying to play on a squeezebox "Touch" player

file     => main::LOCALFILE ? qw(Slim::Player::Protocols::LocalFile) : qw(Slim::Player::Protocols::File),
http     => qw(Slim::Player::Protocols::HTTP),
https    => qw(Slim::Player::Protocols::HTTP),
icy      => qw(Slim::Player::Protocols::HTTP),
mms      => qw(Slim::Player::Protocols::MMS),
spdr     => qw(Slim::Player::Protocols::SqueezePlayDirect),

DannyKudos avatar Sep 15 '14 21:09 DannyKudos

OK. Thanks for checking. So, this is not related to issue #43 and #44. Do you have something in the LMS logfile? It should be located under '''/var/log/squeezeboxserver/server.log'''. A snipped from this file may be helpful.

hechtus avatar Sep 16 '14 08:09 hechtus

BTW, your setup works with other music services, like radio and local files?

hechtus avatar Sep 16 '14 08:09 hechtus

The setup works fine with Spotify and radio (Iplayer). I hadn't bothered with local files as my whole music library is on Google Music. I can add some local files for testing purposes if you like. Should I set any setting in logging to create a useful log file ?

DannyKudos avatar Sep 16 '14 10:09 DannyKudos

Log of this evenings activity below. There are a few re-boots while I tried to set the Google Music plugin logging to "debug". (the later log entries at the bottom are with this set). Let me know if I should set any other logging settings.

squeezeboxserver_safe started. [14-09-16 21:33:55.6197] main::init (368) Starting Logitech Media Server (v7.8.1, 1410526679, Sat Sep 13 02:58:16 UTC 2014) perl 5.014002 [14-09-16 21:33:59.4838] Slim::Utils::SQLiteHelper::postConnect (359) Optimizing DB because of missing or empty sqlite_stat1 table [14-09-16 21:36:28.2929] main::checkDataSource (1089) Warning: Schema updated or no media found in the database, initiating scan. [14-09-16 21:57:55.4797] Slim::bootstrap::sigterm (415) Got sigterm 2014-09-16 21:57:55 squeezeboxserver_safe stopped. [14-09-16 21:57:55.5347] Slim::Utils::PluginManager::shutdownPlugins (404) Shutting down plugins... [14-09-16 21:57:59.2176] Slim::bootstrap::sigterm (415) Got sigterm [14-09-16 21:57:59.2230] Slim::Schema::forceCommit (2125) Warning: Trying to commit transactions before DB is initialized! [14-09-16 21:57:59.2386] Slim::Utils::PluginManager::shutdownPlugins (404) Shutting down plugins... [14-09-16 21:57:59.3359] Slim::bootstrap::theEND (439) Got to the END 2014-09-16 21:58:17 squeezeboxserver_safe started. [14-09-16 21:59:01.9368] main::init (368) Starting Logitech Media Server (v7.8.1, 1410526679, Sat Sep 13 02:58:16 UTC 2014) perl 5.014002 [14-09-16 21:59:01.9937] main::init (397) OS Specific init... [14-09-16 21:59:01.9993] main::init (444) Server settings effective user and group if requested... [14-09-16 21:59:02.0042] main::init (461) Server binary search path init... [14-09-16 21:59:02.0154] main::init (465) Server PluginManager init... [14-09-16 21:59:02.0753] Slim::Utils::PluginDownloader::init (42) downloading to /var/lib/squeezeboxserver/cache/DownloadedPlugins [14-09-16 21:59:02.0800] Slim::Utils::PluginDownloader::init (43) extracting to /var/lib/squeezeboxserver/cache/InstalledPlugins [14-09-16 21:59:02.0856] Slim::Utils::PluginManager::_loadPluginCache (594) Loading plugin cache file. [14-09-16 21:59:02.1573] Slim::Utils::PluginManager::_loadPluginCache (603) Cache Info: { bin => "/usr/sbin", count => 53, mtimesum => "74731971349", osArch => "armv7l-linux", osType => "Linux", revision => "1410526679", server => "7.8.1", version => 4, } [14-09-16 21:59:02.1624] Slim::Utils::PluginManager::_loadPluginCache (605) Amazon [14-09-16 21:59:02.1671] Slim::Utils::PluginManager::_loadPluginCache (605) AppGallery [14-09-16 21:59:02.1717] Slim::Utils::PluginManager::_loadPluginCache (605) AudioScrobbler [14-09-16 21:59:02.1761] Slim::Utils::PluginManager::_loadPluginCache (605) BBCiPlayer [14-09-16 21:59:02.1809] Slim::Utils::PluginManager::_loadPluginCache (605) CLI [14-09-16 21:59:02.1853] Slim::Utils::PluginManager::_loadPluginCache (605) Classical [14-09-16 21:59:02.1900] Slim::Utils::PluginManager::_loadPluginCache (605) DateTime [14-09-16 21:59:02.1946] Slim::Utils::PluginManager::_loadPluginCache (605) Deezer [14-09-16 21:59:02.1992] Slim::Utils::PluginManager::_loadPluginCache (605) DigitalInput [14-09-16 21:59:02.2039] Slim::Utils::PluginManager::_loadPluginCache (605) Extensions [14-09-16 21:59:02.2084] Slim::Utils::PluginManager::_loadPluginCache (605) Favorites [14-09-16 21:59:02.2130] Slim::Utils::PluginManager::_loadPluginCache (605) Flickr [14-09-16 21:59:02.2176] Slim::Utils::PluginManager::_loadPluginCache (605) GoogleMusic [14-09-16 21:59:02.2238] Slim::Utils::PluginManager::_loadPluginCache (605) ImageBrowser [14-09-16 21:59:02.2285] Slim::Utils::PluginManager::_loadPluginCache (605) InfoBrowser [14-09-16 21:59:02.2329] Slim::Utils::PluginManager::_loadPluginCache (605) InternetRadio [14-09-16 21:59:02.2376] Slim::Utils::PluginManager::_loadPluginCache (605) JiveExtras [14-09-16 21:59:02.2422] Slim::Utils::PluginManager::_loadPluginCache (605) LMA [14-09-16 21:59:02.2468] Slim::Utils::PluginManager::_loadPluginCache (605) LastFM [14-09-16 21:59:02.2517] Slim::Utils::PluginManager::_loadPluginCache (605) LineIn [14-09-16 21:59:02.2565] Slim::Utils::PluginManager::_loadPluginCache (605) LineOut [14-09-16 21:59:02.2612] Slim::Utils::PluginManager::_loadPluginCache (605) Live365 [14-09-16 21:59:02.2656] Slim::Utils::PluginManager::_loadPluginCache (605) MOG [14-09-16 21:59:02.2703] Slim::Utils::PluginManager::_loadPluginCache (605) MP3tunes [14-09-16 21:59:02.2748] Slim::Utils::PluginManager::_loadPluginCache (605) MusicMagic [14-09-16 21:59:02.2794] Slim::Utils::PluginManager::_loadPluginCache (605) MyApps [14-09-16 21:59:02.2840] Slim::Utils::PluginManager::_loadPluginCache (605) NetTest [14-09-16 21:59:02.2885] Slim::Utils::PluginManager::_loadPluginCache (605) OPMLGeneric [14-09-16 21:59:02.2931] Slim::Utils::PluginManager::_loadPluginCache (605) Orange [14-09-16 21:59:02.2977] Slim::Utils::PluginManager::_loadPluginCache (605) Pandora [14-09-16 21:59:02.3023] Slim::Utils::PluginManager::_loadPluginCache (605) Podcast [14-09-16 21:59:02.3069] Slim::Utils::PluginManager::_loadPluginCache (605) RS232 [14-09-16 21:59:02.3114] Slim::Utils::PluginManager::_loadPluginCache (605) RSSNews [14-09-16 21:59:02.3160] Slim::Utils::PluginManager::_loadPluginCache (605) RadioIO [14-09-16 21:59:02.3205] Slim::Utils::PluginManager::_loadPluginCache (605) RadioTime [14-09-16 21:59:02.3251] Slim::Utils::PluginManager::_loadPluginCache (605) RandomPlay [14-09-16 21:59:02.3298] Slim::Utils::PluginManager::_loadPluginCache (605) Rescan [14-09-16 21:59:02.3344] Slim::Utils::PluginManager::_loadPluginCache (605) RhapsodyDirect [14-09-16 21:59:02.3390] Slim::Utils::PluginManager::_loadPluginCache (605) SN [14-09-16 21:59:02.3435] Slim::Utils::PluginManager::_loadPluginCache (605) SavePlaylist [14-09-16 21:59:02.3482] Slim::Utils::PluginManager::_loadPluginCache (605) Sirius [14-09-16 21:59:02.3526] Slim::Utils::PluginManager::_loadPluginCache (605) Slacker [14-09-16 21:59:02.3573] Slim::Utils::PluginManager::_loadPluginCache (605) SlimTris [14-09-16 21:59:02.3618] Slim::Utils::PluginManager::_loadPluginCache (605) Snow [14-09-16 21:59:02.3664] Slim::Utils::PluginManager::_loadPluginCache (605) SongScanner [14-09-16 21:59:02.3710] Slim::Utils::PluginManager::_loadPluginCache (605) Sounds [14-09-16 21:59:02.3755] Slim::Utils::PluginManager::_loadPluginCache (605) Spotify [14-09-16 21:59:02.3802] Slim::Utils::PluginManager::_loadPluginCache (605) SpotifyLogi [14-09-16 21:59:02.3846] Slim::Utils::PluginManager::_loadPluginCache (605) UPnP [14-09-16 21:59:02.3892] Slim::Utils::PluginManager::_loadPluginCache (605) Visualizer [14-09-16 21:59:02.3937] Slim::Utils::PluginManager::_loadPluginCache (605) WiMP [14-09-16 21:59:02.3984] Slim::Utils::PluginManager::_loadPluginCache (605) iTunes [14-09-16 21:59:02.4030] Slim::Utils::PluginManager::_loadPluginCache (605) xPL [14-09-16 21:59:03.2878] main::init (468) Server strings init... [14-09-16 21:59:03.3204] Slim::Utils::Strings::loadStrings (123) Retrieving string data from string cache: /var/lib/squeezeboxserver/cache/stringcache.armv7l-linux.bin [14-09-16 21:59:03.3906] Slim::Utils::Strings::storeString (376) redefined string: RADIOTIME_LOCAL in [14-09-16 21:59:03.3954] Slim::Utils::Strings::storeString (376) redefined string: RADIOTIME_WORLD in [14-09-16 21:59:03.4009] Slim::Utils::Strings::storeString (376) redefined string: INTERNET_RADIO in [14-09-16 21:59:03.4056] Slim::Utils::Strings::storeString (376) redefined string: RADIOTIME_SEARCH in [14-09-16 21:59:03.4220] main::init (480) Server SQL init (Slim::Utils::SQLiteHelper)... [14-09-16 21:59:03.4275] main::init (484) Async DNS init... [14-09-16 21:59:03.4319] main::init (487) Async HTTP init... [14-09-16 21:59:03.4421] main::init (491) SqueezeNetwork Init... [14-09-16 21:59:03.4474] main::init (494) Firmware init... [14-09-16 21:59:03.4576] main::init (497) Server Info init... [14-09-16 21:59:05.0862] main::init (500) Server IR init... [14-09-16 21:59:05.3502] main::init (503) Server Request init... [14-09-16 21:59:05.4831] main::init (506) Server Queries init... [14-09-16 21:59:05.4887] main::init (509) Server Buttons init... [14-09-16 21:59:05.5084] main::init (517) UDP init... [14-09-16 21:59:05.5214] main::init (520) Slimproto Init... [14-09-16 21:59:05.5295] main::init (523) Cache init... [14-09-16 21:59:06.1517] Slim::Utils::SQLiteHelper::postConnect (359) Optimizing DB because of missing or empty sqlite_stat1 table [14-09-16 21:59:08.6223] main::init (544) Server HTTP init... [14-09-16 21:59:09.6906] main::init (548) Source conversion init.. [14-09-16 21:59:09.8483] main::init (554) Server Web Settings init... [14-09-16 21:59:10.3845] main::init (559) Menu init... [14-09-16 21:59:10.4182] main::init (570) Server Alarms init... [14-09-16 21:59:10.4228] main::init (574) Server Load Plugins... [14-09-16 21:59:10.4282] Slim::Utils::PluginManager::load (241) Loading plugin: Amazon [14-09-16 21:59:10.7036] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Amazon/HTML] [14-09-16 21:59:10.7089] Slim::Utils::PluginManager::load (241) Loading plugin: AppGallery [14-09-16 21:59:10.7281] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/AppGallery/HTML] [14-09-16 21:59:10.7333] Slim::Utils::PluginManager::load (241) Loading plugin: AudioScrobbler [14-09-16 21:59:10.9422] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/AudioScrobbler/HTML] [14-09-16 21:59:10.9474] Slim::Utils::PluginManager::load (241) Loading plugin: BBCiPlayer [14-09-16 21:59:11.0753] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/BBCiPlayer/HTML] [14-09-16 21:59:11.0804] Slim::Utils::PluginManager::load (241) Loading plugin: CLI [14-09-16 21:59:11.2170] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/CLI/HTML] [14-09-16 21:59:11.2220] Slim::Utils::PluginManager::load (241) Loading plugin: Classical [14-09-16 21:59:11.3000] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Classical/HTML] [14-09-16 21:59:11.3049] Slim::Utils::PluginManager::load (241) Loading plugin: DateTime [14-09-16 21:59:11.3712] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/DateTime/HTML] [14-09-16 21:59:11.3762] Slim::Utils::PluginManager::load (241) Loading plugin: Deezer [14-09-16 21:59:11.4932] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Deezer/HTML] [14-09-16 21:59:11.4984] Slim::Utils::PluginManager::load (241) Loading plugin: DigitalInput [14-09-16 21:59:11.5554] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/DigitalInput/HTML] [14-09-16 21:59:11.5604] Slim::Utils::PluginManager::load (241) Loading plugin: Extensions [14-09-16 21:59:11.6995] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Extensions/HTML] [14-09-16 21:59:11.7045] Slim::Utils::PluginManager::load (241) Loading plugin: Favorites [14-09-16 21:59:11.9742] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Favorites/HTML] [14-09-16 21:59:11.9796] Slim::Utils::PluginManager::load (241) Loading plugin: Flickr [14-09-16 21:59:12.0141] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Flickr/HTML] [14-09-16 21:59:12.0192] Slim::Utils::PluginManager::load (241) Loading plugin: GoogleMusic [14-09-16 21:59:19.3974] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/GoogleMusic/HTML] [14-09-16 21:59:19.4027] Slim::Utils::PluginManager::load (241) Loading plugin: ImageBrowser [14-09-16 21:59:19.4554] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/ImageBrowser/HTML] [14-09-16 21:59:19.4606] Slim::Utils::PluginManager::load (241) Loading plugin: InfoBrowser [14-09-16 21:59:19.5270] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/InfoBrowser/HTML] [14-09-16 21:59:19.5322] Slim::Utils::PluginManager::load (241) Loading plugin: InternetRadio [14-09-16 21:59:19.7243] Slim::Utils::PluginManager::load (241) Loading plugin: JiveExtras [14-09-16 21:59:19.7897] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/JiveExtras/HTML] [14-09-16 21:59:19.7948] Slim::Utils::PluginManager::load (241) Loading plugin: LMA [14-09-16 21:59:19.8174] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/LMA/HTML] [14-09-16 21:59:19.8226] Slim::Utils::PluginManager::load (241) Loading plugin: LastFM [14-09-16 21:59:19.9377] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/LastFM/HTML] [14-09-16 21:59:19.9429] Slim::Utils::PluginManager::load (241) Loading plugin: LineIn [14-09-16 21:59:20.0043] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/LineIn/HTML] [14-09-16 21:59:20.0096] Slim::Utils::PluginManager::load (230) Skipping plugin: LineOut - disabled [14-09-16 21:59:20.0150] Slim::Utils::PluginManager::load (241) Loading plugin: Live365 [14-09-16 21:59:20.0817] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Live365/HTML] [14-09-16 21:59:20.0870] Slim::Utils::PluginManager::load (241) Loading plugin: MOG [14-09-16 21:59:20.2245] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/MOG/HTML] [14-09-16 21:59:20.2299] Slim::Utils::PluginManager::load (241) Loading plugin: MP3tunes [14-09-16 21:59:20.2680] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/MP3tunes/HTML] [14-09-16 21:59:20.2735] Slim::Utils::PluginManager::load (230) Skipping plugin: MusicMagic - disabled [14-09-16 21:59:20.2789] Slim::Utils::PluginManager::load (241) Loading plugin: MyApps [14-09-16 21:59:20.3071] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/MyApps/HTML] [14-09-16 21:59:20.3122] Slim::Utils::PluginManager::load (241) Loading plugin: NetTest [14-09-16 21:59:20.3940] Slim::Utils::PluginManager::load (241) Loading plugin: OPMLGeneric [14-09-16 21:59:20.4182] Slim::Utils::PluginManager::load (241) Loading plugin: Orange [14-09-16 21:59:20.4793] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Orange/HTML] [14-09-16 21:59:20.4845] Slim::Utils::PluginManager::load (241) Loading plugin: Pandora [14-09-16 21:59:20.5974] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Pandora/HTML] [14-09-16 21:59:20.6024] Slim::Utils::PluginManager::load (230) Skipping plugin: Podcast - disabled [14-09-16 21:59:20.6078] Slim::Utils::PluginManager::load (230) Skipping plugin: RS232 - disabled [14-09-16 21:59:20.6127] Slim::Utils::PluginManager::load (241) Loading plugin: RSSNews [14-09-16 21:59:20.7277] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/RSSNews/HTML] [14-09-16 21:59:20.7330] Slim::Utils::PluginManager::load (241) Loading plugin: RadioIO [14-09-16 21:59:20.7689] Slim::Utils::PluginManager::load (241) Loading plugin: RadioTime [14-09-16 21:59:20.7854] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/RadioTime/HTML] [14-09-16 21:59:20.7908] Slim::Utils::PluginManager::load (241) Loading plugin: RandomPlay [14-09-16 21:59:20.9593] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/RandomPlay/HTML] [14-09-16 21:59:20.9644] Slim::Utils::PluginManager::load (241) Loading plugin: Rescan [14-09-16 21:59:21.0584] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Rescan/HTML] [14-09-16 21:59:21.0636] Slim::Utils::PluginManager::load (241) Loading plugin: RhapsodyDirect [14-09-16 21:59:21.2358] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/RhapsodyDirect/HTML] [14-09-16 21:59:21.2411] Slim::Utils::PluginManager::load (241) Loading plugin: SN [14-09-16 21:59:21.3036] Slim::Utils::PluginManager::load (241) Loading plugin: SavePlaylist [14-09-16 21:59:21.3548] Slim::Utils::PluginManager::load (241) Loading plugin: Sirius [14-09-16 21:59:21.4408] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Sirius/HTML] [14-09-16 21:59:21.4460] Slim::Utils::PluginManager::load (241) Loading plugin: Slacker [14-09-16 21:59:21.5785] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Slacker/HTML] [14-09-16 21:59:21.5837] Slim::Utils::PluginManager::load (230) Skipping plugin: SlimTris - disabled [14-09-16 21:59:21.5889] Slim::Utils::PluginManager::load (230) Skipping plugin: Snow - disabled [14-09-16 21:59:21.5936] Slim::Utils::PluginManager::load (241) Loading plugin: SongScanner [14-09-16 21:59:21.6650] Slim::Utils::PluginManager::load (241) Loading plugin: Sounds [14-09-16 21:59:21.7014] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Sounds/HTML] [14-09-16 21:59:21.7067] Slim::Utils::PluginManager::load (241) Loading plugin: Spotify [14-09-16 21:59:22.9992] Slim::Utils::PluginManager::load (345) Adding Bin directory: [/var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/Spotify/Bin] [14-09-16 21:59:23.0051] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/Spotify/HTML] [14-09-16 21:59:23.0105] Slim::Utils::PluginManager::load (230) Skipping plugin: SpotifyLogi - disabled [14-09-16 21:59:23.0154] Slim::Utils::PluginManager::load (241) Loading plugin: UPnP [14-09-16 21:59:23.0443] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/UPnP/HTML] [14-09-16 21:59:23.0496] Slim::Utils::PluginManager::load (241) Loading plugin: Visualizer [14-09-16 21:59:23.0949] Slim::Utils::PluginManager::load (241) Loading plugin: WiMP [14-09-16 21:59:23.2013] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/WiMP/HTML] [14-09-16 21:59:23.2067] Slim::Utils::PluginManager::load (230) Skipping plugin: iTunes - disabled [14-09-16 21:59:23.2115] Slim::Utils::PluginManager::load (230) Skipping plugin: xPL - disabled [14-09-16 22:01:34.8322] Slim::Utils::PluginDownloader::checkForUpdates (241) generating apps query to find latest plugin state [14-09-16 22:01:35.0942] main::init (577) Server Jive init... [14-09-16 22:01:35.1127] main::init (580) Remote Metadata init... [14-09-16 22:01:36.2165] main::init (589) Server checkDataSource... [14-09-16 22:01:36.2249] main::checkDataSource (1089) Warning: Schema updated or no media found in the database, initiating scan. [14-09-16 22:01:36.3997] main::init (599) Library Browser init... [14-09-16 22:01:36.4624] main::init (603) Server persist playlists... [14-09-16 22:01:36.4798] main::init (639) Server HTTP enable... [14-09-16 22:01:36.5053] main::init (647) Server done init... [14-09-16 22:01:36.6295] Slim::Utils::Cache::cleanup (242) Cache purge: cache - 0.000000 sec [14-09-16 22:01:41.3852] Slim::Utils::Strings::storeExtraStrings (413) Reading extrastrings.json file [14-09-16 22:02:10.5972] Slim::Utils::SQLiteHelper::postConnect (359) Optimizing DB because of missing or empty sqlite_stat1 table [14-09-16 22:11:14.3139] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: SongScanner - 'enforce' set in install.xml [14-09-16 22:11:14.3206] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: Sounds - 'enforce' set in install.xml [14-09-16 22:11:14.3292] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: CLI - 'enforce' set in install.xml [14-09-16 22:11:14.3348] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: MyApps - 'enforce' set in install.xml [14-09-16 22:11:14.3405] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: Favorites - 'enforce' set in install.xml [14-09-16 22:11:14.3459] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: Extensions - 'enforce' set in install.xml [14-09-16 22:11:14.3510] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: RadioTime - 'enforce' set in install.xml [14-09-16 22:11:14.3565] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: AppGallery - 'enforce' set in install.xml [14-09-16 22:11:14.3621] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: InternetRadio - 'enforce' set in install.xml [14-09-16 22:11:14.3680] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: OPMLGeneric - 'enforce' set in install.xml [14-09-16 22:11:58.8444] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: Sounds - 'enforce' set in install.xml [14-09-16 22:11:58.8517] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: CLI - 'enforce' set in install.xml [14-09-16 22:11:58.8574] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: Favorites - 'enforce' set in install.xml [14-09-16 22:11:58.8625] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: Extensions - 'enforce' set in install.xml [14-09-16 22:11:58.8684] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: InternetRadio - 'enforce' set in install.xml [14-09-16 22:11:58.8739] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: OPMLGeneric - 'enforce' set in install.xml [14-09-16 22:11:58.8793] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: SongScanner - 'enforce' set in install.xml [14-09-16 22:11:58.8867] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: MyApps - 'enforce' set in install.xml [14-09-16 22:11:58.8922] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: RadioTime - 'enforce' set in install.xml [14-09-16 22:11:58.8974] Slim::Utils::PluginManager::disablePlugin (529) Can't disable plugin: AppGallery - 'enforce' set in install.xml [14-09-16 22:11:59.0357] Slim::Utils::PluginDownloader::install (159) install - downloading SrvrPowerCtrl from http://srvrpowerctrl.googlecode.com/svn/SrvrPowerCtrl_beta.zip [14-09-16 22:12:00.9221] Slim::Utils::PluginDownloader::_downloadDone (176) downloaded SrvrPowerCtrl to /var/lib/squeezeboxserver/cache/DownloadedPlugins/SrvrPowerCtrl.zip [14-09-16 22:12:00.9882] Slim::Utils::PluginDownloader::_downloadDone (200) digest matches - scheduling SrvrPowerCtrl for install on restart [14-09-16 22:12:43.1393] Slim::bootstrap::sigterm (415) Got sigterm [14-09-16 22:12:43.1814] Slim::Utils::PluginManager::shutdownPlugins (404) Shutting down plugins... 2014-09-16 22:12:43 squeezeboxserver_safe stopped. [14-09-16 22:12:47.8925] Slim::bootstrap::sigterm (415) Got sigterm [14-09-16 22:12:47.9084] Slim::Schema::forceCommit (2125) Warning: Trying to commit transactions before DB is initialized! [14-09-16 22:12:47.9138] Slim::Utils::PluginManager::shutdownPlugins (404) Shutting down plugins... [14-09-16 22:12:47.9929] Slim::bootstrap::theEND (439) Got to the END 2014-09-16 22:13:04 squeezeboxserver_safe started. [14-09-16 22:13:50.1203] main::init (368) Starting Logitech Media Server (v7.8.1, 1410526679, Sat Sep 13 02:58:16 UTC 2014) perl 5.014002 [14-09-16 22:13:50.1791] main::init (397) OS Specific init... [14-09-16 22:13:50.1845] main::init (444) Server settings effective user and group if requested... [14-09-16 22:13:50.1897] main::init (461) Server binary search path init... [14-09-16 22:13:50.2007] main::init (465) Server PluginManager init... [14-09-16 22:13:50.2617] Slim::Utils::PluginDownloader::init (42) downloading to /var/lib/squeezeboxserver/cache/DownloadedPlugins [14-09-16 22:13:50.2663] Slim::Utils::PluginDownloader::init (43) extracting to /var/lib/squeezeboxserver/cache/InstalledPlugins [14-09-16 22:13:50.2719] Slim::Utils::PluginManager::_loadPluginCache (594) Loading plugin cache file. [14-09-16 22:13:50.3429] Slim::Utils::PluginManager::_loadPluginCache (603) Cache Info: { bin => "/usr/sbin", count => 53, mtimesum => "74731971349", osArch => "armv7l-linux", osType => "Linux", revision => "1410526679", server => "7.8.1", version => 4, } [14-09-16 22:13:50.3479] Slim::Utils::PluginManager::_loadPluginCache (605) Amazon [14-09-16 22:13:50.3525] Slim::Utils::PluginManager::_loadPluginCache (605) AppGallery [14-09-16 22:13:50.3572] Slim::Utils::PluginManager::_loadPluginCache (605) AudioScrobbler [14-09-16 22:13:50.3617] Slim::Utils::PluginManager::_loadPluginCache (605) BBCiPlayer [14-09-16 22:13:50.3663] Slim::Utils::PluginManager::_loadPluginCache (605) CLI [14-09-16 22:13:50.3707] Slim::Utils::PluginManager::_loadPluginCache (605) Classical [14-09-16 22:13:50.3752] Slim::Utils::PluginManager::_loadPluginCache (605) DateTime [14-09-16 22:13:50.3797] Slim::Utils::PluginManager::_loadPluginCache (605) Deezer [14-09-16 22:13:50.3842] Slim::Utils::PluginManager::_loadPluginCache (605) DigitalInput [14-09-16 22:13:50.3890] Slim::Utils::PluginManager::_loadPluginCache (605) Extensions [14-09-16 22:13:50.3934] Slim::Utils::PluginManager::_loadPluginCache (605) Favorites [14-09-16 22:13:50.3981] Slim::Utils::PluginManager::_loadPluginCache (605) Flickr [14-09-16 22:13:50.4025] Slim::Utils::PluginManager::_loadPluginCache (605) GoogleMusic [14-09-16 22:13:50.4071] Slim::Utils::PluginManager::_loadPluginCache (605) ImageBrowser [14-09-16 22:13:50.4116] Slim::Utils::PluginManager::_loadPluginCache (605) InfoBrowser [14-09-16 22:13:50.4162] Slim::Utils::PluginManager::_loadPluginCache (605) InternetRadio [14-09-16 22:13:50.4206] Slim::Utils::PluginManager::_loadPluginCache (605) JiveExtras [14-09-16 22:13:50.4251] Slim::Utils::PluginManager::_loadPluginCache (605) LMA [14-09-16 22:13:50.4298] Slim::Utils::PluginManager::_loadPluginCache (605) LastFM [14-09-16 22:13:50.4342] Slim::Utils::PluginManager::_loadPluginCache (605) LineIn [14-09-16 22:13:50.4387] Slim::Utils::PluginManager::_loadPluginCache (605) LineOut [14-09-16 22:13:50.4432] Slim::Utils::PluginManager::_loadPluginCache (605) Live365 [14-09-16 22:13:50.4478] Slim::Utils::PluginManager::_loadPluginCache (605) MOG [14-09-16 22:13:50.4522] Slim::Utils::PluginManager::_loadPluginCache (605) MP3tunes [14-09-16 22:13:50.4569] Slim::Utils::PluginManager::_loadPluginCache (605) MusicMagic [14-09-16 22:13:50.4614] Slim::Utils::PluginManager::_loadPluginCache (605) MyApps [14-09-16 22:13:50.4658] Slim::Utils::PluginManager::_loadPluginCache (605) NetTest [14-09-16 22:13:50.4705] Slim::Utils::PluginManager::_loadPluginCache (605) OPMLGeneric [14-09-16 22:13:50.4749] Slim::Utils::PluginManager::_loadPluginCache (605) Orange [14-09-16 22:13:50.4795] Slim::Utils::PluginManager::_loadPluginCache (605) Pandora [14-09-16 22:13:50.4839] Slim::Utils::PluginManager::_loadPluginCache (605) Podcast [14-09-16 22:13:50.4885] Slim::Utils::PluginManager::_loadPluginCache (605) RS232 [14-09-16 22:13:50.4930] Slim::Utils::PluginManager::_loadPluginCache (605) RSSNews [14-09-16 22:13:50.4976] Slim::Utils::PluginManager::_loadPluginCache (605) RadioIO [14-09-16 22:13:50.5021] Slim::Utils::PluginManager::_loadPluginCache (605) RadioTime [14-09-16 22:13:50.5066] Slim::Utils::PluginManager::_loadPluginCache (605) RandomPlay [14-09-16 22:13:50.5112] Slim::Utils::PluginManager::_loadPluginCache (605) Rescan [14-09-16 22:13:50.5157] Slim::Utils::PluginManager::_loadPluginCache (605) RhapsodyDirect [14-09-16 22:13:50.5204] Slim::Utils::PluginManager::_loadPluginCache (605) SN [14-09-16 22:13:50.5248] Slim::Utils::PluginManager::_loadPluginCache (605) SavePlaylist [14-09-16 22:13:50.5294] Slim::Utils::PluginManager::_loadPluginCache (605) Sirius [14-09-16 22:13:50.5339] Slim::Utils::PluginManager::_loadPluginCache (605) Slacker [14-09-16 22:13:50.5384] Slim::Utils::PluginManager::_loadPluginCache (605) SlimTris [14-09-16 22:13:50.5429] Slim::Utils::PluginManager::_loadPluginCache (605) Snow [14-09-16 22:13:50.5475] Slim::Utils::PluginManager::_loadPluginCache (605) SongScanner [14-09-16 22:13:50.5520] Slim::Utils::PluginManager::_loadPluginCache (605) Sounds [14-09-16 22:13:50.5565] Slim::Utils::PluginManager::_loadPluginCache (605) Spotify [14-09-16 22:13:50.5611] Slim::Utils::PluginManager::_loadPluginCache (605) SpotifyLogi [14-09-16 22:13:50.5656] Slim::Utils::PluginManager::_loadPluginCache (605) UPnP [14-09-16 22:13:50.5701] Slim::Utils::PluginManager::_loadPluginCache (605) Visualizer [14-09-16 22:13:50.5746] Slim::Utils::PluginManager::_loadPluginCache (605) WiMP [14-09-16 22:13:50.5791] Slim::Utils::PluginManager::_loadPluginCache (605) iTunes [14-09-16 22:13:50.5837] Slim::Utils::PluginManager::_loadPluginCache (605) xPL [14-09-16 22:13:52.8510] Slim::Utils::PluginDownloader::extract (124) extracted SrvrPowerCtrl to /var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/SrvrPowerCtrl [14-09-16 22:13:53.7866] Slim::Utils::PluginManager::init (169) Reparsing plugin manifests - processed pending operations [14-09-16 22:13:54.2092] Slim::Utils::PluginManager::_parseInstallManifest (772) GoogleMusic [Plugins::GoogleMusic::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:54.2375] Slim::Utils::PluginManager::_parseInstallManifest (772) Spotify [Plugins::Spotify::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:54.2675] Slim::Utils::PluginManager::_parseInstallManifest (772) SrvrPowerCtrl [Plugins::SrvrPowerCtrl::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:54.2994] Slim::Utils::PluginManager::_parseInstallManifest (772) BBCiPlayer [Plugins::BBCiPlayer::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.3354] Slim::Utils::PluginManager::_parseInstallManifest (772) Amazon [Slim::Plugin::Amazon::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.3632] Slim::Utils::PluginManager::_parseInstallManifest (772) SN [Slim::Plugin::SN::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.3922] Slim::Utils::PluginManager::_parseInstallManifest (772) xPL [Slim::Plugin::xPL::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.4202] Slim::Utils::PluginManager::_parseInstallManifest (772) Sirius [Slim::Plugin::Sirius::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.4490] Slim::Utils::PluginManager::_parseInstallManifest (772) RSSNews [Slim::Plugin::RSSNews::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.4772] Slim::Utils::PluginManager::_parseInstallManifest (772) RhapsodyDirect [Slim::Plugin::RhapsodyDirect::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.5047] Slim::Utils::PluginManager::_parseInstallManifest (772) WiMP [Slim::Plugin::WiMP::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.5328] Slim::Utils::PluginManager::_parseInstallManifest (772) MP3tunes [Slim::Plugin::MP3tunes::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.5607] Slim::Utils::PluginManager::_parseInstallManifest (772) Flickr [Slim::Plugin::Flickr::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.5878] Slim::Utils::PluginManager::_parseInstallManifest (772) JiveExtras [Slim::Plugin::JiveExtras::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.6166] Slim::Utils::PluginManager::_parseInstallManifest (772) AppGallery [Slim::Plugin::AppGallery::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.6463] Slim::Utils::PluginManager::_parseInstallManifest (772) Favorites [Slim::Plugin::Favorites::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.6740] Slim::Utils::PluginManager::_parseInstallManifest (772) LastFM [Slim::Plugin::LastFM::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.7020] Slim::Utils::PluginManager::_parseInstallManifest (772) SavePlaylist [Slim::Plugin::SavePlaylist::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.7306] Slim::Utils::PluginManager::_parseInstallManifest (772) DateTime [Slim::Plugin::DateTime::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.7592] Slim::Utils::PluginManager::_parseInstallManifest (772) Sounds [Slim::Plugin::Sounds::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.7878] Slim::Utils::PluginManager::_parseInstallManifest (772) LMA [Slim::Plugin::LMA::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.8163] Slim::Utils::PluginManager::_parseInstallManifest (772) RS232 [Slim::Plugin::RS232::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.8444] Slim::Utils::PluginManager::_parseInstallManifest (772) Orange [Slim::Plugin::Orange::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.8724] Slim::Utils::PluginManager::_parseInstallManifest (772) Pandora [Slim::Plugin::Pandora::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.9016] Slim::Utils::PluginManager::_parseInstallManifest (772) Rescan [Slim::Plugin::Rescan::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.9285] Slim::Utils::PluginManager::_parseInstallManifest (772) Extensions [Slim::Plugin::Extensions::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.9560] Slim::Utils::PluginManager::_parseInstallManifest (772) Live365 [Slim::Plugin::Live365::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:55.9841] Slim::Utils::PluginManager::_parseInstallManifest (772) Slacker [Slim::Plugin::Slacker::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.0111] Slim::Utils::PluginManager::_parseInstallManifest (772) RadioIO [Slim::Plugin::RadioIO::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.0395] Slim::Utils::PluginManager::_parseInstallManifest (772) DigitalInput [Slim::Plugin::DigitalInput::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.0678] Slim::Utils::PluginManager::_parseInstallManifest (772) LineIn [Slim::Plugin::LineIn::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.0963] Slim::Utils::PluginManager::_parseInstallManifest (772) Visualizer [Slim::Plugin::Visualizer::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.1237] Slim::Utils::PluginManager::_parseInstallManifest (772) UPnP [Slim::Plugin::UPnP::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.1581] Slim::Utils::PluginManager::_parseInstallManifest (772) MusicMagic [Slim::Plugin::MusicMagic::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.1868] Slim::Utils::PluginManager::_parseInstallManifest (772) AudioScrobbler [Slim::Plugin::AudioScrobbler::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.2145] Slim::Utils::PluginManager::_parseInstallManifest (772) Deezer [Slim::Plugin::Deezer::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.2425] Slim::Utils::PluginManager::_parseInstallManifest (772) InternetRadio [Slim::Plugin::InternetRadio::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.2717] Slim::Utils::PluginManager::_parseInstallManifest (772) CLI [Slim::Plugin::CLI::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.2995] Slim::Utils::PluginManager::_parseInstallManifest (772) Classical [Slim::Plugin::Classical::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.3290] Slim::Utils::PluginManager::_parseInstallManifest (772) RadioTime [Slim::Plugin::RadioTime::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.3569] Slim::Utils::PluginManager::_parseInstallManifest (772) NetTest [Slim::Plugin::NetTest::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.3847] Slim::Utils::PluginManager::_parseInstallManifest (772) Snow [Slim::Plugin::Snow::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.4135] Slim::Utils::PluginManager::_parseInstallManifest (772) InfoBrowser [Slim::Plugin::InfoBrowser::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.4413] Slim::Utils::PluginManager::_parseInstallManifest (772) SlimTris [Slim::Plugin::SlimTris::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.4691] Slim::Utils::PluginManager::_parseInstallManifest (772) SpotifyLogi [Slim::Plugin::SpotifyLogi::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.4982] Slim::Utils::PluginManager::_parseInstallManifest (772) Podcast [Slim::Plugin::Podcast::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.5281] Slim::Utils::PluginManager::_parseInstallManifest (772) iTunes [Slim::Plugin::iTunes::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.5550] Slim::Utils::PluginManager::_parseInstallManifest (772) LineOut [Slim::Plugin::LineOut::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.5837] Slim::Utils::PluginManager::_parseInstallManifest (772) MyApps [Slim::Plugin::MyApps::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.6116] Slim::Utils::PluginManager::_parseInstallManifest (772) SongScanner [Slim::Plugin::SongScanner::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.6395] Slim::Utils::PluginManager::_parseInstallManifest (772) OPMLGeneric [Slim::Plugin::OPMLGeneric::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.6673] Slim::Utils::PluginManager::_parseInstallManifest (772) MOG [Slim::Plugin::MOG::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.6964] Slim::Utils::PluginManager::_parseInstallManifest (772) RandomPlay [Slim::Plugin::RandomPlay::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.7248] Slim::Utils::PluginManager::_parseInstallManifest (772) ImageBrowser [Slim::Plugin::ImageBrowser::Plugin] INSTALLERROR_SUCCESS [14-09-16 22:13:56.7300] Slim::Utils::PluginManager::_writePluginCache (569) Writing out plugin cache file. [14-09-16 22:13:56.7902] main::init (468) Server strings init... [14-09-16 22:13:56.8233] Slim::Utils::Strings::loadStrings (123) Retrieving string data from string cache: /var/lib/squeezeboxserver/cache/stringcache.armv7l-linux.bin [14-09-16 22:13:56.8591] Slim::Utils::Strings::loadStrings (165) String cache contains old data - reparsing string files [14-09-16 22:13:56.8641] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/squeezeboxserver/strings.txt [14-09-16 22:14:02.0264] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/DateTime/strings.txt [14-09-16 22:14:02.0663] Slim::Utils::Strings::loadStrings (185) Loading string file: /var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/BBCiPlayer/strings.txt [14-09-16 22:14:02.0829] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/DigitalInput/strings.txt [14-09-16 22:14:02.1127] Slim::Utils::Strings::loadStrings (185) Loading string file: /var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/SrvrPowerCtrl/strings.txt [14-09-16 22:14:02.2296] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Podcast/strings.txt [14-09-16 22:14:02.2813] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Pandora/strings.txt [14-09-16 22:14:02.5214] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/MP3tunes/strings.txt [14-09-16 22:14:02.5388] Slim::Utils::Strings::loadStrings (185) Loading string file: /var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/Spotify/strings.txt [14-09-16 22:14:02.5601] Slim::Utils::Strings::storeString (376) redefined string: PLUGIN_SPOTIFY_EULA in /var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/Spotify/strings.txt [14-09-16 22:14:02.6654] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/MOG/strings.txt [14-09-16 22:14:02.6791] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/SpotifyLogi/strings.txt [14-09-16 22:14:02.7508] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Snow/strings.txt [14-09-16 22:14:02.8320] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/AppGallery/strings.txt [14-09-16 22:14:02.8697] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/RadioTime/strings.txt [14-09-16 22:14:02.9297] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/WiMP/strings.txt [14-09-16 22:14:02.9537] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Orange/strings.txt [14-09-16 22:14:02.9703] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Extensions/strings.txt [14-09-16 22:14:03.0649] Slim::Utils::Strings::loadStrings (185) Loading string file: /var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/GoogleMusic/strings.txt [14-09-16 22:14:03.1144] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/LMA/strings.txt [14-09-16 22:14:03.1312] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Flickr/strings.txt [14-09-16 22:14:03.1593] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/LineOut/strings.txt [14-09-16 22:14:03.1742] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Favorites/strings.txt [14-09-16 22:14:03.2987] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/UPnP/strings.txt [14-09-16 22:14:03.3124] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/MyApps/strings.txt [14-09-16 22:14:03.3224] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/InfoBrowser/strings.txt [14-09-16 22:14:03.3499] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/LineIn/strings.txt [14-09-16 22:14:03.3819] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Deezer/strings.txt [14-09-16 22:14:03.4116] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/SongScanner/strings.txt [14-09-16 22:14:03.4404] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Amazon/strings.txt [14-09-16 22:14:03.4532] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/InternetRadio/strings.txt [14-09-16 22:14:03.4631] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Live365/strings.txt [14-09-16 22:14:03.4823] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/AudioScrobbler/strings.txt [14-09-16 22:14:03.5837] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Rescan/strings.txt [14-09-16 22:14:03.6372] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/OPMLGeneric/strings.txt [14-09-16 22:14:03.6475] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/NetTest/strings.txt [14-09-16 22:14:03.6704] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/RSSNews/strings.txt [14-09-16 22:14:03.7570] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Visualizer/strings.txt [14-09-16 22:14:03.7739] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/CLI/strings.txt [14-09-16 22:14:03.7968] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Sirius/strings.txt [14-09-16 22:14:03.8270] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/ImageBrowser/strings.txt [14-09-16 22:14:03.8404] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Classical/strings.txt [14-09-16 22:14:03.8631] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/RhapsodyDirect/strings.txt [14-09-16 22:14:03.9428] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/RandomPlay/strings.txt [14-09-16 22:14:04.0605] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/SavePlaylist/strings.txt [14-09-16 22:14:04.0939] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/JiveExtras/strings.txt [14-09-16 22:14:04.1305] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Slacker/strings.txt [14-09-16 22:14:04.1778] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/SN/strings.txt [14-09-16 22:14:04.1915] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/SlimTris/strings.txt [14-09-16 22:14:04.2046] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/xPL/strings.txt [14-09-16 22:14:04.2446] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/LastFM/strings.txt [14-09-16 22:14:04.2867] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/iTunes/strings.txt [14-09-16 22:14:04.3981] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/MusicMagic/strings.txt [14-09-16 22:14:04.5557] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/Sounds/strings.txt [14-09-16 22:14:04.5660] Slim::Utils::Strings::loadStrings (185) Loading string file: /usr/share/perl5/Slim/Plugin/RS232/strings.txt [14-09-16 22:14:04.5852] Slim::Utils::Strings::loadStrings (192) Storing string cache: /var/lib/squeezeboxserver/cache/stringcache.armv7l-linux.bin [14-09-16 22:14:04.6424] Slim::Utils::Strings::storeString (376) redefined string: RADIOTIME_LOCAL in [14-09-16 22:14:04.6476] Slim::Utils::Strings::storeString (376) redefined string: RADIOTIME_WORLD in [14-09-16 22:14:04.6527] Slim::Utils::Strings::storeString (376) redefined string: INTERNET_RADIO in [14-09-16 22:14:04.6578] Slim::Utils::Strings::storeString (376) redefined string: RADIOTIME_SEARCH in [14-09-16 22:14:04.6694] main::init (480) Server SQL init (Slim::Utils::SQLiteHelper)... [14-09-16 22:14:04.6747] main::init (484) Async DNS init... [14-09-16 22:14:04.6795] main::init (487) Async HTTP init... [14-09-16 22:14:04.6899] main::init (491) SqueezeNetwork Init... [14-09-16 22:14:04.6950] main::init (494) Firmware init... [14-09-16 22:14:04.7048] main::init (497) Server Info init... [14-09-16 22:14:06.3318] main::init (500) Server IR init... [14-09-16 22:14:06.5865] main::init (503) Server Request init... [14-09-16 22:14:06.7184] main::init (506) Server Queries init... [14-09-16 22:14:06.7239] main::init (509) Server Buttons init... [14-09-16 22:14:06.7432] main::init (517) UDP init... [14-09-16 22:14:06.7562] main::init (520) Slimproto Init... [14-09-16 22:14:06.7640] main::init (523) Cache init... [14-09-16 22:14:07.3357] Slim::Utils::SQLiteHelper::postConnect (359) Optimizing DB because of missing or empty sqlite_stat1 table [14-09-16 22:14:08.1602] main::init (544) Server HTTP init... [14-09-16 22:14:09.2460] main::init (548) Source conversion init.. [14-09-16 22:14:09.4038] main::init (554) Server Web Settings init... [14-09-16 22:14:09.9409] main::init (559) Menu init... [14-09-16 22:14:09.9751] main::init (570) Server Alarms init... [14-09-16 22:14:09.9798] main::init (574) Server Load Plugins... [14-09-16 22:14:09.9852] Slim::Utils::PluginManager::load (241) Loading plugin: Amazon [14-09-16 22:14:10.2646] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Amazon/HTML] [14-09-16 22:14:10.2698] Slim::Utils::PluginManager::load (241) Loading plugin: AppGallery [14-09-16 22:14:10.2890] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/AppGallery/HTML] [14-09-16 22:14:10.2939] Slim::Utils::PluginManager::load (241) Loading plugin: AudioScrobbler [14-09-16 22:14:10.5103] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/AudioScrobbler/HTML] [14-09-16 22:14:10.5154] Slim::Utils::PluginManager::load (241) Loading plugin: BBCiPlayer [14-09-16 22:14:10.6450] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/BBCiPlayer/HTML] [14-09-16 22:14:10.6503] Slim::Utils::PluginManager::load (241) Loading plugin: CLI [14-09-16 22:14:10.7884] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/CLI/HTML] [14-09-16 22:14:10.7936] Slim::Utils::PluginManager::load (241) Loading plugin: Classical [14-09-16 22:14:10.8708] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Classical/HTML] [14-09-16 22:14:10.8759] Slim::Utils::PluginManager::load (241) Loading plugin: DateTime [14-09-16 22:14:10.9426] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/DateTime/HTML] [14-09-16 22:14:10.9480] Slim::Utils::PluginManager::load (241) Loading plugin: Deezer [14-09-16 22:14:11.0669] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Deezer/HTML] [14-09-16 22:14:11.0721] Slim::Utils::PluginManager::load (241) Loading plugin: DigitalInput [14-09-16 22:14:11.1300] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/DigitalInput/HTML] [14-09-16 22:14:11.1350] Slim::Utils::PluginManager::load (241) Loading plugin: Extensions [14-09-16 22:14:11.2706] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Extensions/HTML] [14-09-16 22:14:11.2757] Slim::Utils::PluginManager::load (241) Loading plugin: Favorites [14-09-16 22:14:11.5482] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Favorites/HTML] [14-09-16 22:14:11.5533] Slim::Utils::PluginManager::load (241) Loading plugin: Flickr [14-09-16 22:14:11.5881] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Flickr/HTML] [14-09-16 22:14:11.5933] Slim::Utils::PluginManager::load (241) Loading plugin: GoogleMusic [14-09-16 22:14:18.8720] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/GoogleMusic/HTML] [14-09-16 22:14:18.8777] Slim::Utils::PluginManager::load (241) Loading plugin: ImageBrowser [14-09-16 22:14:18.9308] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/ImageBrowser/HTML] [14-09-16 22:14:18.9358] Slim::Utils::PluginManager::load (241) Loading plugin: InfoBrowser [14-09-16 22:14:19.0026] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/InfoBrowser/HTML] [14-09-16 22:14:19.0079] Slim::Utils::PluginManager::load (241) Loading plugin: InternetRadio [14-09-16 22:14:19.2005] Slim::Utils::PluginManager::load (241) Loading plugin: JiveExtras [14-09-16 22:14:19.2675] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/JiveExtras/HTML] [14-09-16 22:14:19.2728] Slim::Utils::PluginManager::load (241) Loading plugin: LMA [14-09-16 22:14:19.2956] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/LMA/HTML] [14-09-16 22:14:19.3008] Slim::Utils::PluginManager::load (241) Loading plugin: LastFM [14-09-16 22:14:19.4175] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/LastFM/HTML] [14-09-16 22:14:19.4226] Slim::Utils::PluginManager::load (241) Loading plugin: LineIn [14-09-16 22:14:19.4850] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/LineIn/HTML] [14-09-16 22:14:19.4904] Slim::Utils::PluginManager::load (230) Skipping plugin: LineOut - disabled [14-09-16 22:14:19.4951] Slim::Utils::PluginManager::load (241) Loading plugin: Live365 [14-09-16 22:14:19.5625] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Live365/HTML] [14-09-16 22:14:19.5685] Slim::Utils::PluginManager::load (241) Loading plugin: MOG [14-09-16 22:14:19.7043] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/MOG/HTML] [14-09-16 22:14:19.7096] Slim::Utils::PluginManager::load (241) Loading plugin: MP3tunes [14-09-16 22:14:19.7457] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/MP3tunes/HTML] [14-09-16 22:14:19.7510] Slim::Utils::PluginManager::load (230) Skipping plugin: MusicMagic - disabled [14-09-16 22:14:19.7563] Slim::Utils::PluginManager::load (241) Loading plugin: MyApps [14-09-16 22:14:19.7848] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/MyApps/HTML] [14-09-16 22:14:19.7901] Slim::Utils::PluginManager::load (241) Loading plugin: NetTest [14-09-16 22:14:19.8735] Slim::Utils::PluginManager::load (241) Loading plugin: OPMLGeneric [14-09-16 22:14:19.8977] Slim::Utils::PluginManager::load (241) Loading plugin: Orange [14-09-16 22:14:19.9591] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Orange/HTML] [14-09-16 22:14:19.9644] Slim::Utils::PluginManager::load (241) Loading plugin: Pandora [14-09-16 22:14:20.0789] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Pandora/HTML] [14-09-16 22:14:20.0841] Slim::Utils::PluginManager::load (230) Skipping plugin: Podcast - disabled [14-09-16 22:14:20.0893] Slim::Utils::PluginManager::load (230) Skipping plugin: RS232 - disabled [14-09-16 22:14:20.0945] Slim::Utils::PluginManager::load (241) Loading plugin: RSSNews [14-09-16 22:14:20.2139] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/RSSNews/HTML] [14-09-16 22:14:20.2194] Slim::Utils::PluginManager::load (241) Loading plugin: RadioIO [14-09-16 22:14:20.2550] Slim::Utils::PluginManager::load (241) Loading plugin: RadioTime [14-09-16 22:14:20.2701] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/RadioTime/HTML] [14-09-16 22:14:20.2754] Slim::Utils::PluginManager::load (241) Loading plugin: RandomPlay [14-09-16 22:14:20.4479] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/RandomPlay/HTML] [14-09-16 22:14:20.4532] Slim::Utils::PluginManager::load (241) Loading plugin: Rescan [14-09-16 22:14:20.5476] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Rescan/HTML] [14-09-16 22:14:20.5529] Slim::Utils::PluginManager::load (241) Loading plugin: RhapsodyDirect [14-09-16 22:14:20.7267] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/RhapsodyDirect/HTML] [14-09-16 22:14:20.7320] Slim::Utils::PluginManager::load (241) Loading plugin: SN [14-09-16 22:14:20.7914] Slim::Utils::PluginManager::load (241) Loading plugin: SavePlaylist [14-09-16 22:14:20.8439] Slim::Utils::PluginManager::load (241) Loading plugin: Sirius [14-09-16 22:14:20.9302] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Sirius/HTML] [14-09-16 22:14:20.9354] Slim::Utils::PluginManager::load (241) Loading plugin: Slacker [14-09-16 22:14:21.0693] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Slacker/HTML] [14-09-16 22:14:21.0746] Slim::Utils::PluginManager::load (230) Skipping plugin: SlimTris - disabled [14-09-16 22:14:21.0796] Slim::Utils::PluginManager::load (230) Skipping plugin: Snow - disabled [14-09-16 22:14:21.0846] Slim::Utils::PluginManager::load (241) Loading plugin: SongScanner [14-09-16 22:14:21.1567] Slim::Utils::PluginManager::load (241) Loading plugin: Sounds [14-09-16 22:14:21.1934] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/Sounds/HTML] [14-09-16 22:14:21.1988] Slim::Utils::PluginManager::load (241) Loading plugin: Spotify [14-09-16 22:14:22.5124] Slim::Utils::PluginManager::load (345) Adding Bin directory: [/var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/Spotify/Bin] [14-09-16 22:14:22.5185] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/Spotify/HTML] [14-09-16 22:14:22.5239] Slim::Utils::PluginManager::load (230) Skipping plugin: SpotifyLogi - disabled [14-09-16 22:14:22.5292] Slim::Utils::PluginManager::load (241) Loading plugin: SrvrPowerCtrl [14-09-16 22:14:23.6941] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/var/lib/squeezeboxserver/cache/InstalledPlugins/Plugins/SrvrPowerCtrl/HTML] [14-09-16 22:14:23.6999] Slim::Utils::PluginManager::load (241) Loading plugin: UPnP [14-09-16 22:14:23.7306] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/UPnP/HTML] [14-09-16 22:14:23.7356] Slim::Utils::PluginManager::load (241) Loading plugin: Visualizer [14-09-16 22:14:23.7823] Slim::Utils::PluginManager::load (241) Loading plugin: WiMP [14-09-16 22:14:23.8920] Slim::Utils::PluginManager::load (368) Adding HTML directory: [/usr/share/perl5/Slim/Plugin/WiMP/HTML] [14-09-16 22:14:23.9013] Slim::Utils::PluginManager::load (230) Skipping plugin: iTunes - disabled [14-09-16 22:14:23.9064] Slim::Utils::PluginManager::load (230) Skipping plugin: xPL - disabled [14-09-16 22:16:31.1941] Slim::Utils::PluginDownloader::checkForUpdates (241) generating apps query to find latest plugin state [14-09-16 22:16:31.6810] main::init (577) Server Jive init... [14-09-16 22:16:31.6995] main::init (580) Remote Metadata init... [14-09-16 22:16:32.8166] main::init (589) Server checkDataSource... [14-09-16 22:16:32.8251] main::checkDataSource (1089) Warning: Schema updated or no media found in the database, initiating scan. [14-09-16 22:16:33.7008] main::init (599) Library Browser init... [14-09-16 22:16:33.7771] main::init (603) Server persist playlists... [14-09-16 22:16:33.7845] main::init (639) Server HTTP enable... [14-09-16 22:16:33.8137] main::init (647) Server done init... [14-09-16 22:16:33.9073] Slim::Utils::Cache::cleanup (246) Cache purge: cache - skipping, purged recently [14-09-16 22:16:37.0659] Slim::Utils::Strings::storeExtraStrings (413) Reading extrastrings.json file [14-09-16 22:16:52.5517] Slim::Networking::Discovery::Players::_players_error (146) Unable to get players: Timed out waiting for data [14-09-16 22:16:52.5696] Slim::Networking::Discovery::Players::_players_error (146) Unable to get players: Timed out waiting for data [14-09-16 22:16:52.5880] Slim::Networking::Discovery::Players::_players_error (146) Unable to get players: Connect timed out: Inappropriate ioctl for device [14-09-16 22:16:52.5980] Slim::Networking::Discovery::Players::_players_error (146) Unable to get players: Connect timed out: Inappropriate ioctl for device [14-09-16 22:17:20.5859] Slim::Utils::SQLiteHelper::postConnect (359) Optimizing DB because of missing or empty sqlite_stat1 table [14-09-16 22:18:42.6162] Plugins::GoogleMusic::Image::handler (64) queuing image id: 1 request: lh5.ggpht.com/9eq9MjFZx540mCPHVt3GrdLfrcBeeNmscyrYqLbqwGJ73tNQ4xypH98Y1WedSSdiGl8olvQx (resizing: 1) [14-09-16 22:18:42.6216] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 0 [14-09-16 22:18:42.6272] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh5.ggpht.com/9eq9MjFZx540mCPHVt3GrdLfrcBeeNmscyrYqLbqwGJ73tNQ4xypH98Y1WedSSdiGl8olvQx=s50-c [14-09-16 22:18:42.6649] Plugins::GoogleMusic::Image::handler (64) queuing image id: 2 request: lh4.ggpht.com/wrIubbdQ5hj6aHMXynMV1PwiM2M6FedShYxYQhAFwrpbrm-aGPUs1DM7-9JVF893Ljxg8B2-GA (resizing: 1) [14-09-16 22:18:42.6702] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 1 [14-09-16 22:18:42.6756] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh4.ggpht.com/wrIubbdQ5hj6aHMXynMV1PwiM2M6FedShYxYQhAFwrpbrm-aGPUs1DM7-9JVF893Ljxg8B2-GA=s50-c [14-09-16 22:18:42.7077] Plugins::GoogleMusic::Image::handler (64) queuing image id: 3 request: lh3.ggpht.com/B9W91tSYyJYgcDJx3FauL4p3hrBPu_gF3GBGcE2qQ7hzC8Fi6tzUN0RKsXrQLzNy8gbmx0X-BQ (resizing: 1) [14-09-16 22:18:42.7131] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 2 [14-09-16 22:18:42.7185] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh3.ggpht.com/B9W91tSYyJYgcDJx3FauL4p3hrBPu_gF3GBGcE2qQ7hzC8Fi6tzUN0RKsXrQLzNy8gbmx0X-BQ=s50-c [14-09-16 22:18:42.7487] Plugins::GoogleMusic::Image::handler (64) queuing image id: 4 request: lh4.ggpht.com/hwPCoZ4Iwc9s7Exr-keenvkH1Wn4aPSq1PBtNAAhqKw3Hh9YisJAiadiaf9MwG1q5-VQiNI_Qw (resizing: 1) [14-09-16 22:18:42.7540] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 3 [14-09-16 22:18:42.7601] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh4.ggpht.com/hwPCoZ4Iwc9s7Exr-keenvkH1Wn4aPSq1PBtNAAhqKw3Hh9YisJAiadiaf9MwG1q5-VQiNI_Qw=s50-c [14-09-16 22:18:42.7898] Plugins::GoogleMusic::Image::handler (64) queuing image id: 5 request: lh6.ggpht.com/nGo0ySb-MVXkOKyPwgmejmUkMJUHOJnnTYspUoXIzSTf7moKxs5IVimBdJ6NfPvUdC-7AyDHuw (resizing: 1) [14-09-16 22:18:42.7951] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 4 [14-09-16 22:18:42.8006] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh6.ggpht.com/nGo0ySb-MVXkOKyPwgmejmUkMJUHOJnnTYspUoXIzSTf7moKxs5IVimBdJ6NfPvUdC-7AyDHuw=s50-c [14-09-16 22:18:43.8288] Plugins::GoogleMusic::Image::handler (64) queuing image id: 6 request: lh4.ggpht.com/T0r1T6gNopwVfgUMShKxW13NSHw0n2D7-d6Kst1rIDcNQzw0kDzV1-BEpsn20ndhGgzex-Rj2w (resizing: 1) [14-09-16 22:18:43.8341] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 5 [14-09-16 22:18:45.7541] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh4.ggpht.com/T0r1T6gNopwVfgUMShKxW13NSHw0n2D7-d6Kst1rIDcNQzw0kDzV1-BEpsn20ndhGgzex-Rj2w=s50-c [14-09-16 22:18:46.1973] Plugins::GoogleMusic::Image::handler (64) queuing image id: 7 request: lh3.ggpht.com/L4oHKT0gUsi4q3_tHEPs8Ozp8UinPVMHDSvzNlwwm3LrrP5zgTb2yoqv02uC7IRlsUifKxLhQw (resizing: 1) [14-09-16 22:18:46.2026] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 3 [14-09-16 22:18:46.2081] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh3.ggpht.com/L4oHKT0gUsi4q3_tHEPs8Ozp8UinPVMHDSvzNlwwm3LrrP5zgTb2yoqv02uC7IRlsUifKxLhQw=s50-c [14-09-16 22:18:46.9548] Plugins::GoogleMusic::Image::handler (64) queuing image id: 8 request: lh6.ggpht.com/Rs9fwA6UaTavp24qW_KoB-j843ugelh_NNeabddz1lxuhEkuR4uBKyDYf9IfqQMMMBfbx1gHGd8 (resizing: 1) [14-09-16 22:18:46.9630] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 1 [14-09-16 22:18:46.9686] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh6.ggpht.com/Rs9fwA6UaTavp24qW_KoB-j843ugelh_NNeabddz1lxuhEkuR4uBKyDYf9IfqQMMMBfbx1gHGd8=s50-c [14-09-16 22:18:47.3398] Plugins::GoogleMusic::Image::handler (64) queuing image id: 9 request: lh6.ggpht.com/AmQISiKDCz1BDiZvwOKA6gywdH-Vp_fdlWT6qfxc1WXq6OOPlYFfM-LgA512Ipo4CPmCvT0WqQ (resizing: 1) [14-09-16 22:18:47.3451] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 2 [14-09-16 22:18:47.3506] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh6.ggpht.com/AmQISiKDCz1BDiZvwOKA6gywdH-Vp_fdlWT6qfxc1WXq6OOPlYFfM-LgA512Ipo4CPmCvT0WqQ=s50-c [14-09-16 22:18:48.0952] Plugins::GoogleMusic::Image::handler (64) queuing image id: 10 request: lh6.ggpht.com/8DwNL0TUy2xfZppw_oORrAmkgIj-hZ-zGGb0yRJzVK1aKxYu5dEpTuk6FKzNSGSZy_kfwYL0gvk (resizing: 1) [14-09-16 22:18:48.1006] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 3 [14-09-16 22:18:48.1060] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh6.ggpht.com/8DwNL0TUy2xfZppw_oORrAmkgIj-hZ-zGGb0yRJzVK1aKxYu5dEpTuk6FKzNSGSZy_kfwYL0gvk=s50-c [14-09-16 22:18:48.5371] Plugins::GoogleMusic::Image::handler (64) queuing image id: 11 request: lh3.ggpht.com/gJVap9pf8biySgl9MWSd55V48WuqslhT_k1QEsVa42Iiv-YfzAWJ6fznaW16ZSP_QYWol0PyNJg (resizing: 1) [14-09-16 22:18:48.5424] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 4 [14-09-16 22:18:48.5479] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh3.ggpht.com/gJVap9pf8biySgl9MWSd55V48WuqslhT_k1QEsVa42Iiv-YfzAWJ6fznaW16ZSP_QYWol0PyNJg=s50-c [14-09-16 22:18:49.2464] Plugins::GoogleMusic::Image::handler (64) queuing image id: 12 request: lh3.ggpht.com/0U5zj3pknW6VbK5qYE3fcXk-Ptj0RDAh_nlfQHpLyOfcL_kMxR_O1rpUW6ikl8SQRrq6x7gGHA (resizing: 1) [14-09-16 22:18:49.2518] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 5 [14-09-16 22:18:49.3169] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh3.ggpht.com/0U5zj3pknW6VbK5qYE3fcXk-Ptj0RDAh_nlfQHpLyOfcL_kMxR_O1rpUW6ikl8SQRrq6x7gGHA=s50-c [14-09-16 22:18:49.7710] Plugins::GoogleMusic::Image::handler (64) queuing image id: 13 request: lh5.ggpht.com/7UMFng5J_ETdrXHpKL0Nk-JsKAaXFG7Ja1opxbXxVlxX-Z3_tcgc_fwxJEToKh2n8q9a_V3Hr5A (resizing: 1) [14-09-16 22:18:49.7765] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 5 [14-09-16 22:18:49.8037] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh5.ggpht.com/7UMFng5J_ETdrXHpKL0Nk-JsKAaXFG7Ja1opxbXxVlxX-Z3_tcgc_fwxJEToKh2n8q9a_V3Hr5A=s50-c [14-09-16 22:18:50.6129] Plugins::GoogleMusic::Image::handler (64) queuing image id: 14 request: lh4.ggpht.com/rplyu4f6fBYs-3-JgaXwqG8N326FR_dBP6-0p1ZitbWM8KITc3qdRS8FBM79_fOMEEtx9oQp (resizing: 1) [14-09-16 22:18:50.6188] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 1 [14-09-16 22:18:50.6247] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh4.ggpht.com/rplyu4f6fBYs-3-JgaXwqG8N326FR_dBP6-0p1ZitbWM8KITc3qdRS8FBM79_fOMEEtx9oQp=s50-c [14-09-16 22:18:50.8133] Plugins::GoogleMusic::Image::handler (64) queuing image id: 15 request: lh3.ggpht.com/7D9AUJHQxCfZ2DyHZVyVZQzWAU4drqsZ6UbWY-d8CjEvUWsL3SZBAota3y8xab2QfCVcBFjrSas (resizing: 1) [14-09-16 22:18:50.8187] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 2 [14-09-16 22:18:50.8248] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh3.ggpht.com/7D9AUJHQxCfZ2DyHZVyVZQzWAU4drqsZ6UbWY-d8CjEvUWsL3SZBAota3y8xab2QfCVcBFjrSas=s50-c [14-09-16 22:18:51.5650] Plugins::GoogleMusic::Image::handler (64) queuing image id: 16 request: lh6.ggpht.com/9UnyLGFO50z249Arq3HkDsn7gWHvTY5HPPgZ3X62zxb3iybiuBMzeRJmy4RnT7T7RuYBQrTx (resizing: 1) [14-09-16 22:18:51.5704] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 3 [14-09-16 22:18:51.5757] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh6.ggpht.com/9UnyLGFO50z249Arq3HkDsn7gWHvTY5HPPgZ3X62zxb3iybiuBMzeRJmy4RnT7T7RuYBQrTx=s50-c [14-09-16 22:18:51.9430] Plugins::GoogleMusic::Image::handler (64) queuing image id: 17 request: lh4.ggpht.com/eX4HdkqPOxxMovQgVS27owSdJdycTNRdEnA4I1ZFyb5sEQ8fbzftuMW6B_moqKGWabY-iV592Lo (resizing: 1) [14-09-16 22:18:51.9485] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 4 [14-09-16 22:18:51.9539] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh4.ggpht.com/eX4HdkqPOxxMovQgVS27owSdJdycTNRdEnA4I1ZFyb5sEQ8fbzftuMW6B_moqKGWabY-iV592Lo=s50-c [14-09-16 22:18:52.7094] Plugins::GoogleMusic::Image::handler (64) queuing image id: 18 request: lh3.ggpht.com/1GPh2e5jBh42T_92yEc9sNFHtRuMBcMtn-IrSccaAuIhNf1-JXKEG4Ia0YH4BQ30Fttage6E6JM (resizing: 1) [14-09-16 22:18:52.7148] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 5 [14-09-16 22:18:52.7895] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh3.ggpht.com/1GPh2e5jBh42T_92yEc9sNFHtRuMBcMtn-IrSccaAuIhNf1-JXKEG4Ia0YH4BQ30Fttage6E6JM=s50-c [14-09-16 22:18:58.0379] Plugins::GoogleMusic::Image::handler (64) queuing image id: 19 request: lh6.ggpht.com/dSAnrlOLJHxW763D-dWUEVXg7i27my0Kd5YAQhvyrwYMa0pG-2tuSijDvhgAL2UvMm-UYjFI (resizing: 1) [14-09-16 22:18:58.0471] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 4 [14-09-16 22:18:58.0525] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh6.ggpht.com/dSAnrlOLJHxW763D-dWUEVXg7i27my0Kd5YAQhvyrwYMa0pG-2tuSijDvhgAL2UvMm-UYjFI=s50-c [14-09-16 22:18:58.7319] Plugins::GoogleMusic::Image::handler (64) queuing image id: 20 request: lh6.ggpht.com/8DwNL0TUy2xfZppw_oORrAmkgIj-hZ-zGGb0yRJzVK1aKxYu5dEpTuk6FKzNSGSZy_kfwYL0gvk (resizing: 1) [14-09-16 22:18:58.7372] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 5 [14-09-16 22:18:58.7783] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh6.ggpht.com/8DwNL0TUy2xfZppw_oORrAmkgIj-hZ-zGGb0yRJzVK1aKxYu5dEpTuk6FKzNSGSZy_kfwYL0gvk=s150-c [14-09-16 22:18:59.6292] Plugins::GoogleMusic::Image::handler (64) queuing image id: 21 request: lh6.ggpht.com/eVmTVGMZW64rsdvWEg4HnqWfNa-7ntmiO5vIuEM9s37RxXZQGmDu7zwcj3I (resizing: 1) [14-09-16 22:18:59.6346] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 5 [14-09-16 22:18:59.6460] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh6.ggpht.com/eVmTVGMZW64rsdvWEg4HnqWfNa-7ntmiO5vIuEM9s37RxXZQGmDu7zwcj3I=s50-c [14-09-16 22:19:10.3697] Slim::Player::Squeezebox::stream_s (821) This player supports direct streaming for https://sj.googleusercontent.com/stream?id=1a3d46c7551f7983&itag=25&source=skyjam_user_upload&begin=0&o=05555025930601694187&ip=0.0.0.0&ipbits=0&expire=1410902440&sparams=id,itag,source,o,ip,ipbits,expire&signature=9730E9BD73AAE098F92E49DE65B39E32B0329CFA.41E4A7E4C536ECD2BF7802423892F59026332B02&key=sj3 as https://sj.googleusercontent.com/stream?id=1a3d46c7551f7983&itag=25&source=skyjam_user_upload&begin=0&o=05555025930601694187&ip=0.0.0.0&ipbits=0&expire=1410902440&sparams=id,itag,source,o,ip,ipbits,expire&signature=9730E9BD73AAE098F92E49DE65B39E32B0329CFA.41E4A7E4C536ECD2BF7802423892F59026332B02&key=sj3, let's do it. [14-09-16 22:19:10.5412] Slim::Player::Squeezebox::stream_s (847) Made synchronous DNS request for sj.googleusercontent.com (0.15 ms) [14-09-16 22:19:10.5680] Slim::Player::Squeezebox::stream_s (868) setting up direct stream (2915192452:443) autostart: 3 format: m. [14-09-16 22:19:10.5731] Slim::Player::Squeezebox::stream_s (869) request string: GET /stream?id=1a3d46c7551f7983&itag=25&source=skyjam_user_upload&begin=0&o=05555025930601694187&ip=0.0.0.0&ipbits=0&expire=1410902440&sparams=id,itag,source,o,ip,ipbits,expire&signature=9730E9BD73AAE098F92E49DE65B39E32B0329CFA.41E4A7E4C536ECD2BF7802423892F59026332B02&key=sj3 HTTP/1.0 Cache-Control: no-cache Connection: close Accept: / Host: sj.googleusercontent.com:443 User-Agent: iTunes/4.7.1 (Linux; N; Debian; armv7l-linux; EN; utf8) SqueezeCenter, Squeezebox Server, Logitech Media Server/7.8.1/1410526679 Icy-Metadata: 1

[14-09-16 22:19:11.0088] Plugins::GoogleMusic::Radio::commandCallback (268) [playlist play] slave source: [14-09-16 22:19:11.2508] Plugins::GoogleMusic::Image::handler (64) queuing image id: 22 request: lh3.ggpht.com/ZgOAF6RVbdgTQwg-1rBDH5MNzYlLZ9pYUv2Hm7PwjS4KrBbr5TGYNmJ3A_al (resizing: 1) [14-09-16 22:19:11.2562] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 0 [14-09-16 22:19:11.2616] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh3.ggpht.com/ZgOAF6RVbdgTQwg-1rBDH5MNzYlLZ9pYUv2Hm7PwjS4KrBbr5TGYNmJ3A_al=s96-c [14-09-16 22:19:12.1109] Plugins::GoogleMusic::Radio::commandCallback (268) [playlist load_done] slave source: [14-09-16 22:19:12.1378] Plugins::GoogleMusic::Radio::commandCallback (268) [playlist newsong] slave source: [14-09-16 22:19:12.2964] Plugins::GoogleMusic::Image::handler (64) queuing image id: 23 request: lh3.ggpht.com/ZgOAF6RVbdgTQwg-1rBDH5MNzYlLZ9pYUv2Hm7PwjS4KrBbr5TGYNmJ3A_al (resizing: 1) [14-09-16 22:19:12.3017] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 1 [14-09-16 22:19:12.3072] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh3.ggpht.com/ZgOAF6RVbdgTQwg-1rBDH5MNzYlLZ9pYUv2Hm7PwjS4KrBbr5TGYNmJ3A_al=s50-c [14-09-16 22:19:12.4446] Plugins::GoogleMusic::Image::handler (64) queuing image id: 24 request: lh5.ggpht.com/s55B-wktNnn1VGqRRb-qcrl3ej8nOxlgA-eCgJo6GVprUsrdt9RIUJ20CyBd6g (resizing: 1) [14-09-16 22:19:12.4500] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 2 [14-09-16 22:19:12.4554] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh5.ggpht.com/s55B-wktNnn1VGqRRb-qcrl3ej8nOxlgA-eCgJo6GVprUsrdt9RIUJ20CyBd6g=s50-c [14-09-16 22:19:13.8228] Plugins::GoogleMusic::Image::handler (64) queuing image id: 25 request: lh5.ggpht.com/s55B-wktNnn1VGqRRb-qcrl3ej8nOxlgA-eCgJo6GVprUsrdt9RIUJ20CyBd6g (resizing: 1) [14-09-16 22:19:13.8282] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 0 [14-09-16 22:19:13.8336] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh5.ggpht.com/s55B-wktNnn1VGqRRb-qcrl3ej8nOxlgA-eCgJo6GVprUsrdt9RIUJ20CyBd6g=s190-c [14-09-16 22:19:14.3195] Plugins::GoogleMusic::Image::handler (64) queuing image id: 26 request: lh3.ggpht.com/ZgOAF6RVbdgTQwg-1rBDH5MNzYlLZ9pYUv2Hm7PwjS4KrBbr5TGYNmJ3A_al (resizing: 1) [14-09-16 22:19:14.9866] Plugins::GoogleMusic::Image::handler (70) fetchQ: 1 fetching: 1 [14-09-16 22:19:14.9921] Plugins::GoogleMusic::Image::_fetch (126) fetching image: lh3.ggpht.com/ZgOAF6RVbdgTQwg-1rBDH5MNzYlLZ9pYUv2Hm7PwjS4KrBbr5TGYNmJ3A_al=s190-c

DannyKudos avatar Sep 16 '14 21:09 DannyKudos

I'm seeing something very similar here since upgrading to 7.7.4 - 1410420843 yesterday. Log output is almost identical and the stream just sits there doing nothing. Very weird.

elfez avatar Sep 17 '14 10:09 elfez

Glad its not just me...

DannyKudos avatar Sep 17 '14 10:09 DannyKudos

I believe the issue was introduced by this commit: https://github.com/Logitech/slimserver/commit/f0995da0e5cfc86e3b6de3c1b718b2a1770402c1

I'm running the latest 7.9 version from git and reverting that specific commit solves the problem for me.

redlulz avatar Sep 17 '14 14:09 redlulz

Yup, reverting that fixes the problem. Thanks for that!

elfez avatar Sep 17 '14 14:09 elfez

Do I just find that file and change that line ?

DannyKudos avatar Sep 17 '14 14:09 DannyKudos

Wow! Thank you guys!

@mherger: Could you please have a look why this line breaks the google music plugin?

hechtus avatar Sep 17 '14 14:09 hechtus

Hmm... I've been investigating some issues playing streams over https. One of the reasons was that that we'd always connect to port 80 instead of 443 for https. Above change should have fixed this.

Unfortunately there are more serious issues playing https streams. But some services seem to be happy to stream unsecured anyway. Therefore falling back to port 80 even for https seems to have somehow worked.

I'll revert that change until we've figured out streaming over https. Thanks for the heads-up!

mherger avatar Sep 17 '14 14:09 mherger

Just changed that line in Slim/Utils/Misc.pm on my installation and all works ! AMAZING !!! Thanks for sorting this.

DannyKudos avatar Sep 17 '14 22:09 DannyKudos

Great news! @mherger just removed the culprit:

https://github.com/Logitech/slimserver/commit/565f073421edc808789c771c73a629ac59a4a0a8

So, the upcoming LMS nightly builds should work again.

Thank you all for sorting this out!

hechtus avatar Sep 18 '14 09:09 hechtus

Hmmm, I'm running 7.8.0 - 1395409907, which always uses port 80 for https, and I'm experiencing the same problem (no audio but everything else works), so I think there is still something more to sort out. Is there any information I should give that would be useful? Should I upgrade to the 4.09 nightly? Any other suggestions?

mspertus avatar Sep 21 '14 14:09 mspertus

Upgrading to the latest 7.9 nightly did the trick. I'm working now! Thanks!

mspertus avatar Sep 21 '14 18:09 mspertus

@mspertus Great! Thanks for letting us know.

hechtus avatar Sep 22 '14 07:09 hechtus