firsttris / plugin.video.sendtokodi

:tv: plays various stream sites on kodi using youtube-dl
MIT License
121 stars 27 forks source link

Arte.tv not playing #70

Closed laurentbacall closed 1 year ago

laurentbacall commented 1 year ago

Hi @firsttris After issue #64 was solved upstream a couple of weeks ago, I just made new unsuccessful attempts. Below is a log excerpt showing first a youtube video playing without any issue and then an arte.tv video failing. Any clue about this one? Happy to provide any more details as needed or to raise this issue elsewhere as appropriate. Thank you.

2022-08-14 08:46:59.681 T:1876 INFO : initializing python engine. 2022-08-14 08:47:02.506 T:547 INFO : CActiveAESink::OpenSink - initialize sink 2022-08-14 08:47:02.506 T:547 INFO : CAESinkALSA::Initialize - Attempting to open device "@" 2022-08-14 08:47:02.511 T:547 INFO : CAESinkALSA::Initialize - Opened device "sysdefault" 2022-08-14 08:47:02.512 T:547 INFO : CAESinkALSA::InitializeHW - Your hardware does not support AE_FMT_FLOAT, trying other formats 2022-08-14 08:47:02.512 T:547 INFO : CAESinkALSA::InitializeHW - Using data format AE_FMT_S24NE3 2022-08-14 08:47:07.206 T:1876 INFO : CPythonInvoker(4, /home/osmc/.kodi/addons/plugin.video.sendtokodi/service.py): script successfully run 2022-08-14 08:47:07.488 T:1876 INFO : Python interpreter stopped 2022-08-14 08:47:07.612 T:495 INFO : VideoPlayer::OpenFile: plugin://plugin.video.sendtokodi/?https://youtube.com/watch?v=Tuw8hxrFBH8&feature=share {"ydlOpts":{}} 2022-08-14 08:47:07.772 T:1880 INFO : Creating InputStream 2022-08-14 08:47:08.446 T:1880 INFO : Creating Demuxer 2022-08-14 08:47:08.628 T:1880 INFO : Opening stream: 0 source: 256 2022-08-14 08:47:08.628 T:1880 INFO : [WHITELIST] Searching the whitelist for: width: 1280, height: 720, fps: 29.970, 3D: false 2022-08-14 08:47:08.628 T:1880 ERROR : T99 1280/720 vs. 1920/1080 - 29.970030 vs. 50.000000, flags: 0x0 2022-08-14 08:47:08.628 T:1880 ERROR : T99 1280/720 vs. 1920/1080 - 29.970030 vs. 59.940063, flags: 0x0 2022-08-14 08:47:08.628 T:1880 ERROR : T99 1280/720 vs. 1920/1080 - 29.970030 vs. 60.000000, flags: 0x0 2022-08-14 08:47:08.629 T:1880 INFO : Skipped 1 duplicate messages.. 2022-08-14 08:47:08.629 T:1880 INFO : Display resolution ADJUST : 1920x1080 @ 59.940063 Hz (18) (weight: 0.000) 2022-08-14 08:47:08.639 T:495 INFO : VideoPlayer: OnLostDisplay received 2022-08-14 08:47:08.639 T:495 WARNING : CDVDMessageQueue(audio)::Put MSGQ_NOT_INITIALIZED 2022-08-14 08:47:08.639 T:495 WARNING : CDVDMessageQueue(video)::Put MSGQ_NOT_INITIALIZED 2022-08-14 08:47:08.640 T:495 INFO : GLES: Maximum texture width: 4096 2022-08-14 08:47:08.643 T:1880 INFO : Creating video codec with codec id: 27 2022-08-14 08:47:08.643 T:1880 INFO : CDVDVideoCodecDRMPRIME::Open - using decoder V4L2 mem2mem H.264 decoder wrapper 2022-08-14 08:47:08.662 T:1880 INFO : Creating video thread 2022-08-14 08:47:08.663 T:1889 INFO : running thread: video_thread 2022-08-14 08:47:08.665 T:1880 INFO : Opening stream: 1 source: 256 2022-08-14 08:47:08.665 T:1880 INFO : Finding audio codec for: 86018 2022-08-14 08:47:08.666 T:1880 INFO : CDVDAudioCodecFFmpeg::Open() Successful opened audio decoder aac 2022-08-14 08:47:08.666 T:1880 INFO : Creating audio thread 2022-08-14 08:47:08.666 T:1890 INFO : running thread: CVideoPlayerAudio::Process() 2022-08-14 08:47:08.720 T:495 INFO : VideoPlayer: OnResetDisplay received 2022-08-14 08:47:08.774 T:1890 INFO : CVideoPlayerAudio: display reset occurred, checking for passthrough 2022-08-14 08:47:08.775 T:1890 INFO : CDVDAudioCodecFFmpeg::Open() Successful opened audio decoder aac 2022-08-14 08:47:08.775 T:1890 INFO : Creating audio stream (codec id: 86018, channels: 2, sample rate: 44100, no pass-through) 2022-08-14 08:47:08.816 T:547 INFO : CActiveAESink::OpenSink - initialize sink 2022-08-14 08:47:09.016 T:547 INFO : CAESinkALSA::Initialize - Attempting to open device "@" 2022-08-14 08:47:09.020 T:547 INFO : CAESinkALSA::Initialize - Opened device "sysdefault" 2022-08-14 08:47:09.022 T:547 INFO : CAESinkALSA::InitializeHW - Your hardware does not support AE_FMT_FLOAT, trying other formats 2022-08-14 08:47:09.022 T:547 INFO : CAESinkALSA::InitializeHW - Using data format AE_FMT_S24NE3 2022-08-14 08:47:09.087 T:495 ERROR : Window Translator: Can't find window True 2022-08-14 08:47:09.090 T:495 INFO : [WHITELIST] Searching the whitelist for: width: 1280, height: 720, fps: 29.970, 3D: false 2022-08-14 08:47:09.090 T:495 ERROR : T99 1280/720 vs. 1920/1080 - 29.970030 vs. 50.000000, flags: 0x0 2022-08-14 08:47:09.090 T:495 ERROR : T99 1280/720 vs. 1920/1080 - 29.970030 vs. 59.940063, flags: 0x0 2022-08-14 08:47:09.090 T:495 ERROR : T99 1280/720 vs. 1920/1080 - 29.970030 vs. 60.000000, flags: 0x0 2022-08-14 08:47:09.091 T:495 INFO : Skipped 1 duplicate messages.. 2022-08-14 08:47:09.091 T:495 INFO : Display resolution ADJUST : 1920x1080 @ 59.940063 Hz (18) (weight: 0.000) 2022-08-14 08:47:21.303 T:572 INFO : JSONRPC Server: New connection added 2022-08-14 08:47:25.010 T:495 INFO : CVideoPlayer::CloseFile() 2022-08-14 08:47:25.011 T:495 INFO : VideoPlayer: waiting for threads to exit 2022-08-14 08:47:25.017 T:1880 INFO : CVideoPlayer::OnExit() 2022-08-14 08:47:25.017 T:1880 INFO : Closing stream player 1 2022-08-14 08:47:25.017 T:1880 INFO : Waiting for audio thread to exit 2022-08-14 08:47:25.030 T:1890 INFO : thread end: CVideoPlayerAudio::OnExit() 2022-08-14 08:47:25.030 T:1880 INFO : Closing audio device 2022-08-14 08:47:25.080 T:1880 INFO : Deleting audio codec 2022-08-14 08:47:25.080 T:547 INFO : CActiveAESink::OpenSink - initialize sink 2022-08-14 08:47:25.080 T:1880 INFO : Closing stream player 2 2022-08-14 08:47:25.080 T:1880 INFO : waiting for video thread to exit 2022-08-14 08:47:25.093 T:1889 WARNING : OutputPicture - timeout waiting for buffer 2022-08-14 08:47:25.093 T:1889 INFO : thread end: video_thread 2022-08-14 08:47:25.093 T:1880 INFO : deleting video codec 2022-08-14 08:47:25.108 T:495 INFO : VideoPlayer: finished waiting 2022-08-14 08:47:25.108 T:495 INFO : CVideoPlayer::CloseFile() 2022-08-14 08:47:25.109 T:495 INFO : VideoPlayer: waiting for threads to exit 2022-08-14 08:47:25.109 T:495 INFO : VideoPlayer: finished waiting 2022-08-14 08:47:25.186 T:495 INFO : GLES: Maximum texture width: 4096 2022-08-14 08:47:25.279 T:547 INFO : CAESinkALSA::Initialize - Attempting to open device "@" 2022-08-14 08:47:25.287 T:547 INFO : CAESinkALSA::Initialize - Opened device "sysdefault" 2022-08-14 08:47:25.293 T:547 INFO : CAESinkALSA::InitializeHW - Your hardware does not support AE_FMT_FLOAT, trying other formats 2022-08-14 08:47:25.293 T:547 INFO : CAESinkALSA::InitializeHW - Using data format AE_FMT_S24NE3 2022-08-14 08:47:26.929 T:572 INFO : JSONRPC Server: Disconnection detected 2022-08-14 08:48:16.034 T:1904 INFO : initializing python engine. 2022-08-14 08:48:22.845 T:1904 ERROR : ERROR: [ArteTV] 092943-001-A: Requested format is not available. Use --list-formats for a list of available formats

