Closed
Bug 1665210
Opened 4 years ago
Closed 4 years ago
Perma Mn-fis testing/marionette/harness/marionette_harness/tests/unit/test_navigation.py TestNavigate.test_navigate_top_frame_from_nested_context | AssertionError: u'about:blank' != 'http://127.0.0.1:50030/test.html '
Categories
(Testing :: Marionette Client and Harness, defect, P5)
Testing
Marionette Client and Harness
Tracking
(Fission Milestone:M7, firefox-esr78 unaffected, firefox81 unaffected, firefox82 disabled, firefox83 fixed)
| Tracking | Status | |
|---|---|---|
| firefox-esr78 | --- | unaffected |
| firefox81 | --- | unaffected |
| firefox82 | --- | disabled |
| firefox83 | --- | fixed |
People
(Reporter: intermittent-bug-filer, Assigned: whimboo)
References
(Regression)
Details
(Keywords: intermittent-failure, regression)
Attachments
(1 file)
Filed by: nbeleuzu [at] mozilla.com
Parsed log: https://treeherder.mozilla.org/logviewer.html#?job_id=315780699&repo=autoland
Full log: https://firefox-ci-tc.services.mozilla.com/api/queue/v1/task/OO5UT6CEQWGoXo3lzOiwkw/runs/0/artifacts/public/logs/live_backing.log
[task 2020-09-15T21:06:29.572Z] 21:06:29 INFO - DEBUG: Adding blocker ContentParent: id=26928190000 for phase xpcom-will-shutdown
[task 2020-09-15T21:06:29.572Z] 21:06:29 INFO - DEBUG: Adding blocker ContentParent: id=26928190000 for phase profile-before-change
[task 2020-09-15T21:06:29.572Z] 21:06:29 INFO - 1600203989563 Marionette DEBUG 18 <- [1,21,null,{"value":"about:blank"}]
[task 2020-09-15T21:06:29.582Z] 21:06:29 INFO - [Child 10808, Main Thread] WARNING: NS_ENSURE_TRUE(info) failed: file /builds/worker/checkouts/gecko/extensions/permissions/PermissionDelegateHandler.cpp, line 348
[task 2020-09-15T21:06:29.582Z] 21:06:29 INFO - 1600203989575 Marionette DEBUG 18 -> [0,22,"Marionette:GetContext",{}]
[task 2020-09-15T21:06:29.582Z] 21:06:29 INFO - 1600203989576 Marionette DEBUG 18 <- [1,22,null,{"value":"content"}]
[task 2020-09-15T21:06:29.592Z] 21:06:29 INFO - 1600203989585 Marionette DEBUG 18 -> [0,23,"Marionette:SetContext",{"value":"chrome"}]
[task 2020-09-15T21:06:29.592Z] 21:06:29 INFO - 1600203989585 Marionette DEBUG 18 <- [1,23,null,{"value":null}]
[task 2020-09-15T21:06:29.655Z] 21:06:29 INFO - 1600203989652 Marionette DEBUG 18 -> [0,24,"WebDriver:TakeScreenshot",{"full":true,"hash":false,"id":null,"scroll":true}]
[task 2020-09-15T21:06:29.817Z] 21:06:29 INFO - 1600203989808 Marionette DEBUG 18 <- [1,24,null,{"value":"iVBORw0KGgoAAAANSUhEUgAABQAAAAQHCAYAAACjlsT7AAAgAElEQVR4nOzdb3Bd5X0ver08c+uZc+950VbnTZn6nEEMcHppb6MpmTbh ... wCIAAAADR8+wB4Op02v9jCmO88AiAAAAA0fMsAON+Wu74V2RjzcwRAAAAAaPiWAdAYc3sEQAAAAGgQAI0xwxEAAQAAoOEfGc0FxdeIhZoAAAAASUVORK5CYII="}]
[task 2020-09-15T21:06:29.836Z] 21:06:29 INFO - 1600203989832 Marionette DEBUG 18 -> [0,25,"Marionette:SetContext",{"value":"content"}]
[task 2020-09-15T21:06:29.836Z] 21:06:29 INFO - 1600203989833 Marionette DEBUG 18 <- [1,25,null,{"value":null}]
[task 2020-09-15T21:06:29.836Z] 21:06:29 INFO - 1600203989835 Marionette DEBUG 18 -> [0,26,"Marionette:GetContext",{}]
[task 2020-09-15T21:06:29.838Z] 21:06:29 INFO - 1600203989835 Marionette DEBUG 18 <- [1,26,null,{"value":"content"}]
[task 2020-09-15T21:06:29.840Z] 21:06:29 INFO - 1600203989837 Marionette DEBUG 18 -> [0,27,"Marionette:SetContext",{"value":"content"}]
[task 2020-09-15T21:06:29.840Z] 21:06:29 INFO - 1600203989837 Marionette DEBUG 18 <- [1,27,null,{"value":null}]
[task 2020-09-15T21:06:29.850Z] 21:06:29 INFO - 1600203989845 Marionette DEBUG 18 -> [0,28,"WebDriver:GetPageSource",{}]
[task 2020-09-15T21:06:29.850Z] 21:06:29 INFO - 1600203989847 Marionette DEBUG 18 <- [1,28,null,{"value":"<html><head>\n<title>Marionette Test</title>\n</head>\n<body>\n <h1 id=\"testh1\">Test Page</h1>\n <sc ... <input id=\"createDivButton\" type=\"button\" value=\"create a div\" onclick=\"addDelayedElement()\">\n\n\n</body></html>"}]
[task 2020-09-15T21:06:29.852Z] 21:06:29 INFO - 1600203989849 Marionette DEBUG 18 -> [0,29,"Marionette:SetContext",{"value":"content"}]
[task 2020-09-15T21:06:29.852Z] 21:06:29 INFO - 1600203989850 Marionette DEBUG 18 <- [1,29,null,{"value":null}]
[task 2020-09-15T21:06:29.853Z] 21:06:29 ERROR - TEST-UNEXPECTED-FAIL | testing/marionette/harness/marionette_harness/tests/unit/test_navigation.py TestNavigate.test_navigate_top_frame_from_nested_context | AssertionError: u'about:blank' != 'http://127.0.0.1:50030/test.html'
[task 2020-09-15T21:06:29.853Z] 21:06:29 INFO - Traceback (most recent call last):
[task 2020-09-15T21:06:29.853Z] 21:06:29 INFO - File "Z:\task_1600203065\build\venv\lib\site-packages\marionette_harness\marionette_test\testcases.py", line 196, in run
[task 2020-09-15T21:06:29.853Z] 21:06:29 INFO - testMethod()
[task 2020-09-15T21:06:29.853Z] 21:06:29 INFO - File "Z:\task_1600203065\build\tests\marionette\tests\testing\marionette\harness\marionette_harness\tests\unit\test_navigation.py", line 182, in test_navigate_top_frame_from_nested_context
[task 2020-09-15T21:06:29.853Z] 21:06:29 INFO - self.assertEqual(self.marionette.get_url(), self.test_page_remote)
[task 2020-09-15T21:06:29.853Z] 21:06:29 INFO - TEST-INFO took 957ms```
|
Assignee | |
Comment 1•4 years ago
|
||
I will have a look what's causing this failure. Probably related to my changes on bug 1493108.
Assignee: nobody → hskupin
Status: NEW → ASSIGNED
status-firefox82:
--- → affected
Keywords: assertion
Priority: P5 → P1
Whiteboard: [marionette-fission-mvp]
|
|
Assignee | |
Updated•4 years ago
|
|
|
Assignee | |
Updated•4 years ago
|
Blocks: marionette-fission
|
|
Assignee | |
Comment 2•4 years ago
|
||
The problem here is that we cancel the wait for navigation finished too early because there is a remoteness change:
1600232808166 Marionette DEBUG 2 -> [0,20,"WebDriver:ElementClick",{"id":"1dcb07a4-ea44-f44f-8b1c-5a48b9cc476d"}]
1600232808193 Marionette TRACE Received message beforeunload for data:text/html;charset=utf-8,%0A%20%20%20%20%20%20%20%20%20%20%3Ctitle%3Ebar%3C/title%3E%0A%20%20%20%20%20%20%20%20%20%20%3Ca ... 3D%22http%3A//127.0.0.1%3A57024/test.html%22%20target%3D%22_top%22%3Econsume%20top%20frame%3C/a%3E%0A%20%20%20%20%20%20%20%20
1600232808241 Marionette TRACE [36] Frame script unloaded
1600232808242 Marionette TRACE [36] Frame with id 8589934593 got removed
1600232808244 Marionette TRACE Received message pagehide for data:text/html;charset=utf-8,%0A%20%20%20%20%20%20%20%20%20%20%3Ctitle%3Ebar%3C/title%3E%0A%20%20%20%20%20%20%20%20%20%20%3Ca ... 3D%22http%3A//127.0.0.1%3A57024/test.html%22%20target%3D%22_top%22%3Econsume%20top%20frame%3C/a%3E%0A%20%20%20%20%20%20%20%20
1600232808244 Marionette TRACE Canceled page load listener because current frame has been removed
1600232808244 Marionette DEBUG 2 <- [1,20,null,{"value":null}]
1600232808251 Marionette DEBUG 2 -> [0,21,"WebDriver:GetCurrentURL",{}]
1600232808363 Marionette TRACE [36] Frame script loaded
1600232808365 Marionette TRACE Detected remoteness change. New browsing context: 36
|
|
Assignee | |
Comment 3•4 years ago
|
||
The causing changeset is:
https://hg.mozilla.org/integration/autoland/rev/bcf6908307f71714798acb55a7e8b41e8a2b9bfb
Actually this test was unskipped:
https://hg.mozilla.org/integration/autoland/rev/bcf6908307f71714798acb55a7e8b41e8a2b9bfb#l4.48
I propose that we skip this test for the moment, so we have a bit of time to get it fixed. Note that this only affects Fission.
Summary: Perma [Tier2] testing/marionette/harness/marionette_harness/tests/unit/test_navigation.py TestNavigate.test_navigate_top_frame_from_nested_context | AssertionError: u'about:blank' != 'http://127.0.0.1:50030/test.html' → Perma Mn-fis testing/marionette/harness/marionette_harness/tests/unit/test_navigation.py TestNavigate.test_navigate_top_frame_from_nested_context | AssertionError: u'about:blank' != 'http://127.0.0.1:50030/test.html'
|
|
Assignee | |
Comment 4•4 years ago
|
||
|
|
Assignee | |
Comment 5•4 years ago
|
||
Given that this problem happens with WebDriver:ElementClick we will have to wait until it has been made Fission compatible. Also switching from using navigation events to the webprogress listener might be needed here to detect that we just have a remoteness change.
|
|
Assignee | |
Updated•4 years ago
|
|
||
Updated•4 years ago
|
Assignee: nobody → hskupin
Status: NEW → ASSIGNED
|
|
Assignee | |
Updated•4 years ago
|
Assignee: hskupin → nobody
Status: ASSIGNED → NEW
Pushed by hskupin@mozilla.com:
https://hg.mozilla.org/integration/autoland/rev/70f1ab1a4e32
[marionette] Skip TestNavigate.test_navigate_top_frame_from_nested_context for Fission. r=marionette-reviewers,jgraham
|
|
||
Updated•4 years ago
|
Assignee: nobody → hskupin
Status: NEW → ASSIGNED
|
|
Assignee | |
Updated•4 years ago
|
Assignee: hskupin → nobody
Status: ASSIGNED → NEW
|
||
Comment 7•4 years ago
|
||
| bugherder | ||
| Comment hidden (Intermittent Failures Robot) |
|
||
Comment 9•4 years ago
|
||
Tentatively tracking marionette-fission-mvp bugs for Fission M7 Beta milestone. We would like Marionette tests to work with Fission before we ride the trains to Beta.
Fission Milestone: --- → M7
| Comment hidden (Intermittent Failures Robot) |
|
|
Assignee | |
Comment 11•4 years ago
|
||
A fix will be provided via bug 1665489. So we can unskip soon.
|
|
Assignee | |
Comment 12•4 years ago
|
||
Test is fixed and unskipped for Fission now.
Assignee: nobody → hskupin
Status: NEW → RESOLVED
Closed: 4 years ago
status-firefox83:
--- → fixed
Keywords: leave-open
Resolution: --- → FIXED
Whiteboard: [marionette-fission-mvp]
Target Milestone: --- → 83 Branch
|
||
Updated•4 years ago
|
status-firefox-esr78:
--- → unaffected
|
||
Updated•2 years ago
|
Product: Testing → Remote Protocol
|
|
||
Comment 13•2 years ago
|
||
Moving bug to Testing::Marionette Client and Harness component per bug 1815831.
Component: Marionette → Marionette Client and Harness
Product: Remote Protocol → Testing
You need to log in
before you can comment on or make changes to this bug.
Description
•