1612612 - Intermittent browser/base/content/test/siteIdentity/browser_bug906190.js | Test timed out -

Status: RESOLVED INCOMPLETE

(Firefox :: Site Identity, defect, P5)

Description

[Treeherder Bug Filer]

Filed by: nerli [at] mozilla.com
Parsed log: https://treeherder.mozilla.org/logviewer.html#?job_id=287113302&repo=mozilla-central
Full log: https://firefox-ci-tc.services.mozilla.com/api/queue/v1/task/WDSFvVvBT_WvlpKGgjpvjA/runs/0/artifacts/public/logs/live_backing.log

---

[task 2020-01-31T17:58:30.911Z] 17:58:30 INFO - TEST-START | browser/base/content/test/siteIdentity/browser_bug906190.js
[task 2020-01-31T18:00:00.920Z] 18:00:00 INFO - TEST-INFO | started process screentopng
[task 2020-01-31T18:00:01.252Z] 18:00:01 INFO - TEST-INFO | screentopng: exit 0
[task 2020-01-31T18:00:01.252Z] 18:00:01 INFO - Buffered messages logged at 17:58:30
[task 2020-01-31T18:00:01.252Z] 18:00:01 INFO - Entering test bound test_initialize
[task 2020-01-31T18:00:01.252Z] 18:00:01 INFO - Leaving test bound test_initialize
[task 2020-01-31T18:00:01.252Z] 18:00:01 INFO - Entering test bound test_same_origin
[task 2020-01-31T18:00:01.252Z] 18:00:01 INFO - Console message: [JavaScript Error: "Blocked loading mixed active content “http://test1.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190.js”" {file: "https://test1.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190_1.html" line: 0}]
[task 2020-01-31T18:00:01.252Z] 18:00:01 INFO - Console message: [JavaScript Error: "Blocked loading mixed active content “http://test1.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190.js”" {file: "https://test1.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190_1.html" line: 0}]
[task 2020-01-31T18:00:01.252Z] 18:00:01 INFO - Console message: [JavaScript Warning: "Loading failed for the <script> with source “http://test1.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190.js”." {file: "https://test1.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190_1.html" line: 13}]
[task 2020-01-31T18:00:01.254Z] 18:00:01 INFO - Buffered messages logged at 17:58:31
[task 2020-01-31T18:00:01.254Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | Expected state for activeBlocked matches UI state -
[task 2020-01-31T18:00:01.254Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | Expected state for activeLoaded matches UI state -
[task 2020-01-31T18:00:01.254Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | Expected state for passiveLoaded matches UI state -
[task 2020-01-31T18:00:01.257Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | identityBox has expected class for activeLoaded -
[task 2020-01-31T18:00:01.257Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | identityBox has expected class for activeBlocked && !passiveLoaded -
[task 2020-01-31T18:00:01.257Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | identityBox has expected class for passiveLoaded && !(activeLoaded || activeBlocked) -
[task 2020-01-31T18:00:01.258Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | identityBox has expected class for passiveLoaded && activeBlocked -
[task 2020-01-31T18:00:01.258Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | information icon should be visible -
[task 2020-01-31T18:00:01.258Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | Using active blocked icon -
[task 2020-01-31T18:00:01.258Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | identity-popup has expected attr for activeLoaded -
[task 2020-01-31T18:00:01.258Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | securityView-body has expected attr for activeLoaded -
[task 2020-01-31T18:00:01.258Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | identity-popup has expected attr for activeBlocked -
[task 2020-01-31T18:00:01.258Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | securityView-body has expected attr for activeBlocked -
[task 2020-01-31T18:00:01.258Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | identity-popup has expected attr for passiveLoaded -
[task 2020-01-31T18:00:01.258Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | securityView-body has expected attr for passiveLoaded -
[task 2020-01-31T18:00:01.259Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | CC using secure icon -
[task 2020-01-31T18:00:01.260Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | CC using secure icon -
[task 2020-01-31T18:00:01.260Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | The 'Learn more' link should be visible once. -
[task 2020-01-31T18:00:01.260Z] 18:00:01 INFO - Hiding identity popup
[task 2020-01-31T18:00:01.261Z] 18:00:01 INFO - Console message: [JavaScript Warning: "Loading mixed (insecure) active content “http://test1.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190.js” on a secure page" {file: "https://test1.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190_1.html" line: 0}]
[task 2020-01-31T18:00:01.262Z] 18:00:01 INFO - Console message: [JavaScript Warning: "Loading mixed (insecure) active content “http://test1.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190.js” on a secure page" {file: "https://test1.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190_1.html" line: 0}]
[task 2020-01-31T18:00:01.262Z] 18:00:01 INFO - Console message: [JavaScript Warning: "Loading mixed (insecure) active content “http://test2.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190.js” on a secure page" {file: "https://test1.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190_2.html" line: 0}]
[task 2020-01-31T18:00:01.263Z] 18:00:01 INFO - Console message: [JavaScript Warning: "Loading mixed (insecure) active content “http://test2.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190.js” on a secure page" {file: "https://test1.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190_2.html" line: 0}]
[task 2020-01-31T18:00:01.263Z] 18:00:01 INFO - Buffered messages logged at 17:58:32
[task 2020-01-31T18:00:01.264Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | Expected state for activeBlocked matches UI state -
[task 2020-01-31T18:00:01.265Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | Expected state for activeLoaded matches UI state -
[task 2020-01-31T18:00:01.266Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | Expected state for passiveLoaded matches UI state -
[task 2020-01-31T18:00:01.267Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | identityBox has expected class for activeLoaded -
[task 2020-01-31T18:00:01.268Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | identityBox has expected class for activeBlocked && !passiveLoaded -
[task 2020-01-31T18:00:01.269Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | identityBox has expected class for passiveLoaded && !(activeLoaded || activeBlocked) -
[task 2020-01-31T18:00:01.270Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | identityBox has expected class for passiveLoaded && activeBlocked -
[task 2020-01-31T18:00:01.271Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | information icon should be visible -
[task 2020-01-31T18:00:01.271Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | Using active loaded icon -
[task 2020-01-31T18:00:01.272Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | identity-popup has expected attr for activeLoaded -
[task 2020-01-31T18:00:01.272Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | securityView-body has expected attr for activeLoaded -
[task 2020-01-31T18:00:01.272Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | identity-popup has expected attr for activeBlocked -
[task 2020-01-31T18:00:01.272Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | securityView-body has expected attr for activeBlocked -
[task 2020-01-31T18:00:01.273Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | identity-popup has expected attr for passiveLoaded -
[task 2020-01-31T18:00:01.273Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | securityView-body has expected attr for passiveLoaded -
[task 2020-01-31T18:00:01.273Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | CC using active loaded icon -
[task 2020-01-31T18:00:01.274Z] 18:00:01 INFO - TEST-PASS | browser/base/content/test/siteIdentity/browser_bug906190.js | CC using active loaded icon -
[task 2020-01-31T18:00:01.274Z] 18:00:01 INFO - Console message: [JavaScript Error: "Cannot show a subview in a closed panel." {file: "resource:///modules/PanelMultiView.jsm" line: 660}]
[task 2020-01-31T18:00:01.275Z] 18:00:01 INFO - _showSubView@resource:///modules/PanelMultiView.jsm:660:22
[task 2020-01-31T18:00:01.275Z] 18:00:01 INFO - showSubView@resource:///modules/PanelMultiView.jsm:647:10
[task 2020-01-31T18:00:01.275Z] 18:00:01 INFO - value@resource:///modules/PanelMultiView.jsm:421:41
[task 2020-01-31T18:00:01.276Z] 18:00:01 INFO - showSecuritySubView@chrome://browser/content/browser-siteIdentity.js:422:34
[task 2020-01-31T18:00:01.276Z] 18:00:01 INFO - oncommand@chrome://browser/content/browser.xhtml:1:18
[task 2020-01-31T18:00:01.276Z] 18:00:01 INFO - assertMixedContentBlockingState@chrome://mochitests/content/browser/browser/base/content/test/siteIdentity/head.js:375:60
[task 2020-01-31T18:00:01.277Z] 18:00:01 INFO - asynctest_same_origin/<@chrome://mochitests/content/browser/browser/base/content/test/siteIdentity/browser_bug906190.js:147:13
[task 2020-01-31T18:00:01.277Z] 18:00:01 INFO - doTest/<@chrome://mochitests/content/browser/browser/base/content/test/siteIdentity/browser_bug906190.js:84:15
[task 2020-01-31T18:00:01.278Z] 18:00:01 INFO - asyncwithNewTab@resource://testing-common/BrowserTestUtils.jsm:150:24
[task 2020-01-31T18:00:01.278Z] 18:00:01 INFO - asyncdoTest@chrome://mochitests/content/browser/browser/base/content/test/siteIdentity/browser_bug906190.js:33:26
[task 2020-01-31T18:00:01.278Z] 18:00:01 INFO - test_same_origin@chrome://mochitests/content/browser/browser/base/content/test/siteIdentity/browser_bug906190.js:140:9
[task 2020-01-31T18:00:01.278Z] 18:00:01 INFO - Tester_execTest/<@chrome://mochikit/content/browser-test.js:1062:34
[task 2020-01-31T18:00:01.278Z] 18:00:01 INFO - asyncTester_execTest@chrome://mochikit/content/browser-test.js:1097:11
[task 2020-01-31T18:00:01.278Z] 18:00:01 INFO - nextTest/<@chrome://mochikit/content/browser-test.js:925:14
[task 2020-01-31T18:00:01.278Z] 18:00:01 INFO - SimpleTest.waitForFocus/waitForFocusInner/focusedOrLoaded/<@chrome://mochikit/content/tests/SimpleTest/SimpleTest.js:808:67
[task 2020-01-31T18:00:01.278Z] 18:00:01 INFO -
[task 2020-01-31T18:00:01.278Z] 18:00:01 INFO - Buffered messages logged at 17:59:15
[task 2020-01-31T18:00:01.278Z] 18:00:01 INFO - Longer timeout required, waiting longer... Remaining timeouts: 1
[task 2020-01-31T18:00:01.278Z] 18:00:01 INFO - Buffered messages finished
[task 2020-01-31T18:00:01.278Z] 18:00:01 INFO - TEST-UNEXPECTED-FAIL | browser/base/content/test/siteIdentity/browser_bug906190.js | Test timed out -
[task 2020-01-31T18:00:01.278Z] 18:00:01 INFO - GECKO(4477) | MEMORY STAT | vsize 2939MB | residentFast 309MB | heapAllocated 95MB
[task 2020-01-31T18:00:01.279Z] 18:00:01 INFO - TEST-OK | browser/base/content/test/siteIdentity/browser_bug906190.js | took 90009ms
[task 2020-01-31T18:00:01.279Z] 18:00:01 INFO - Not taking screenshot here: see the one that was previously logged
[task 2020-01-31T18:00:01.280Z] 18:00:01 INFO - TEST-UNEXPECTED-FAIL | browser/base/content/test/siteIdentity/browser_bug906190.js | Found a tab after previous test timed out: https://test1.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190_2.html -
[task 2020-01-31T18:00:01.280Z] 18:00:01 INFO - Not taking screenshot here: see the one that was previously logged
[task 2020-01-31T18:00:01.280Z] 18:00:01 INFO - TEST-UNEXPECTED-FAIL | browser/base/content/test/siteIdentity/browser_bug906190.js | Found a tab after previous test timed out: https://test1.example.com/browser/browser/base/content/test/siteIdentity/file_bug906190_1.html -
[task 2020-01-31T18:00:01.281Z] 18:00:01 INFO - checking window state

Comment 1

[Zibi Braniecki [:zbraniecki][:gandalf]]

Why did you set the regressed by to bug 1608022?

Comment 2

[Intermittent Failures Robot]

1 failures in 2190 pushes (0.0 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• mozilla-central: 1

Platform breakdown:

• linux64-shippable: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures.html#/bugdetails?bug=1612612&startday=2020-01-27&endday=2020-02-02&tree=all

Comment 3

[Zibi Braniecki [:zbraniecki][:gandalf]]

There has been only a single intermittent failure and it looks similar to previous intermittents in the same test. I don't think bug 1608022 is visibly related, so I'll remove it from deps.

Comment 4

[Noemi Erli[:noemi_erli]]

Sorry for the trouble

Comment 5

[BugBot [:suhaib / :marco/ :calixte]]

https://wiki.mozilla.org/Bug_Triage#Intermittent_Test_Failure_Cleanup
For more information, please visit auto_nag documentation.

Comment 6

[Arthur Iakab [arthur_iakab]]

Recent failure https://treeherder.mozilla.org/#/jobs?repo=mozilla-central&resultStatus=testfailed%2Cbusted%2Cexception&revision=fb4f281c1c54a5199e6e713c1b8115f80d7faa37&searchStr=linux%2C18.04%2Cx64%2Copt%2Cmochitests%2Cwith%2Cfission%2Cenabled%2Ctest-linux1804-64%2Fopt-mochitest-browser-chrome-fis-e10s-6%2Cm-fis%28bc6%29&selectedJob=290940449

Failure log https://treeherder.mozilla.org/logviewer.html#?job_id=290940449&repo=mozilla-central

Comment 7

[Intermittent Failures Robot]

1 failures in 5233 pushes (0.0 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• mozilla-central: 1

Platform breakdown:

• linux1804-64: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures.html#/bugdetails?bug=1612612&startday=2020-02-24&endday=2020-03-01&tree=all

Comment 8

[Intermittent Failures Robot]

1 failures in 4955 pushes (0.0 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• try: 1

Platform breakdown:

• linux1804-64: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures.html#/bugdetails?bug=1612612&startday=2020-03-16&endday=2020-03-22&tree=all

Comment 9

[BugBot [:suhaib / :marco/ :calixte]]

https://wiki.mozilla.org/Bug_Triage#Intermittent_Test_Failure_Cleanup
For more information, please visit auto_nag documentation.

Comment 10

[Intermittent Failures Robot]

1 failures in 5458 pushes (0.0 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• autoland: 1

Platform breakdown:

• linux1804-64-shippable: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures.html#/bugdetails?bug=1612612&startday=2020-05-25&endday=2020-05-31&tree=all

Comment 11

[BugBot [:suhaib / :marco/ :calixte]]

https://wiki.mozilla.org/Bug_Triage#Intermittent_Test_Failure_Cleanup
For more information, please visit auto_nag documentation.

Comment 12

[Alexandru Michis [:malexandru]]

Recent failure log: https://treeherder.mozilla.org/logviewer?job_id=323305411&repo=autoland&lineNumber=4424

Comment 13

[Intermittent Failures Robot]

2 failures in 3712 pushes (0.001 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• autoland: 2

Platform breakdown:

• linux1804-64: 2

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1612612&startday=2020-11-30&endday=2020-12-06&tree=all

Comment 14

[Intermittent Failures Robot]

1 failures in 4060 pushes (0.0 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• autoland: 1

Platform breakdown:

• linux1804-64: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1612612&startday=2020-12-07&endday=2020-12-13&tree=all

Comment 15

[BugBot [:suhaib / :marco/ :calixte]]

https://wiki.mozilla.org/Bug_Triage#Intermittent_Test_Failure_Cleanup
For more information, please visit auto_nag documentation.

Comment 16

[Alexandru Michis [:malexandru]]

Recent failure log: https://treeherder.mozilla.org/logviewer?job_id=335871413&repo=mozilla-beta&lineNumber=3323

Comment 17

[Intermittent Failures Robot]

1 failures in 3854 pushes (0.0 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• mozilla-beta: 1

Platform and build breakdown:

• linux1804-64-shippable: 1
  • opt: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1612612&startday=2021-04-05&endday=2021-04-11&tree=all

Comment 18

[Intermittent Failures Robot]

2 failures in 4255 pushes (0.0 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• autoland: 2

Platform and build breakdown:

• macosx1014-64-qr: 2
  • debug: 1
  • opt: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1612612&startday=2021-04-12&endday=2021-04-18&tree=all

Comment 19

[Intermittent Failures Robot]

1 failures in 3706 pushes (0.0 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• autoland: 1

Platform and build breakdown:

• linux1804-64-shippable: 1
  • opt: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1612612&startday=2021-04-26&endday=2021-05-02&tree=all

Comment 20

[BugBot [:suhaib / :marco/ :calixte]]

https://wiki.mozilla.org/Bug_Triage#Intermittent_Test_Failure_Cleanup
For more information, please visit auto_nag documentation.

Comment 21

[Intermittent Failures Robot]

1 failures in 2387 pushes (0.0 failures/push) were associated with this bug in the last 7 days.

Repository breakdown:

• mozilla-release: 1

Platform and build breakdown:

• macosx1015-64-shippable-qr: 1
  • opt: 1

For more details, see:
https://treeherder.mozilla.org/intermittent-failures/bugdetails?bug=1612612&startday=2021-07-05&endday=2021-07-11&tree=all