Magnolia recording failed no login form found

Failed to reauth starting a recording at 12:20pm.
I was able to reauth the channel later by viewing the channel live.
Appears it was a timout?

Logs have been submitted as a7df2777-362d-47d7-8094-59fffc1316bd.

Another one. Same channel, different server.

This channel requires reauth every 7-8 days.
Recording job started at 9:57am.
After retries it eventually authenticated and started recording 3.5 minutes later.

Logs have been submitted as 63db3f04-2b19-45fe-bd17-51a5ba302ae2.

Don't know if it's related, but my other server was getting the following error today trying to view any Discovery Network channel.
[TVE] action=science_stream error={[{access.denied.missingpackage 403}] {{[]}}}

I linked provider at the science channel website with no problem and played a few channels (Science, Magnolia, Discover). While they were playing I was then able to watch then in Channels DVR.
I then unlinked provider at the science channel website and Channels DVR continues to work.

1 Like

Happened again today. Same as first post.
Magnolia channel failed to authenticate for scheduled recording

Not sure if this timeout is the reason [TVE] action=wait_for_interstitial err=timeout

2022/12/05 12:20:01.003218 [DVR] Starting job 1670271601-ch6108 Canary DIY Recording on ch=[6108]
2022/12/05 12:21:09.250525 [TVE] action=wait_for_interstitial err=timeout
2022/12/05 12:21:14.844752 [ERR] Failed to start stream on channel 6108 via TVE-Comcast_SSO: TVE: "no login form found"

I was able to get it authenticated by playing the channel live in the web UI
See 12:51:08 - 12:52:23 in log

Diagnostics submitted c1c9faa8-1731-4115-ada8-cb11543f385b

Version 2022.12.22.0210
Failed again with invalid token
The activation code has expired
Log entries

2022/12/22 13:20:01.000790 [DVR] Starting job 1671744001-ch6108 Canary DIY Recording on ch=[6108]
2022/12/22 13:20:01.424031 [TVE] action=science_stream error={[{invalid.token Token invalid 400}] {{[]}}}
2022/12/22 13:20:01.520561 [ERR] Failed to start stream on channel 6108 via TVE-Comcast_SSO: TVE: 400: Token invalid (invalid.token)
2022/12/22 13:20:59.244974 [TVE] action=wait_for_interstitial err=timeout
2022/12/22 13:20:59.797010 [TVE] action=screenshot size=9512
2022/12/22 13:21:02.173930 [ERR] Failed to start stream on channel 6108 via TVE-Comcast_SSO: TVE: "no login form found"

Logs have been submitted as 90feda0a-9f72-4343-97b0-b14fdfe882a3

Version 2023.01.06.2203
Failed again

2023/01/08 13:20:00.004150 [DVR] Starting job 1673212800-ch6108 Canary DIY Recording on ch=[6108]
2023/01/08 13:20:01.181724 [TVE] action=version product=Chrome/97.0.4692.56 jsVersion=9.7.106.18 protocol=1.3 revision=@04da6c66398ca50e603cc236a07dc7dfd3bbc750
2023/01/08 13:20:10.401888 [TVE] action=wait_for_interstitial timeout=12s
2023/01/08 13:21:01.922931 [TVE] action=wait_for_interstitial err=timeout
2023/01/08 13:21:02.838261 [TVE] action=fill_form u=xxxxxxx
2023/01/08 13:21:03.009123 [TVE] action=screenshot size=9512
2023/01/08 13:21:05.687079 [ERR] Failed to start stream on channel 6108 via TVE-Comcast_SSO: TVE: "no login form found"

Logs have been submitted as 38ed3978-de74-406b-b4ad-6e3a0052be2f

I was able to re-auth just by playing the channel live from the web UI player.

I run this every Sunday morning to reset my password to original password and then run a scan. Haven't had many authentication issues and if there is a problem I can easily tell by the amount of channels.

curl -XPUT --data-binary '{"pass":"yourpassword"}' http://10.0.0.2:8089/providers/tve/mvpds/Comcast_SSO/credentials && curl -XPOST http://10.0.0.2:8089/providers/tve/mvpds/Comcast_SSO/scan?all=true
1 Like

I don't clear the chromedata folder anymore since Aman made some auth changes last year.
Like I said, just viewing the channel live reauthed it.
Seems to be an issue with the 12 second interstitial timeout.

When I read last year, I said to myself that is a long time ago looked at my Calendar and last year was only 9 days ago lol.

