radeon 677 Posted May 16, 2017 Share Posted May 16, 2017 (edited) Hey, I picked up an Amazon Fire TV Stick (Gen 2) for my parents to hook into my emby and have found some strange behaviour... As they have fairly crappy internet, I set the max streaming bitrate to 1mbit which inevitably means most things are being transcoded server side. Everything plays absolutely fine until the ffmpeg trancode completes on the server then the app seems to restart the playback from the very beginning of the video. Then for whatever reason, if they fast forward to get back to where they were, the transcode process restarts and the whole problem repeats again when the it completes server side. I can't get any logs for them just yet but thought I'd post in the short term in case anyone has seen this issue before and might have a fix. Cheers! Edited May 16, 2017 by radeon Link to comment Share on other sites More sharing options...
radeon 677 Posted May 16, 2017 Author Share Posted May 16, 2017 OK, just had a mate try, he's normally connected to his own server but has a nvidia shield and had the exact same issue. I got him to send a debug log from his, 22.14 UK time and DaveB is the username on my server Link to comment Share on other sites More sharing options...
Luke 37112 Posted May 16, 2017 Share Posted May 16, 2017 What version(s) of the emby app are you running? Link to comment Share on other sites More sharing options...
radeon 677 Posted May 16, 2017 Author Share Posted May 16, 2017 1.3.35a on both servers on Version 3.2.17.0 Link to comment Share on other sites More sharing options...
ebr 14929 Posted May 17, 2017 Share Posted May 17, 2017 Everything plays absolutely fine until the ffmpeg trancode completes on the server then the app seems to restart the playback from the very beginning of the video. What made you to come to the conclusion that it was the transcode completing that caused this? Link to comment Share on other sites More sharing options...
radeon 677 Posted May 17, 2017 Author Share Posted May 17, 2017 I could basically watch it unfold on the server. Firstly I noticed the red transcoded line moving to the end on the emby dashboard and it seemed to happen fairly close to when that completed but not right on it. So I watched for the ffmpeg process directly in task manager and whilst the red line gets to the end, it doesn't seem so accurate as ffmpeg is left running for a little while longer in the background but as soon as that ffmpeg process ends, within 5-10 seconds the video restarts and is repeatable on any transcoded stream in my environment. Link to comment Share on other sites More sharing options...
ebr 14929 Posted May 17, 2017 Share Posted May 17, 2017 Can you please reproduce the issue and send a log from the app? Thanks. Link to comment Share on other sites More sharing options...
radeon 677 Posted May 17, 2017 Author Share Posted May 17, 2017 I did last night? "I got him to send a debug log from his, 22.14 UK time and DaveB is the username on my server" Do i need to do it again? Link to comment Share on other sites More sharing options...
ebr 14929 Posted May 17, 2017 Share Posted May 17, 2017 I did last night? "I got him to send a debug log from his, 22.14 UK time and DaveB is the username on my server" Do i need to do it again? Yeah, sorry. There was no playback in that log. Thanks. Link to comment Share on other sites More sharing options...
radeon 677 Posted May 17, 2017 Author Share Posted May 17, 2017 ok, sure, strange. I talked him through the whole thing. guess he messed up! I'll try and get him to do it now and let you know once done Link to comment Share on other sites More sharing options...
radeon 677 Posted May 17, 2017 Author Share Posted May 17, 2017 OK, Uploaded, 16.24. Username DaveB again. Link to comment Share on other sites More sharing options...
ebr 14929 Posted May 17, 2017 Share Posted May 17, 2017 You have to actually reproduce the problem and then send the log in that same app session. The log he is sending just has a bunch of idle time in it. . Link to comment Share on other sites More sharing options...
CBers 6771 Posted May 17, 2017 Share Posted May 17, 2017 @@radeon Does he have DEBUG on in the app? Link to comment Share on other sites More sharing options...
radeon 677 Posted May 17, 2017 Author Share Posted May 17, 2017 You have to actually reproduce the problem and then send the log in that same app session. The log he is sending just has a bunch of idle time in it. . Yeah, Thats what he's doing, I'm on the phone with him now talking him through it. I'll get him to kill the app then restart and try again @@radeon Does he have DEBUG on in the app? lol, well yeah, he wouldn't be able to send the log if it wasn't, would he? Link to comment Share on other sites More sharing options...
radeon 677 Posted May 17, 2017 Author Share Posted May 17, 2017 OK, new log produced.16.56 DaveB Link to comment Share on other sites More sharing options...
CBers 6771 Posted May 17, 2017 Share Posted May 17, 2017 lol, well yeah, he wouldn't be able to send the log if it wasn't, would he? Ignore me. 1 Link to comment Share on other sites More sharing options...
radeon 677 Posted May 17, 2017 Author Share Posted May 17, 2017 Ignore me. lol! are you able to see the logs cbers? Can you see if that one "OK, new log produced.16.56 DaveB" was uploaded ok? Link to comment Share on other sites More sharing options...
CBers 6771 Posted May 17, 2017 Share Posted May 17, 2017 lol! are you able to see the logs cbers? Can you see if that one "OK, new log produced.16.56 DaveB" was uploaded ok? No, I can't see them, as they go straight to Eric. Link to comment Share on other sites More sharing options...
radeon 677 Posted May 17, 2017 Author Share Posted May 17, 2017 No, I can't see them, as they go straight to Eric. Ah k! Ta mate! 1 Link to comment Share on other sites More sharing options...
radeon 677 Posted May 17, 2017 Author Share Posted May 17, 2017 OK, another log submitted from another mate called Jon at 19.01. Fire tv stick and same app version as above. Link to comment Share on other sites More sharing options...
ebr 14929 Posted May 18, 2017 Share Posted May 18, 2017 Alright - your first guy's logs never did contain any playback but the second one (Jon) did. Looks like playback is chugging along until this happens: I/System.out( 4181): internalError [218.29, loadError] I/OMX.MTK.VIDEO.DECODER.AVC-MediaCodecRenderer( 4181): onPositionReset: 60000000, joining: false I/MediaCodecLogger( 4181): Flushing: tv.emby.embyatv.HW.video.avc.framerate = 25.005 fps I/OMX.MTK.AUDIO.DECODER.MP3-MediaCodecRenderer( 4181): onPositionReset: 60000000, joining: false D/ACodec ( 4181): submitOutputMetaBuffers send FTB for ouptut I/AudioTrack( 4181): reset() I/AudioTrack( 4181): calling pause I/System.out( 4181): ******** Exoplayer state change to: true/2 I/AudioTrack( 4181): calling flush I/System.out( 4181): state [218.34, true, B] I/AudioTrack( 4181): calling release Perhaps a network disruption, or maybe something else but the player hits this error. Interestingly, it isn't calling our error routine when it happens but the player seems to reset itself and start going again. In that session, did Jon react to the event in any way? I mean, when it jumped back to the beginning, did he try to seek back where he was or just let it go for a bit and then back out? Also, did it really go to the beginning, or just somewhere near the beginning? Thanks. Link to comment Share on other sites More sharing options...
radeon 677 Posted May 18, 2017 Author Share Posted May 18, 2017 Alright - your first guy's logs never did contain any playback but the second one (Jon) did. Looks like playback is chugging along until this happens: I/System.out( 4181): internalError [218.29, loadError] I/OMX.MTK.VIDEO.DECODER.AVC-MediaCodecRenderer( 4181): onPositionReset: 60000000, joining: false I/MediaCodecLogger( 4181): Flushing: tv.emby.embyatv.HW.video.avc.framerate = 25.005 fps I/OMX.MTK.AUDIO.DECODER.MP3-MediaCodecRenderer( 4181): onPositionReset: 60000000, joining: false D/ACodec ( 4181): submitOutputMetaBuffers send FTB for ouptut I/AudioTrack( 4181): reset() I/AudioTrack( 4181): calling pause I/System.out( 4181): ******** Exoplayer state change to: true/2 I/AudioTrack( 4181): calling flush I/System.out( 4181): state [218.34, true, B] I/AudioTrack( 4181): calling release Perhaps a network disruption, or maybe something else but the player hits this error. Interestingly, it isn't calling our error routine when it happens but the player seems to reset itself and start going again. In that session, did Jon react to the event in any way? I mean, when it jumped back to the beginning, did he try to seek back where he was or just let it go for a bit and then back out? Also, did it really go to the beginning, or just somewhere near the beginning? Thanks. Ah nice! Well at least we got a log from somewhere! Jon "just let it go for a bit and then back out" then straight away sent a log to you. He didn't react to it in any way. As for where it goes to, its always dependent on the starting state, i.e. if the item has been part watched and they're just resuming, it will go back to exactly where they resumed from. If they started watching from the beginning then it always goes back to the beginning. I can't imagine it being a network disruption as it's so repeatable. I can pick any piece of media which requires transcoding and the same thing will happen within seconds of the ffmpeg process closing (once it has completed the transcode). Hope that helps! Thanks Link to comment Share on other sites More sharing options...
ebr 14929 Posted May 20, 2017 Share Posted May 20, 2017 Do you know exactly when this started happening? It seems we just started getting reports for it in the past few days but there have been no updates to the app for a few weeks. I cannot figure out how this could be caused by the app at this point. Link to comment Share on other sites More sharing options...
radeon 677 Posted May 20, 2017 Author Share Posted May 20, 2017 (edited) Unfortunately not. After the nowtv dev removal people jumped ship to android and started getting reports of this sort of behaviour about 6-8 weeks ago I guess? Edited May 20, 2017 by radeon Link to comment Share on other sites More sharing options...
ebr 14929 Posted May 20, 2017 Share Posted May 20, 2017 6-8 weeks ago? There are posts out here about this back then? Link to comment Share on other sites More sharing options...
Recommended Posts
Create an account or sign in to comment
You need to be a member in order to leave a comment
Create an account
Sign up for a new account in our community. It's easy!
Register a new accountSign in
Already have an account? Sign in here.
Sign In Now