2022-08-14 08:48:22.853 T:1904 ERROR : EXCEPTION Thrown (PythonToCppException) : -->Python callback/script returned the following error<--

2022-08-14 08:48:23.145 T:1904 INFO : Python interpreter stopped

nullket commented 1 year ago

I did a quick test with a single video. Unless this was an exception, arte.tv seems to not provide a "single file for audio and video" anymore. The future of streams is to provide multiple audio and video streams separately. This enables seamless and even adaptive switching between qualities and different audio lines (langues etc.).

In the current state this plugin requires a single file stream which contains audio and video at once. For everything else wee need https://github.com/firsttris/plugin.video.sendtokodi/issues/34

laurentbacall commented 1 year ago

Thanks for coming back @nullket

nullket commented 1 year ago

@laurentbacall if you are on kodi matrix can you please checkout this experimental feature:

laurentbacall commented 1 year ago

@nullket - great stuff - works like a charm - my wife is super happy to watch ARTE again. You rock. Thank you so much. How will I know when it is available as an update to the regular addon?

nullket commented 1 year ago

@nullket - great stuff - works like a charm - my wife is super happy to watch ARTE again. You rock. Thank you so much.

You are welcome :) But I had to add some changes again as I broke audio only streams. Can you do me a favor, install the newest test build (steps above) and test it again?

