Closed Bug 1784256 Opened 3 years ago Closed 3 years ago

Intermittent TEST-UNEXPECTED-TIMEOUT | /feature-policy/feature-policy-frame-policy-allowed-for-all.https.sub.html | TestRunner hit external timeout (this may indicate a hang)

Categories

(Core :: DOM: Security, defect, P5)

Product:
Core
Component:
DOM: Security
Type:
defect

Tracking

()

Status:
RESOLVED DUPLICATE of bug 1785718

People

(Reporter: intermittent-bug-filer, Unassigned)

References

Details

(Keywords: intermittent-failure, Whiteboard: [domsecurity-intermittent])

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

[task 2022-08-11T10:55:17.306Z] 10:55:17     INFO - TEST-START | /feature-policy/feature-policy-frame-policy-allowed-for-all.https.sub.html
[task 2022-08-11T10:55:17.326Z] 10:55:17     INFO - Setting pref dom.security.featurePolicy.experimental.enabled to true
[task 2022-08-11T10:55:17.348Z] 10:55:17     INFO - Setting pref dom.payments.request.enabled to true
[task 2022-08-11T10:55:17.368Z] 10:55:17     INFO - Setting pref dom.reporting.enabled to true
[task 2022-08-11T10:55:17.388Z] 10:55:17     INFO - Setting pref dom.reporting.featurePolicy.enabled to true
[task 2022-08-11T10:55:17.411Z] 10:55:17     INFO - Setting pref dom.security.featurePolicy.header.enabled to true
[task 2022-08-11T10:55:17.434Z] 10:55:17     INFO - Setting pref dom.security.featurePolicy.webidl.enabled to true
[task 2022-08-11T10:55:17.452Z] 10:55:17     INFO - Setting pref dom.webmidi.enabled to true
[task 2022-08-11T10:55:17.476Z] 10:55:17     INFO - Setting pref dom.vr.enabled to true
[task 2022-08-11T10:57:32.308Z] 10:57:32     INFO - Got timeout in harness
[task 2022-08-11T10:57:32.310Z] 10:57:32     INFO - TEST-UNEXPECTED-TIMEOUT | /feature-policy/feature-policy-frame-policy-allowed-for-all.https.sub.html | TestRunner hit external timeout (this may indicate a hang)
[task 2022-08-11T10:57:32.311Z] 10:57:32     INFO - TEST-INFO took 135005ms
[task 2022-08-11T10:57:56.471Z] 10:57:56     INFO - PID 13588 | 1660215476470	addons.xpi	ERROR	System addon update list error Error: Failed downloading XML, status: 0, reason: error
[task 2022-08-11T10:58:43.395Z] 10:58:43     INFO - Browser exited with return code -15
[task 2022-08-11T10:58:43.439Z] 10:58:43 CRITICAL - Loading initial page https://web-platform.test:8443/testharness_runner.html failed. Ensure that the there are no other programs bound to this port and that your firewall rules or network setup does not prevent access.
[task 2022-08-11T10:58:43.439Z] 10:58:43 CRITICAL - Traceback (most recent call last):
[task 2022-08-11T10:58:43.439Z] 10:58:43 CRITICAL -   File "/builds/worker/workspace/build/tests/web-platform/tests/tools/wptrunner/wptrunner/executors/executormarionette.py", line 166, in load_runner
[task 2022-08-11T10:58:43.439Z] 10:58:43 CRITICAL -     self.dismiss_alert(lambda: self.marionette.navigate(url))
[task 2022-08-11T10:58:43.439Z] 10:58:43 CRITICAL -   File "/builds/worker/workspace/build/tests/web-platform/tests/tools/wptrunner/wptrunner/executors/executormarionette.py", line 214, in dismiss_alert
[task 2022-08-11T10:58:43.439Z] 10:58:43 CRITICAL -     f()
[task 2022-08-11T10:58:43.439Z] 10:58:43 CRITICAL -   File "/builds/worker/workspace/build/tests/web-platform/tests/tools/wptrunner/wptrunner/executors/executormarionette.py", line 166, in <lambda>
[task 2022-08-11T10:58:43.439Z] 10:58:43 CRITICAL -     self.dismiss_alert(lambda: self.marionette.navigate(url))
[task 2022-08-11T10:58:43.439Z] 10:58:43 CRITICAL -   File "/builds/worker/workspace/build/venv/lib/python3.6/site-packages/marionette_driver/marionette.py", line 1572, in navigate
[task 2022-08-11T10:58:43.439Z] 10:58:43 CRITICAL -     self._send_message("WebDriver:Navigate", {"url": url})
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL -   File "/builds/worker/workspace/build/venv/lib/python3.6/site-packages/marionette_driver/decorators.py", line 37, in _
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL -     m._handle_socket_failure()
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL -   File "/builds/worker/workspace/build/venv/lib/python3.6/site-packages/marionette_driver/marionette.py", line 710, in _handle_socket_failure
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL -     reraise(exc_cls, exc, tb)
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL -   File "/builds/worker/workspace/build/tests/web-platform/tests/tools/third_party/six/six.py", line 703, in reraise
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL -     raise value
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL -   File "/builds/worker/workspace/build/venv/lib/python3.6/site-packages/marionette_driver/decorators.py", line 27, in _
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL -     return func(*args, **kwargs)
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL -   File "/builds/worker/workspace/build/venv/lib/python3.6/site-packages/marionette_driver/marionette.py", line 659, in _send_message
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL -     msg = self.client.request(name, params)
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL -   File "/builds/worker/workspace/build/venv/lib/python3.6/site-packages/marionette_driver/transport.py", line 383, in request
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL -     return self.receive()
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL -   File "/builds/worker/workspace/build/venv/lib/python3.6/site-packages/marionette_driver/transport.py", line 230, in receive
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL -     raise socket.error("No data received over socket")
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL - OSError: No data received over socket
[task 2022-08-11T10:58:43.440Z] 10:58:43 CRITICAL - 
[task 2022-08-11T10:58:43.449Z] 10:58:43  WARNING - Traceback (most recent call last):
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -   File "/builds/worker/workspace/build/tests/web-platform/tests/tools/wptrunner/wptrunner/executors/base.py", line 300, in run_test
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -     self.on_environment_change(test.environment)
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -   File "/builds/worker/workspace/build/tests/web-platform/tests/tools/wptrunner/wptrunner/executors/executormarionette.py", line 897, in on_environment_change
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -     self.protocol.testharness.load_runner(new_environment["protocol"])
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -   File "/builds/worker/workspace/build/tests/web-platform/tests/tools/wptrunner/wptrunner/executors/executormarionette.py", line 166, in load_runner
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -     self.dismiss_alert(lambda: self.marionette.navigate(url))
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -   File "/builds/worker/workspace/build/tests/web-platform/tests/tools/wptrunner/wptrunner/executors/executormarionette.py", line 214, in dismiss_alert
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -     f()
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -   File "/builds/worker/workspace/build/tests/web-platform/tests/tools/wptrunner/wptrunner/executors/executormarionette.py", line 166, in <lambda>
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -     self.dismiss_alert(lambda: self.marionette.navigate(url))
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -   File "/builds/worker/workspace/build/venv/lib/python3.6/site-packages/marionette_driver/marionette.py", line 1572, in navigate
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -     self._send_message("WebDriver:Navigate", {"url": url})
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -   File "/builds/worker/workspace/build/venv/lib/python3.6/site-packages/marionette_driver/decorators.py", line 37, in _
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -     m._handle_socket_failure()
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -   File "/builds/worker/workspace/build/venv/lib/python3.6/site-packages/marionette_driver/marionette.py", line 710, in _handle_socket_failure
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -     reraise(exc_cls, exc, tb)
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -   File "/builds/worker/workspace/build/tests/web-platform/tests/tools/third_party/six/six.py", line 703, in reraise
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -     raise value
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -   File "/builds/worker/workspace/build/venv/lib/python3.6/site-packages/marionette_driver/decorators.py", line 27, in _
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -     return func(*args, **kwargs)
[task 2022-08-11T10:58:43.450Z] 10:58:43  WARNING -   File "/builds/worker/workspace/build/venv/lib/python3.6/site-packages/marionette_driver/marionette.py", line 659, in _send_message
[task 2022-08-11T10:58:43.451Z] 10:58:43  WARNING -     msg = self.client.request(name, params)
[task 2022-08-11T10:58:43.451Z] 10:58:43  WARNING -   File "/builds/worker/workspace/build/venv/lib/python3.6/site-packages/marionette_driver/transport.py", line 383, in request
[task 2022-08-11T10:58:43.451Z] 10:58:43  WARNING -     return self.receive()
[task 2022-08-11T10:58:43.451Z] 10:58:43  WARNING -   File "/builds/worker/workspace/build/venv/lib/python3.6/site-packages/marionette_driver/transport.py", line 230, in receive
[task 2022-08-11T10:58:43.452Z] 10:58:43  WARNING -     raise socket.error("No data received over socket")
[task 2022-08-11T10:58:43.452Z] 10:58:43  WARNING - OSError: No data received over socket
[task 2022-08-11T10:58:43.453Z] 10:58:43  WARNING - 
[task 2022-08-11T10:58:43.455Z] 10:58:43  WARNING - Command left in command_queue during cleanup: 'test_ended', (<wptrunner.wpttest.TestharnessTest /feature-policy/feature-policy-frame-policy-allowed-for-all.https.sub.html>, (<wptrunner.wpttest.TestharnessResult INTERNAL-ERROR>, []))
[task 2022-08-11T10:58:43.456Z] 10:58:43     INFO - Closing logging queue
[task 2022-08-11T10:58:43.457Z] 10:58:43     INFO - queue closed
[task 2022-08-11T10:58:43.464Z] 10:58:43     INFO - Application command: /builds/worker/workspace/build/application/firefox/firefox --marionette about:blank -profile /tmp/tmpkzixd7q5
[task 2022-08-11T10:58:43.499Z] 10:58:43     INFO - PID 15047 | [CodeCoverage] Setting handlers for process 15047.
[task 2022-08-11T10:58:43.501Z] 10:58:43     INFO - PID 15047 | 1660215317675	Marionette	INFO	Marionette enabled
[task 2022-08-11T10:58:43.505Z] 10:58:43     INFO - PID 15047 | 1660215317679	Marionette	INFO	Listening on port 36084
[task 2022-08-11T10:58:43.506Z] 10:58:43     INFO - PID 15047 | console.warn: SearchSettings: "get: No settings file exists, new profile?" (new NotFoundError("Could not open the file at /tmp/tmpfa_qr8bw/search.json.mozlz4", (void 0)))
[task 2022-08-11T10:58:43.506Z] 10:58:43     INFO - Starting runner
[task 2022-08-11T10:58:44.515Z] 10:58:44     INFO - PID 15047 | [CodeCoverage] Setting handlers for process 15157.
[task 2022-08-11T10:58:44.648Z] 10:58:44     INFO - PID 15047 | [CodeCoverage] Setting handlers for process 15161.
[task 2022-08-11T10:58:46.092Z] 10:58:46     INFO - PID 15047 | [CodeCoverage] Setting handlers for process 15302.
[task 2022-08-11T10:58:46.419Z] 10:58:46     INFO - TEST-START | /feature-policy/feature-policy-frame-policy-allowed-for-self.https.sub.html
Status: NEW → RESOLVED
Closed: 3 years ago
Resolution: --- → DUPLICATE
You need to log in before you can comment on or make changes to this bug.