After some searching, I tried turning on debug mode 'd-source' and I
finally got some results in the log file.

Here's what I get when playing a .m4a non-DRM file from iTunes Plus
(audio plays normally via Squeezebox):

2007-06-16 15:43:17.8141 openSong on:
file:///Volumes/media/Music/The%20Specials/01%20A%20Message%20to%20You%20Rudy.m4a
2007-06-16 15:43:17.8149 openSong: duration: [173] size: [5521993]
endian [] offset: [0] for
file:///Volumes/media/Music/The%20Specials/01%20A%20Message%20to%20You%20Rudy.m4a
2007-06-16 15:43:17.8159 undermax = 1, type = mov, squeezebox2 =
00:04:20:06:f5:db
2007-06-16 15:43:17.8161 checking formats for:
mov-wma-squeezebox2-00:04:20:06:f5:db
2007-06-16 15:43:17.8162 checking formats for:
mov-wma-*-00:04:20:06:f5:db
2007-06-16 15:43:17.8162 checking formats for: mov-wma-squeezebox2-*
2007-06-16 15:43:17.8163 checking formats for: mov-wma-*-*
2007-06-16 15:43:17.8163 checking formats for:
mov-ogg-squeezebox2-00:04:20:06:f5:db
2007-06-16 15:43:17.8163 checking formats for:
mov-ogg-*-00:04:20:06:f5:db
2007-06-16 15:43:17.8164 checking formats for: mov-ogg-squeezebox2-*
2007-06-16 15:43:17.8164 checking formats for: mov-ogg-*-*
2007-06-16 15:43:17.8165 checking formats for:
mov-flc-squeezebox2-00:04:20:06:f5:db
2007-06-16 15:43:17.8165 checking formats for:
mov-flc-*-00:04:20:06:f5:db
2007-06-16 15:43:17.8166 checking formats for: mov-flc-squeezebox2-*
2007-06-16 15:43:17.8166 checking formats for: mov-flc-*-*
2007-06-16 15:43:17.8167 Checking to see if mov-flc-*-* is enabled
2007-06-16 15:43:17.8168    enabled
2007-06-16 15:43:17.8169   Found command: [mov123] $FILE$ | [flac] -cs
--totally-silent --compression-level-0 --endian big --sign signed
--channels 2 --bps 16 --sample-rate 44100 -
2007-06-16 15:43:17.8170 Matched Format: flc Type: mov Command:
[mov123] $FILE$ | [flac] -cs --totally-silent --compression-level-0
--endian big --sign signed --channels 2 --bps 16 --sample-rate 44100 -

2007-06-16 15:43:17.8171 openSong: this is an mov file:
file:///Volumes/media/Music/The%20Specials/01%20A%20Message%20to%20You%20Rudy.m4a
2007-06-16 15:43:17.8171   file type: mov format: flc inrate: 249
maxRate: 0
2007-06-16 15:43:17.8172   command: [mov123] $FILE$ | [flac] -cs
--totally-silent --compression-level-0 --endian big --sign signed
--channels 2 --bps 16 --sample-rate 44100 -
2007-06-16 15:43:17.8180 Using command for conversion:
"/Library/PreferencePanes/SlimServer.prefPane/Contents/server/Bin/darwin/mov123"
"/Volumes/media/Music/The Specials/01 A Message to You Rudy.m4a" |
"/Library/PreferencePanes/SlimServer.prefPane/Contents/server/Bin/darwin/flac"
-cs --totally-silent --compression-level-0 --endian big --sign signed
--channels 2 --bps 16 --sample-rate 44100 - & |
2007-06-16 15:43:17.8259 openSong: Streaming with format: flc
2007-06-16 15:43:17.8433 00:04:20:06:f5:db New play mode: play
2007-06-16 15:43:17.8526 00:04:20:06:f5:db: Current playmode: play
2007-06-16 15:43:18.2232 Got a track starting event
2007-06-16 15:43:18.2237 Song 0 has now started playing
2007-06-16 15:43:18.2254 Song queue is now 0

---*****----
End of dump
---*****----

Here's what I see when trying to play a problem song (cues normally but
no audio or progress):