How will I know when it is available as an update to the regular addon?

As soon as all issues introduced by this (see https://github.com/firsttris/plugin.video.sendtokodi/pull/74) are fixed and firsttris had the time to review the PR.

laurentbacall commented 1 year ago

Sure. Just tested 0.9.274. The ARTE stream won't start (kodi log below). But worse -- 0.9.274 won't uninstall via kodi interface. How can I force uninstall? (I am comfortable with shell if that helps). 0.9.274_kodi.log

laurentbacall commented 1 year ago

Re: forcing uninstall, would it be as easy as removing ~/.kodi/addons/plugin.video.sendtokodi ?

nullket commented 1 year ago

Re: forcing uninstall, would it be as easy as removing ~/.kodi/addons/plugin.video.sendtokodi ?

Yep, that and restarting Kodi should do it.

Thanks but too bad it broke. I will look into the log the next days.

nullket commented 1 year ago

Mhm I am not sure you got the right version last time or something else was borked (might be the reason you could not uninstall it correctly). Anyway, I made some changes and your url was working fine on my kodi instance. Please test https://github.com/firsttris/plugin.video.sendtokodi/actions/runs/3044279379

In case it does not work, please restart kodi to make sure the correct plugin version was loaded.

laurentbacall commented 1 year ago

Thank you. So I tried 0.9.276. The stream from the other day was no longer available. I am attaching the log (kodi.old.log) after installing it and re-starting kodi. At 21:16:48.123 I attempted to play an empty URL which obviously failed (my bad). At 2022-09-13 21:18:17.778, I played a short stream (1 min 13s total length) which launched OK. At 2022-09-13 21:19:21.057, same short stream launched successfully again. At 2022-09-13 21:21:14.689, trying another random (but longer, say 45 min) stream. This one failed. At 2022-09-13 21:22:52.333 another random longer stream failed. At 2022-09-13 21:22:52.333, re-installing 0.9.269 after uninstalling 276 (uninstall worked OK this time) and re-starting kodi.

After that (kodi.log), at 2022-09-13 21:24:30.699 I played the previously failed stream and it launched just fine.

kodi.old.log kodi.log

nullket commented 1 year ago

Okay there was a copy paste error. Sorry for that.

Please uninstall the current version, install this version, restart kodi (just to be sure). Lets make your first URL our prime test case from now on (it works on my machine ;) ): https://www.arte.tv/fr/videos/080102-000-A/aurores-boreales-des-lumieres-fascinantes-mais-menacantes/

If that works, please test other ARTE streams as well.

laurentbacall commented 1 year ago

Every Arte stream I tried - including our prime test case - played beautifully with 0.9.277 :) Well done @nullket

nullket commented 1 year ago

It is merged in the master and will be available via an automatic update to you. For now it is experimental (default off) to figure out if there are any other issues with it.