Closed Bug 1731090 Opened 3 years ago Closed 3 years ago

Intermittent /webdriver/tests/element_click/navigate.py | test_link_cross_origin[capabilities0] - AssertionError: assert 'https://web-platform.test:8443/webdriver/tests/support/inline.py

Categories

(Remote Protocol :: Marionette, defect, P5)

defect

Tracking

(Not tracked)

RESOLVED INCOMPLETE

People

(Reporter: intermittent-bug-filer, Unassigned)

References

(Depends on 1 open bug)

Details

(Keywords: assertion, intermittent-failure)

Filed by: smolnar [at] mozilla.com
Parsed log: https://treeherder.mozilla.org/logviewer?job_id=351715759&repo=autoland
Full log: https://firefox-ci-tc.services.mozilla.com/api/queue/v1/task/TEM_C_ozTyqbeoeraTW-4w/runs/0/artifacts/public/logs/live_backing.log


INFO - TEST-PASS | /webdriver/tests/element_click/navigate.py | test_link_from_nested_context_with_target[_top] 
[task 2021-09-16T13:08:30.847Z] 13:08:30     INFO - TEST-UNEXPECTED-FAIL | /webdriver/tests/element_click/navigate.py | test_link_cross_origin[capabilities0] - AssertionError: assert 'https://web-platform.test:8443/webdriver/tests/support/inline.py?doc=%3C%21doctype+html%3E%0A%3Cmeta+charset%3DUTF-8%3E%0A%3Ca+href%3D%27https%3A%2F%2Fnot-web-platform.test%3A8443%2Fwebdriver%2Ftests%2Fsupport%2Fhtml%2Fsubframe.html%3Fpipe%3Dheader%28Cross-Origin-Opener-Policy%2Csame-origin%27%3Eclick+me%3C%2Fa%3E&mime=text%2Fhtml&charset=UTF-8' == 'https://not-web-platform.test:8443/webdriver/tests/support/html/subframe.html?pipe=header(Cross-Origin-Opener-Policy,same-origin'
[task 2021-09-16T13:08:30.847Z] 13:08:30     INFO - session = <Session 2ecfdac0-785a-4abc-9610-d9eb0b8d6b76>
[task 2021-09-16T13:08:30.847Z] 13:08:30     INFO - inline = <function inline.<locals>.inline at 0x0000026E49CE5E50>
[task 2021-09-16T13:08:30.847Z] 13:08:30     INFO - url = <function url.<locals>.url at 0x0000026E49CE5CA0>
[task 2021-09-16T13:08:30.848Z] 13:08:30     INFO - 
[task 2021-09-16T13:08:30.848Z] 13:08:30     INFO -     @pytest.mark.capabilities({"acceptInsecureCerts": True})
[task 2021-09-16T13:08:30.848Z] 13:08:30     INFO -     def test_link_cross_origin(session, inline, url):
[task 2021-09-16T13:08:30.848Z] 13:08:30     INFO -         base_path = ("/webdriver/tests/support/html/subframe.html" +
[task 2021-09-16T13:08:30.848Z] 13:08:30     INFO -                      "?pipe=header(Cross-Origin-Opener-Policy,same-origin")
[task 2021-09-16T13:08:30.848Z] 13:08:30     INFO -         target_page = url(base_path, protocol="https", domain="alt")
[task 2021-09-16T13:08:30.848Z] 13:08:30     INFO -     
[task 2021-09-16T13:08:30.848Z] 13:08:30     INFO -         session.url = inline("<a href='{}'>click me</a>".format(target_page), protocol="https")
[task 2021-09-16T13:08:30.848Z] 13:08:30     INFO -         link = session.find.css("a", all=False)
[task 2021-09-16T13:08:30.848Z] 13:08:30     INFO -     
[task 2021-09-16T13:08:30.848Z] 13:08:30     INFO -         response = element_click(session, link)
[task 2021-09-16T13:08:30.848Z] 13:08:30     INFO -         assert_success(response)
[task 2021-09-16T13:08:30.848Z] 13:08:30     INFO -     
[task 2021-09-16T13:08:30.849Z] 13:08:30     INFO - >       assert session.url == target_page
[task 2021-09-16T13:08:30.849Z] 13:08:30     INFO - E       AssertionError: assert 'https://web-platform.test:8443/webdriver/tests/support/inline.py?doc=%3C%21doctype+html%3E%0A%3Cmeta+charset%3DUTF-8%3E%0A%3Ca+href%3D%27https%3A%2F%2Fnot-web-platform.test%3A8443%2Fwebdriver%2Ftests%2Fsupport%2Fhtml%2Fsubframe.html%3Fpipe%3Dheader%28Cross-Origin-Opener-Policy%2Csame-origin%27%3Eclick+me%3C%2Fa%3E&mime=text%2Fhtml&charset=UTF-8' == 'https://not-web-platform.test:8443/webdriver/tests/support/html/subframe.html?pipe=header(Cross-Origin-Opener-Policy,same-origin'
[task 2021-09-16T13:08:30.849Z] 13:08:30     INFO - E         - https://not-web-platform.test:8443/webdriver/tests/support/html/subframe.html?pipe=header(Cross-Origin-Opener-Policy,same-origin
[task 2021-09-16T13:08:30.849Z] 13:08:30     INFO - E         + https://web-platform.test:8443/webdriver/tests/support/inline.py?doc=%3C%21doctype+html%3E%0A%3Cmeta+charset%3DUTF-8%3E%0A%3Ca+href%3D%27https%3A%2F%2Fnot-web-platform.test%3A8443%2Fwebdriver%2Ftests%2Fsupport%2Fhtml%2Fsubframe.html%3Fpipe%3Dheader%28Cross-Origin-Opener-Policy%2Csame-origin%27%3Eclick+me%3C%2Fa%3E&mime=text%2Fhtml&charset=UTF-8
[task 2021-09-16T13:08:30.849Z] 13:08:30     INFO - 
[task 2021-09-16T13:08:30.849Z] 13:08:30     INFO - base_path  = '/webdriver/tests/support/html/subframe.html?pipe=header(Cross-Origin-Opener-Policy,same-origin'
[task 2021-09-16T13:08:30.849Z] 13:08:30     INFO - inline     = <function inline.<locals>.inline at 0x0000026E49CE5E50>
[task 2021-09-16T13:08:30.849Z] 13:08:30     INFO - link       = <Element 4a56ade1-df56-4b9f-8f38-454664875e61>
[task 2021-09-16T13:08:30.849Z] 13:08:30     INFO - response   = <Responsetatus=200 body={"value": null}>
[task 2021-09-16T13:08:30.849Z] 13:08:30     INFO - session    = <Session 2ecfdac0-785a-4abc-9610-d9eb0b8d6b76>
[task 2021-09-16T13:08:30.849Z] 13:08:30     INFO - target_page = 'https://not-web-platform.test:8443/webdriver/tests/support/html/subframe.html?pipe=header(Cross-Origin-Opener-Policy,same-origin'
[task 2021-09-16T13:08:30.849Z] 13:08:30     INFO - url        = <function url.<locals>.url at 0x0000026E49CE5CA0>
[task 2021-09-16T13:08:30.850Z] 13:08:30     INFO - 
[task 2021-09-16T13:08:30.850Z] 13:08:30     INFO - tests\web-platform\tests\webdriver\tests\element_click\navigate.py:182: AssertionError
[task 2021-09-16T13:08:30.851Z] 13:08:30     INFO - .
[task 2021-09-16T13:08:30.852Z] 13:08:30     INFO - TEST-OK | /webdriver/tests/element_click/navigate.py | took 20568ms