Since this one, specifically.

Version 2023.01.17.0457 Synology Package install w/Chrome v97
Failed again recording from Magnolia with no login form found, screenshot "The activation code has expired."

2023/01/18 13:20:13.034152 [TVE] action=wait_for_interstitial timeout=12s
2023/01/18 13:21:04.912083 [TVE] action=wait_for_interstitial err=timeout

2023/01/18 13:20:01.002499 [DVR] Starting job 1674076801-ch6108 Canary DIY Recording on ch=[6108]
2023/01/18 13:20:01.437737 [TVE] action=science_stream error={[{invalid.token Token invalid 400}] {{[]}}}
2023/01/18 13:20:01.550647 [ERR] Failed to start stream on channel 6108 via TVE-Comcast_SSO: TVE: 400: Token invalid (invalid.token)
2023/01/18 13:20:01.550736 [DVR] Error running job 1674076801-ch6108 Canary DIY Recording: could not start stream on channels=[6108]: TVE: 400: Token invalid (invalid.token)
2023/01/18 13:20:02.558208 [DVR] Starting job 1674076801-ch6108 Canary DIY Recording on ch=[6108]
2023/01/18 13:20:03.761443 [TVE] action=version product=Chrome/97.0.4692.56 jsVersion=9.7.106.18 protocol=1.3 revision=@04da6c66398ca50e603cc236a07dc7dfd3bbc750
2023/01/18 13:20:03.786322 [TVE] action=navigate url=https://auth.sciencechannel.com/login-affiliates?returnUrl=https://www.sciencechannel.com/live-now&hostUrl=us1-prod-direct.sciencechannel.com
2023/01/18 13:20:03.789293 [TVE] action=request type=Document method=GET url=https://auth.sciencechannel.com/login-affiliates
2023/01/18 13:20:03.789335 [TVE] action=auth_domain domain=auth.sciencechannel.com
2023/01/18 13:20:03.789342 [TVE] action=scienceauth reason=login
2023/01/18 13:20:04.443898 [TVE] action=wait_for_page
2023/01/18 13:20:11.001702 [TVE] action=page_ready
2023/01/18 13:20:11.001761 [TVE] action=wait_for_page done=true reason=page_ready
2023/01/18 13:20:13.002081 [TVE] action=click_interstitial
2023/01/18 13:20:13.006387 [TVE] action=tvejs msg="scienceSelect: path=/login-affiliates"
2023/01/18 13:20:13.034152 [TVE] action=wait_for_interstitial timeout=12s
2023/01/18 13:20:15.181475 [TVE] action=request type=Document method=GET url=https://api.auth.adobe.com/api/v1/authenticate
2023/01/18 13:20:15.470666 [TVE] action=request type=Document method=GET url=https://sp.auth.adobe.com/api/v1/authenticate
2023/01/18 13:20:15.834852 [TVE] action=request type=Document method=GET url=https://oauth.xfinity.com/oauth/authorize
2023/01/18 13:20:16.264104 [TVE] action=request type=Document method=GET url=https://login.xfinity.com/login
2023/01/18 13:20:20.845866 [TVE] action=error_response type=Image error=net::ERR_NAME_NOT_RESOLVED url=https://match.rundsp.com/match.gif 
2023/01/18 13:20:21.748895 [TVE] action=request type=Document method=GET url=https://oauth.xfinity.com/oauth/authorize
2023/01/18 13:20:22.049180 [TVE] action=request type=Document method=GET url=https://sp.auth.adobe.com/adobe-services/oauth2
2023/01/18 13:20:28.235197 [TVE] action=request type=Document method=GET url=https://us1-prod.disco-api.com/v1/gauth/callback/ca81d4b4-25bd-46b0-8544-81c107b81933
2023/01/18 13:20:28.636768 [TVE] action=request type=Document method=GET url=https://auth.sciencechannel.com/gauth-sync
2023/01/18 13:20:28.636809 [TVE] action=scienceauth reason=sync
2023/01/18 13:20:34.910773 [TVE] action=page_ready
2023/01/18 13:20:34.910842 [TVE] action=scienceauth event=page_ready
2023/01/18 13:21:04.912083 [TVE] action=wait_for_interstitial err=timeout
2023/01/18 13:21:06.150360 [TVE] action=fill_form u=username
2023/01/18 13:21:06.155758 [TVE] action=screenshot
2023/01/18 13:21:06.331681 [TVE] action=screenshot size=9512
2023/01/18 13:21:06.345983 [TVE] action=capture_html
2023/01/18 13:21:06.361194 [TVE] action=capture_html size=187940
2023/01/18 13:21:06.361967 [TVE] action=script_error err=&runtime.ExceptionDetails{ExceptionID:1, Text:"Uncaught", LineNumber:9, ColumnNumber:5, ScriptID:"83", URL:"", StackTrace:(*runtime.StackTrace)(0xc00003e400), Exception:(*runtime.RemoteObject)(0xc000f47830), ExecutionContextID:0, ExceptionMetaData:easyjson.RawMessage(nil)} exp=&runtime.RemoteObject{Type:"string", Subtype:"", ClassName:"", Value:easyjson.RawMessage{0x22, 0x6e, 0x6f, 0x20, 0x6c, 0x6f, 0x67, 0x69, 0x6e, 0x20, 0x66, 0x6f, 0x72, 0x6d, 0x20, 0x66, 0x6f, 0x75, 0x6e, 0x64, 0x22}, UnserializableValue:"", Description:"", WebDriverValue:(*runtime.WebDriverValue)(nil), ObjectID:"", Preview:(*runtime.ObjectPreview)(nil), CustomPreview:(*runtime.CustomPreview)(nil)} exp_value="no login form found"
2023/01/18 13:21:08.668945 [ERR] Failed to start stream on channel 6108 via TVE-Comcast_SSO: TVE: "no login form found"
2023/01/18 13:21:08.669022 [DVR] Error running job 1674076801-ch6108 Canary DIY Recording: could not start stream on channels=[6108]: TVE: "no login form found"

