Hi again,
I just can’t get it to work… Reminder: setup is mopidy on a RasPi B+ (now upgraded to Jessie), controlled by upmpdcli on the same machine. UPnP control software is BubbleUPnP running on an Android tablet.
I purged mopidy and upmpdcli as well as all its dependencies (as identified by deborphan), re-installed both packages, configured them, and still I get errors like the following when asking mopidy (via BubbleUPnP via upmpdcli) to play a song served by a minidlna server running on my desktop:
DEBUG 2015-09-10 21:13:49,413 [1741:MpdSession-10] mopidy.mpd.session
Request from [::ffff:127.0.0.1]:47911: status
DEBUG 2015-09-10 21:13:49,459 [1741:MpdSession-10] mopidy.mpd.session
Response to [::ffff:127.0.0.1]:47911:
volume: 100
repeat: 0
random: 0
single: 0
consume: 0
playlist: 1
playlistlength: 0
xfade: 0
state: stop
OK
DEBUG 2015-09-10 21:13:49,471 [1741:MpdSession-10] mopidy.mpd.session
Request from [::ffff:127.0.0.1]:47911: playlistinfo
DEBUG 2015-09-10 21:13:49,483 [1741:MpdSession-10] mopidy.mpd.session
Response to [::ffff:127.0.0.1]:47911: OK
DEBUG 2015-09-10 21:13:49,495 [1741:MpdSession-10] mopidy.mpd.session
Request from [::ffff:127.0.0.1]:47911: addid "http://192.168.0.7:8200/MediaItems/114355.mp3" "0"
DEBUG 2015-09-10 21:13:50,408 [1741:Core-6] mopidy.core.tracklist
Triggering event: tracklist_changed()
DEBUG 2015-09-10 21:13:50,416 [1741:MainThread] mopidy.listener
Sending tracklist_changed to CoreListener: {}
DEBUG 2015-09-10 21:13:50,422 [1741:MpdSession-10] mopidy.mpd.session
Response to [::ffff:127.0.0.1]:47911:
Id: 0
OK
DEBUG 2015-09-10 21:13:50,448 [1741:MpdSession-10] mopidy.mpd.session
Request from [::ffff:127.0.0.1]:47911: addtagid "0" "Artist" "Kraftwerk"
DEBUG 2015-09-10 21:13:50,462 [1741:MpdSession-10] mopidy.mpd.session
Response to [::ffff:127.0.0.1]:47911: ACK [0@0] {addtagid} Not implemented
DEBUG 2015-09-10 21:13:50,487 [1741:MpdSession-10] mopidy.internal.network
Client most likely disconnected.
INFO 2015-09-10 21:13:50,495 [1741:MpdSession-11] mopidy.mpd.session
New MPD connection from [::ffff:127.0.0.1]:47918
DEBUG 2015-09-10 21:13:50,508 [1741:MpdSession-11] mopidy.mpd.session
Request from [::ffff:127.0.0.1]:47918: status
DEBUG 2015-09-10 21:13:50,516 [1741:MpdSession-10] mopidy.internal.network
Already stopping: Actor is shutting down.
DEBUG 2015-09-10 21:13:50,570 [1741:MpdSession-11] mopidy.mpd.session
Response to [::ffff:127.0.0.1]:47918:
volume: 100
repeat: 0
random: 0
single: 0
consume: 0
playlist: 2
playlistlength: 1
xfade: 0
state: stop
OK
DEBUG 2015-09-10 21:13:50,582 [1741:MpdSession-11] mopidy.mpd.session
Request from [::ffff:127.0.0.1]:47918: status
DEBUG 2015-09-10 21:13:50,626 [1741:MpdSession-11] mopidy.mpd.session
Response to [::ffff:127.0.0.1]:47918:
volume: 100
repeat: 0
random: 0
single: 0
consume: 0
playlist: 2
playlistlength: 1
xfade: 0
state: stop
OK
DEBUG 2015-09-10 21:13:50,634 [1741:MpdSession-11] mopidy.mpd.session
Request from [::ffff:127.0.0.1]:47918: status
DEBUG 2015-09-10 21:13:50,680 [1741:MpdSession-11] mopidy.mpd.session
Response to [::ffff:127.0.0.1]:47918:
volume: 100
repeat: 0
random: 0
single: 0
consume: 0
playlist: 2
playlistlength: 1
xfade: 0
state: stop
OK
DEBUG 2015-09-10 21:13:50,689 [1741:MpdSession-11] mopidy.mpd.session
Request from [::ffff:127.0.0.1]:47918: playlistinfo
DEBUG 2015-09-10 21:13:50,703 [1741:MpdSession-11] mopidy.mpd.session
Response to [::ffff:127.0.0.1]:47918:
file: http://192.168.0.7:8200/MediaItems/114355.mp3
Time: 396
Artist: Kraftwerk
Album: Trans Europa Express
Title: Trans Europa Express
Date: 1977-01-01
Track: 4
Pos: 0
Id: 0
AlbumArtist: Kraftwerk
Genre: Elektronik & Ambient
OK
DEBUG 2015-09-10 21:13:51,077 [1741:MpdSession-11] mopidy.mpd.session
Request from [::ffff:127.0.0.1]:47918: playid "0"
DEBUG 2015-09-10 21:13:51,094 [1741:Core-6] mopidy.core.playback
Changing state: stopped -> playing
DEBUG 2015-09-10 21:13:51,101 [1741:Core-6] mopidy.core.playback
Triggering playback state change event
DEBUG 2015-09-10 21:13:51,108 [1741:MainThread] mopidy.listener
Sending playback_state_changed to CoreListener: {'old_state': u'stopped', 'new_state': u'playing'}
DEBUG 2015-09-10 21:13:51,173 [1741:Audio-2] mopidy.audio.gst
State change to GST_STATE_READY: result=GST_STATE_CHANGE_SUCCESS
DEBUG 2015-09-10 21:13:51,179 [1741:MainThread] mopidy.audio.gst
Got state-changed message: old=GST_STATE_NULL new=GST_STATE_READY pending=GST_STATE_VOID_PENDING
DEBUG 2015-09-10 21:13:56,097 [1741:StreamBackend-3] mopidy.backend
Backend translated URI from http://192.168.0.7:8200/MediaItems/114355.mp3 to None
WARNING 2015-09-10 21:13:56,105 [1741:Core-6] mopidy.core.tracklist
Track is not playable: http://192.168.0.7:8200/MediaItems/114355.mp3
DEBUG 2015-09-10 21:13:56,119 [1741:Audio-2] mopidy.audio.actor
Position query failed
DEBUG 2015-09-10 21:13:56,138 [1741:Audio-2] mopidy.audio.gst
State change to GST_STATE_NULL: result=GST_STATE_CHANGE_SUCCESS
DEBUG 2015-09-10 21:13:56,146 [1741:Core-6] mopidy.core.playback
Changing state: playing -> stopped
DEBUG 2015-09-10 21:13:56,152 [1741:Core-6] mopidy.core.playback
Triggering playback state change event
DEBUG 2015-09-10 21:13:56,160 [1741:MainThread] mopidy.listener
Sending playback_state_changed to CoreListener: {'old_state': u'playing', 'new_state': u'stopped'}
DEBUG 2015-09-10 21:13:56,164 [1741:Core-6] mopidy.core.playback
Triggering track playback ended event
DEBUG 2015-09-10 21:13:56,185 [1741:MainThread] mopidy.listener
Sending track_playback_ended to CoreListener: {'time_position': 0, 'tl_track': TlTrack(tlid=0, track=Track(album=Album(artists=[Artist(name=u'Kraftwerk')], name=u'Trans Europa Express'), artists=[Artist(name=u'Kraftwerk')], bitrate=127739L, date='1977-01-01', genre=u'Elektronik & Ambient', length=396016L, name=u'Trans Europa Express', track_no=4L, uri='http://192.168.0.7:8200/MediaItems/114355.mp3'))}
DEBUG 2015-09-10 21:13:56,194 [1741:MpdSession-11] mopidy.mpd.session
Response to [::ffff:127.0.0.1]:47918: OK
DEBUG 2015-09-10 21:13:56,230 [1741:MpdSession-11] mopidy.mpd.session
Request from [::ffff:127.0.0.1]:47918: status
DEBUG 2015-09-10 21:13:56,278 [1741:MpdSession-11] mopidy.mpd.session
Response to [::ffff:127.0.0.1]:47918:
volume: 100
repeat: 0
random: 0
single: 0
consume: 0
playlist: 2
playlistlength: 1
xfade: 0
state: stop
OK Playback of the same song works flawlessly with the tablet’s local renderer or our smart tv.
mopidy deps says:
Executable: /usr/bin/mopidy
Platform: Linux-4.1.6+-armv6l-with-debian-8.0
Python: CPython 2.7.9 from /usr/lib/python2.7
Mopidy: 1.1.0 from /usr/lib/python2.7/dist-packages
Pykka>=1.1: 1.2.1 from /usr/lib/python2.7/dist-packages
requests: 2.4.3 from /usr/lib/python2.7/dist-packages
tornado>=2.3: 3.2.2 from /usr/lib/python2.7/dist-packages
Mopidy-MusicBox-Webclient: 2.0.0 from /usr/local/lib/python2.7/dist-packages
setuptools: 5.5.1 from /usr/lib/python2.7/dist-packages
Mopidy>=0.19: 1.1.0 from /usr/lib/python2.7/dist-packages
Pykka>=1.1: 1.2.1 from /usr/lib/python2.7/dist-packages
requests: 2.4.3 from /usr/lib/python2.7/dist-packages
tornado>=2.3: 3.2.2 from /usr/lib/python2.7/dist-packages
GStreamer: 0.10.36.0 from /usr/lib/python2.7/dist-packages/gst-0.10/gst
Detailed information:
Python wrapper: gst-python 0.10.22.0
Relevant elements:
Found:
uridecodebin
souphttpsrc
appsrc
alsasink
osssink
oss4sink
pulsesink
id3demux
id3v2mux
lame
mad
mp3parse
vorbisdec
vorbisenc
vorbisparse
oggdemux
oggmux
oggparse
flacdec
flacparse
shout2send
Not found:
flump3decStill some package version mismatches? Or anything else? Anything…?
Best regards –
– Torsten