Related lines of the log:
https://treeherder.mozilla.org/logviewer?job_id=351715759&repo=autoland&lineNumber=19600-19606

[task 2021-09-16T13:08:19.219Z] 13:08:19     INFO - PID 3696 | 1631797699218	Marionette	DEBUG	0 -> [0,6,"WebDriver:ElementClick",{"id":"4a56ade1-df56-4b9f-8f38-454664875e61"}]
[task 2021-09-16T13:08:19.259Z] 13:08:19     INFO - PID 3696 | 1631797699262	Marionette	TRACE	Received DOM event click for https://not-web-platform.test:8443/webdriver/tests/support/html/subframe.html?pipe=header(Cross-Origin-Opener-Policy,same-origin
[task 2021-09-16T13:08:19.265Z] 13:08:19     INFO - PID 3696 | [Child 4312, Main Thread] WARNING: NS_ENSURE_TRUE(info) failed: file /builds/worker/checkouts/gecko/extensions/permissions/PermissionDelegateHandler.cpp:348
[task 2021-09-16T13:08:19.267Z] 13:08:19     INFO - PID 3696 | 1631797699265	Marionette	TRACE	[28] Received event beforeunload for https://web-platform.test:8443/webdriver/tests/support/inline.py?doc=%3C%21doctype+html%3E%0A%3Cmeta+charset%3DUTF-8%3E%0A%3C ... bframe.html%3Fpipe%3Dheader%28Cross-Origin-Opener-Policy%2Csame-origin%27%3Eclick+me%3C%2Fa%3E&mime=text%2Fhtml&charset=UTF-8
[task 2021-09-16T13:08:19.272Z] 13:08:19     INFO - PID 3696 | DEBUG: Adding blocker UserInteractionTimer 1 for document 1df2dc65000 for phase xpcom-will-shutdown
[task 2021-09-16T13:08:21.181Z] 13:08:21     INFO - PID 3696 | DEBUG: Adding blocker SessionFile: Finish writing Session Restore data for phase profile-before-change
[task 2021-09-16T13:08:24.494Z] 13:08:24     INFO - PID 3696 | 1631797704494	Marionette	TRACE	Canceled page load listener because no navigation has been detected

The original document has been unloaded but we didn't receive a DOMContentLoaded event from the new page within 3s even when loading it from a locally running HTTP server. And as such Marionette gave up 3s later. Sadly we cannot remove this early break yet due to bug 1450876.

Depends on: 1450876
Status: NEW → RESOLVED
Closed: 3 years ago
Resolution: --- → INCOMPLETE
Moving bug to Remote Protocol::Marionette component per bug 1815831.
Component: geckodriver → Marionette
Product: Testing → Remote Protocol
You need to log in before you can comment on or make changes to this bug.