Logs have been submitted as 49653f51-927e-4f20-af03-063716370400
I was able to re-auth just by playing the channel live from the web UI player.

Hopefully the last post I make in this topic.
Since I can't update headless-chrome past v97 on my Synology Package installs, I've migrated them to TVE docker containers using the same record path and port after stopping the Synology Packages.
Since the new :tve docker container uses chrome v109, I'm hoping this solves my problem.
I should know next time Channels DVR needs to re-auth Magnolia, which should be Jan. 25 and Jan 29 for my two servers using TVE sources. :crossed_fingers:

1 Like

Failed recording due to auth again

2023/02/18 13:20:00.003674 [DVR] Starting job 1676755200-ch6108 Canary DIY Recording on ch=[6108]
2023/02/18 13:20:45.285810 [TVE] action=screenshot size=28355
2023/02/18 13:20:45.303150 [TVE] action=capture_html size=54745
2023/02/18 13:20:45.318693 [TVE] action=script_error err=&runtime.ExceptionDetails{ExceptionID:1, Text:"Uncaught", LineNumber:9, ColumnNumber:5, ScriptID:"166", URL:"", StackTrace:(*runtime.StackTrace)(0xc001111f40), Exception:(*runtime.RemoteObject)(0xc000e1c5a0), ExecutionContextID:0, ExceptionMetaData:easyjson.RawMessage(nil)} exp=&runtime.RemoteObject{Type:"string", Subtype:"", ClassName:"", Value:easyjson.RawMessage{0x22, 0x6e, 0x6f, 0x20, 0x6c, 0x6f, 0x67, 0x69, 0x6e, 0x20, 0x66, 0x6f, 0x72, 0x6d, 0x20, 0x66, 0x6f, 0x75, 0x6e, 0x64, 0x22}, UnserializableValue:"", Description:"", WebDriverValue:(*runtime.WebDriverValue)(nil), ObjectID:"", Preview:(*runtime.ObjectPreview)(nil), CustomPreview:(*runtime.CustomPreview)(nil)} exp_value="no login form found"
2023/02/18 13:20:45.582548 [ERR] Failed to start stream on channel 6108 via TVE-Comcast_SSO: TVE: "no login form found"
2023/02/18 13:20:45.582607 [DVR] Error running job 1676755200-ch6108 Canary DIY Recording: could not start stream on channels=[6108]: TVE: "no login form found"

I tuned in live and it reauthed
2023/02/18 13:55:33.858416 [TVE] action=scienceauth done=true
2023/02/18 13:55:33.858462 [TVE] action=authed

Logs have been submitted as 9465a00e-5032-4f04-8a9d-e235d07dec9b

Just an update that since moving my TVE servers to docker containers using chrome v109, no issues.

This topic was automatically closed 365 days after the last reply. New replies are no longer allowed.