2007-06-16 15:44:18.7734 openSong on:
file:///Volumes/media/Music/The%20English%20Beat/Beat%20This!%20The%20Best%20of%20The%20English%20Beat/01%20Mirror%20In%20The%20Bathroom.m4a
2007-06-16 15:44:18.7741 openSong: duration: [186] size: [18837676]
endian [] offset: [0] for
file:///Volumes/media/Music/The%20English%20Beat/Beat%20This!%20The%20Best%20of%20The%20English%20Beat/01%20Mirror%20In%20The%20Bathroom.m4a
2007-06-16 15:44:18.7747 undermax = 1, type = mov, squeezebox2 =
00:04:20:06:f5:db
2007-06-16 15:44:18.7749 getConvertCommand: track is alac - updating
type!
2007-06-16 15:44:18.7750 checking formats for:
alc-wma-squeezebox2-00:04:20:06:f5:db
2007-06-16 15:44:18.7750 checking formats for:
alc-wma-*-00:04:20:06:f5:db
2007-06-16 15:44:18.7750 checking formats for: alc-wma-squeezebox2-*
2007-06-16 15:44:18.7751 checking formats for: alc-wma-*-*
2007-06-16 15:44:18.7751 checking formats for:
alc-ogg-squeezebox2-00:04:20:06:f5:db
2007-06-16 15:44:18.7752 checking formats for:
alc-ogg-*-00:04:20:06:f5:db
2007-06-16 15:44:18.7752 checking formats for: alc-ogg-squeezebox2-*
2007-06-16 15:44:18.7753 checking formats for: alc-ogg-*-*
2007-06-16 15:44:18.7753 checking formats for:
alc-flc-squeezebox2-00:04:20:06:f5:db
2007-06-16 15:44:18.7754 checking formats for:
alc-flc-*-00:04:20:06:f5:db
2007-06-16 15:44:18.7754 checking formats for: alc-flc-squeezebox2-*
2007-06-16 15:44:18.7754 checking formats for: alc-flc-*-*
2007-06-16 15:44:18.7755 Checking to see if alc-flc-*-* is enabled
2007-06-16 15:44:18.7756    enabled
2007-06-16 15:44:18.7756   Found command: [alac] $FILE$ | [flac] -cs
--totally-silent --compression-level-0 --endian big --sign signed
--channels 2 --bps 16 --sample-rate 44100 -
2007-06-16 15:44:18.7757 Matched Format: flc Type: alc Command: [alac]
$FILE$ | [flac] -cs --totally-silent --compression-level-0 --endian big
--sign signed --channels 2 --bps 16 --sample-rate 44100 - 
2007-06-16 15:44:18.7758 openSong: this is an alc file:
file:///Volumes/media/Music/The%20English%20Beat/Beat%20This!%20The%20Best%20of%20The%20English%20Beat/01%20Mirror%20In%20The%20Bathroom.m4a
2007-06-16 15:44:18.7758   file type: alc format: flc inrate: 790
maxRate: 0
2007-06-16 15:44:18.7759   command: [alac] $FILE$ | [flac] -cs
--totally-silent --compression-level-0 --endian big --sign signed
--channels 2 --bps 16 --sample-rate 44100 -
2007-06-16 15:44:18.7766 Using command for conversion:
"/Library/PreferencePanes/SlimServer.prefPane/Contents/server/Bin/darwin/alac"
"/Volumes/media/Music/The English Beat/Beat This! The Best of The
English Beat/01 Mirror In The Bathroom.m4a" |
"/Library/PreferencePanes/SlimServer.prefPane/Contents/server/Bin/darwin/flac"
-cs --totally-silent --compression-level-0 --endian big --sign signed
--channels 2 --bps 16 --sample-rate 44100 - & |
2007-06-16 15:44:18.7848 openSong: Streaming with format: flc
2007-06-16 15:44:18.7965 00:04:20:06:f5:db New play mode: play
2007-06-16 15:44:18.8052 00:04:20:06:f5:db: Current playmode: play
2007-06-16 15:44:18.9100 Read to end of file or pipe
2007-06-16 15:44:18.9103 end of file or error on socket, opening next
song, (song pos: 4186(tell says: . ), totalbytes: 0)
2007-06-16 15:44:18.9104 opening next song...
2007-06-16 15:44:18.9106 00:04:20:06:f5:db: Switching to mode
playout-stop from play
2007-06-16 15:44:18.9108 00:04:20:06:f5:db New play mode: playout-stop
2007-06-16 15:44:18.9113 00:04:20:06:f5:db: Current playmode:
playout-stop
2007-06-16 15:44:18.9114 No pending chunks - we're dropping the
streaming connection
2007-06-16 15:44:18.9132 00:04:20:06:f5:db: Can't opennext, returning
no chunk.
2007-06-16 15:44:18.9227 00:04:20:06:f5:db: Decoder underrun while this
mode: playout-stop
2007-06-16 15:44:18.9228 the next song is number 0, was 0


-- 
forddonald
------------------------------------------------------------------------
forddonald's Profile: http://forums.slimdevices.com/member.php?userid=11991
View this thread: http://forums.slimdevices.com/showthread.php?t=36131

_______________________________________________
discuss mailing list
[email protected]
http://lists.slimdevices.com/lists/listinfo/discuss

Reply via email to