[17:45:34.815] New invocation is queued and will start shortly
[17:45:34.815] Triggered by user:chromium-ci-builder@chops-service-accounts.iam.gserviceaccount.com
[17:45:35.979] Starting the invocation (attempt 1)
[17:45:36.011] Popped buildset tag "buildset:commit/gitiles/chromium.googlesource.com/chromium/src/+/b1a9dec29bf7faeef5ad1be2592dd64bb864d64c"
[17:45:36.011] Reconstructed gitiles commit from tags
[17:45:36.011] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[17:45:36.012] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[17:45:36.012] Buildbucket request:
{
"requestId": "9017559285670409456",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "Linux MSan Tests"
},
"properties": {
"$build/chromium_tests": {
"fixed_revisions": {
"src": "b1a9dec29bf7faeef5ad1be2592dd64bb864d64c"
}
},
"parent_builder_group": "chromium.memory",
"parent_buildername": "Linux MSan Builder",
"parent_got_angle_revision": "90cf278c36871437c89b8f88d62e6a538b51501d",
"parent_got_dawn_revision": "6b80743d3f5bb389665590585c43eeb9cfa70a34",
"parent_got_nacl_revision": "abf3277f295c6c87f0b103f291ed5e3e73933b76",
"parent_got_revision": "b1a9dec29bf7faeef5ad1be2592dd64bb864d64c",
"parent_got_revision_cp": "refs/heads/master@{#864998}",
"parent_got_swarming_client_revision": "a32a1607f6093d338f756c7e7c7b4333b0c50c9c",
"parent_got_swiftshader_revision": "a98fb3f8380a3a5c9ae3e0175634ba88c85a434f",
"parent_got_v8_revision": "6092f990f654f2d7a4534ee8c5bbb5c4fb800bdc",
"parent_got_v8_revision_cp": "refs/heads/9.1.170@{#1}",
"parent_got_webrtc_revision": "8bf1cd1c665a538a366bce4770acbb990b025388",
"parent_got_webrtc_revision_cp": "refs/heads/master@{#33513}",
"swarm_hashes": {
"absl_hardening_tests": "cc842d5d32542a5a48a887ea34f2206853b312f8",
"accessibility_unittests": "d4193b5fa0e10bc2fd42208aa172696019ae82e0",
"angle_unittests": "80524baf6bf2dd561bc8284fd594250272331973",
"app_shell_unittests": "7bb67ad8bb42bbbc8e94f04d17da18c28cc17d5a",
"aura_unittests": "bcea24ac41827bc8dc6831a58cc7d3a698cbe636",
"base_unittests": "73f32ee2a82a3dbc2604f9606e995c3ed77a6f68",
"base_util_unittests": "891ea1f006cbfd351994013296f9c213d1a9b63c",
"blink_common_unittests": "aadd25e5c7d63100b4a90da49ab9cd9255a289fe",
"blink_fuzzer_unittests": "ba1d2f15fd7dc2a2049573d303084153753f134e",
"blink_heap_unittests": "041adb658051346f124193a3f8fa60c0b44b7180",
"blink_platform_unittests": "9a00478d9436327f214d2fe114459c5267f1d1c4",
"blink_unittests": "1bce81c3aaa5b70f69f3b67ffa854c7cfba04c9b",
"boringssl_crypto_tests": "06c59ae82d9250ef889efae03d4b9cd8debec2d1",
"boringssl_ssl_tests": "1a1a78534dd54800a417024e043fd43fe27ba58b",
"browser_tests": "35ff90f1f1b721ff234005f789f025aa8e983461",
"capture_unittests": "d42331f0eb3479e208c3b982f0b10a56fb63b264",
"cast_unittests": "c650526dc8ed925caf978babe1d3dc973dc48319",
"cc_unittests": "77de877b55c67528bd396f16783f61b0dc9055e6",
"chrome_app_unittests": "3f21e8782fac3d18b166bd034a150e8682d2ae37",
"chromedriver_unittests": "ef59b70113b770b41898cdaa0be8239003921dba",
"color_unittests": "083470bf047b2dbe22b532375400dbdc28d8749c",
"components_browsertests": "37e284f3fca874de06020167c0a374be7780a105",
"components_unittests": "cbbce779bd052222f4cc5dc148e4f1a2927ac1ad",
"compositor_unittests": "5b34d37f3031f39fdb332f280451fbf4d35a6e3e",
"content_browsertests": "582d811cff5cdfdde87cc8652ea96afd6386cd1e",
"content_unittests": "0ac503d30e4d0e8ce8808c69b7225223d885cdad",
"crashpad_tests": "cead7a61c2eaec14d4196964874ce3383c7892ef",
"cronet_tests": "1e17d10f3f3fc170653ff790ea9e94301ded7fa4",
"cronet_unittests": "517f3f1ade7a09d1da30c9982c47508be0530750",
"crypto_unittests": "612141f041131f36b7517a72b626555efcc7a105",
"dbus_unittests": "db58b33b737331cf99f35af141f174277e34fbc9",
"device_unittests": "45dcde268ca912ebc6876e814b326476105d2bc7",
"display_unittests": "f217273c6e0c9f841a11b61d574c7730cfa11fc8",
"events_unittests": "b1031bf6613e21baf04d3807391fe884c5d8f57b",
"extensions_browsertests": "e7aae88b0996ca89b798f8d2e887caa54e6827c6",
"extensions_unittests": "dea8bc0699b87b1b9a84c14bac5b4040e596606e",
"filesystem_service_unittests": "1525de21023a640975a46eb8364a78ab83172fd1",
"gcm_unit_tests": "36b158264e3a0c97a860d642b07525b665d40416",
"gfx_unittests": "0d0be758d1c3a89e65555c096e91dfd9a323041b",
"gin_unittests": "5f11528286eb68877b518db0fe1d4892a16de3ca",
"google_apis_unittests": "11833e1e55e6200d57dd98fa9a3f4704832d2945",
"gpu_unittests": "b7d6aeccd9dbe9c170a480b6d912b54ae270651d",
"gwp_asan_unittests": "92f147412ec156d64b729fbb9e86ec1ecb72fcaf",
"headless_browsertests": "82e07d4576a244c21f0596b742e35c6acc7ee4b5",
"headless_unittests": "a3ce2aa1b2816493b277a57e63448c6af85e3ad7",
"interactive_ui_tests": "0aa5e5b3abf5d8e44f10dfb2e7843c33d1a6f821",
"ipc_tests": "e444e4caadc1b99d7af49e41b08506a5cf6c703b",
"jingle_unittests": "a54e52e7fa07520597a6a135bac56af566a28d21",
"latency_unittests": "38553ca2c0fb9470064d1d02e8dc1dc0c39aaecd",
"libjingle_xmpp_unittests": "53c84fc7ca7e2ee7d9a16730a187029e289e6714",
"liburlpattern_unittests": "9a59eb953bc7e664793910a82d36c412bb2ca46a",
"media_blink_unittests": "e79add722354af90726ab4151b5a906c7d9bb6da",
"media_unittests": "d9e69d2e18e548c8bf22bf2787da90ba0b18dbe5",
"message_center_unittests": "ed36cd3191b9d2cfc283a8614b66afccd00ae204",
"midi_unittests": "4e3bdedd88c36a46323c08bd55937e723f377416",
"mojo_core_unittests": "643ad3f789835e18b008980162bab17df4bbea5d",
"mojo_unittests": "2200e7714544ce52382f333a499a529e60d3d9c6",
"nacl_helper_nonsfi_unittests": "074abec0af6463ede5fd620cdca71721bc7760aa",
"nacl_loader_unittests": "2d881c5d99cd0b865143f72f7dfac82a49ebc4d1",
"native_theme_unittests": "47f7dcf9c6fc1968788a6ebabaa559df2e90d02b",
"net_unittests": "d52ed3dbf958a9a210b0191d9c31992e2de44808",
"openscreen_unittests": "61ecf8643b5fdb8b37da8bc7ad47fba2b3b3b993",
"pdf_unittests": "5f0c4be99a2d03449a61c6b983ff64f0346fc0f5",
"perfetto_unittests": "fac5d73d551b9a90403ee6f81d7c524dcde059c1",
"ppapi_unittests": "d764b32c70f11ec7c938e372c1c1017ba717115b",
"printing_unittests": "a6299f2e05c3e93f7f641ac11a2a09652c690811",
"remoting_unittests": "ff59cc2cee0414c26ed7b86f994b23914e4ef58a",
"sandbox_linux_unittests": "6d5e1d98ced61457a77e203c66cd71b816978331",
"service_manager_unittests": "275529795239f7ffe85bc5002581257a1c85871c",
"shell_dialogs_unittests": "81a44af76012cb839da1a72d5bfdf4bfe5751c2f",
"skia_unittests": "71ad1d75c42e632ab0c2006319c0b1f53cba83dc",
"snapshot_unittests": "48b246e5a3864338a2b7f76b8c2c21bf6608ef6a",
"sql_unittests": "5ac89572ba2d20c5f84f5f3e8bbdaaed96956f62",
"storage_unittests": "27c0452d4e23ad8bdd47894c4e66235d2dabbab9",
"sync_integration_tests": "1ba5b40e7b8321f8e29562ad6c14a7be2d911079",
"traffic_annotation_auditor_unittests": "e08dd67d441166249b73af1b4573e77044a43eea",
"ui_base_unittests": "b8f6a50adad3e8e5828a76bb78a0e350a53f7720",
"ui_touch_selection_unittests": "b51af2dfa549f43c07c989d565823bd17b5d6c72",
"unit_tests": "aa50036dbc78661081cb61e8fbe37e794031e190",
"url_unittests": "f17810ddba0ba05d7183a659bc4b4bdb3298c71f",
"views_unittests": "e112f8ead2544d9ea5641690b581bd0caae0e768",
"viz_unittests": "4e8d1f323c80f3461666c26687818df0d0044054",
"vr_common_unittests": "a490257ef1e407ed2f37eb622b33e315ad471dcc",
"vr_pixeltests": "3c6e6d10db8a8b4df53edebf9621c08259e1f9e1",
"weblayer_browsertests": "4a8497467da154d07fbd23f48a324fde148c98a7",
"weblayer_unittests": "c95d1097b4acfb57860a46ca26ba7827ae1c23a3",
"wm_unittests": "ff642a569020108a8af23a8c704696a5eaf6ce04",
"wtf_unittests": "0bc85e259af75dfb96ecff2b4a5d6757d3605f3e",
"x11_unittests": "4f20b4ec2dfd3ca1149d57650ca79db750f1fbb5",
"xr_browser_tests": "d34c08fe4a85613c5c6b4cd7f7f064991601f3c0",
"zlib_unittests": "b88733a59367a4070467bd94d8357c34893af39d"
},
"swarming_command_lines_cwd": "out/Release",
"swarming_command_lines_digest": "b6997d5d2702c2755f1ed9667cc000df0707d50c2332f66a5755db2ef3211cfe/94"
},
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "b1a9dec29bf7faeef5ad1be2592dd64bb864d64c",
"ref": "refs/heads/master"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "9017559285670409456"
},
{
"key": "scheduler_job_id",
"value": "chromium/Linux MSan Tests"
},
{
"key": "user_agent",
"value": "luci-scheduler"
},
{
"key": "parent_buildername",
"value": "Linux MSan Builder"
},
{
"key": "parent_buildnumber",
"value": "30209"
},
{
"key": "user_agent",
"value": "recipe"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[17:45:36.630] Scheduled build:
{
"id": "8852129223612545808",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "Linux MSan Tests"
},
"number": 27801,
"createdBy": "project:chromium",
"createTime": "2021-03-21T17:45:36.139515Z",
"updateTime": "2021-03-21T17:45:36.542691Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "b1a9dec29bf7faeef5ad1be2592dd64bb864d64c",
"ref": "refs/heads/master"
}
},
"canary": true
}
[17:45:36.630] Task URL: https://cr-buildbucket.appspot.com/build/8852129223612545808
[17:45:36.630] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:2:0) after 7m44s
[17:53:20.762] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:2:0)
[17:53:20.785] Build status: SCHEDULED
[17:53:20.785] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:3:0) after 8m13s
[18:01:33.803] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:3:0)
[18:01:33.803] Timer tick, asking Buildbucket for the build status
[18:01:33.926] Build 8852129223612545808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:01:33.926] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:4:0) after 1m0s
[18:02:33.945] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:4:0)
[18:02:33.985] Build status: SCHEDULED
[18:02:33.985] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:5:0) after 6m0s
[18:08:34.020] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:5:0)
[18:08:34.074] Build status: SCHEDULED
[18:08:34.074] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:6:0) after 9m5s
[18:17:39.160] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:6:0)
[18:17:39.189] Build status: SCHEDULED
[18:17:39.189] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:7:0) after 2m11s
[18:19:50.252] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:7:0)
[18:19:50.252] Timer tick, asking Buildbucket for the build status
[18:19:50.695] Build 8852129223612545808: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:19:50.695] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:8:0) after 1m0s
[18:20:50.834] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:8:0)
[18:20:50.860] Build status: SCHEDULED
[18:20:50.860] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:9:0) after 2m19s
[18:21:05.393] Received PubSub notification, asking Buildbucket for the build status
[18:21:05.596] Build 8852129223612545808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:23:10.050] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:9:0)
[18:23:10.050] Timer tick, asking Buildbucket for the build status
[18:23:10.483] Build 8852129223612545808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:23:10.483] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:11:0) after 1m0s
[18:24:10.705] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:11:0)
[18:24:10.705] Timer tick, asking Buildbucket for the build status
[18:24:10.792] Build 8852129223612545808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:24:10.792] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:12:0) after 1m0s
[18:25:10.912] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:12:0)
[18:25:10.936] Build status: STARTED
[18:25:10.936] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:13:0) after 9m41s
[18:34:51.979] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:13:0)
[18:34:51.979] Timer tick, asking Buildbucket for the build status
[18:34:52.093] Build 8852129223612545808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:34:52.094] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:14:0) after 1m0s
[18:35:52.196] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:14:0)
[18:35:52.196] Timer tick, asking Buildbucket for the build status
[18:35:52.374] Build 8852129223612545808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:35:52.374] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:15:0) after 1m0s
[18:36:52.500] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:15:0)
[18:36:52.549] Build status: STARTED
[18:36:52.549] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:16:0) after 4m14s
[18:41:06.570] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:16:0)
[18:41:06.596] Build status: STARTED
[18:41:06.596] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:17:0) after 1m0s
[18:42:06.618] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:17:0)
[18:42:06.618] Timer tick, asking Buildbucket for the build status
[18:42:06.734] Build 8852129223612545808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:42:06.734] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:18:0) after 1m0s
[18:43:06.841] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:18:0)
[18:43:06.866] Build status: STARTED
[18:43:06.866] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:19:0) after 5m32s
[18:48:38.884] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:19:0)
[18:48:38.912] Build status: STARTED
[18:48:38.912] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:20:0) after 2m11s
[18:50:49.946] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:20:0)
[18:50:49.946] Timer tick, asking Buildbucket for the build status
[18:50:50.187] Build 8852129223612545808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:50:50.188] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:21:0) after 1m0s
[18:51:50.210] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:21:0)
[18:51:50.236] Build status: STARTED
[18:51:50.236] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:22:0) after 5m26s
[18:57:16.274] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:22:0)
[18:57:16.302] Build status: STARTED
[18:57:16.302] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:23:0) after 2m33s
[18:59:49.322] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:23:0)
[18:59:49.345] Build status: STARTED
[18:59:49.345] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:24:0) after 2m27s
[19:02:16.526] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:24:0)
[19:02:16.553] Build status: STARTED
[19:02:16.553] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:25:0) after 7m36s
[19:09:52.655] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:25:0)
[19:09:52.655] Timer tick, asking Buildbucket for the build status
[19:09:53.166] Build 8852129223612545808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:09:53.166] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:26:0) after 1m0s
[19:11:04.063] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:26:0)
[19:11:04.063] Timer tick, asking Buildbucket for the build status
[19:11:04.180] Build 8852129223612545808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:11:04.180] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:27:0) after 1m0s
[19:12:04.218] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:27:0)
[19:12:04.218] Timer tick, asking Buildbucket for the build status
[19:12:04.337] Build 8852129223612545808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:12:04.337] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:28:0) after 1m0s
[19:13:04.367] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:28:0)
[19:13:04.367] Timer tick, asking Buildbucket for the build status
[19:13:04.450] Build 8852129223612545808: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:13:04.450] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:29:0) after 1m0s
[19:14:04.472] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:29:0)
[19:14:04.504] Build status: STARTED
[19:14:04.504] Scheduling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:30:0) after 3m44s
[19:17:48.637] Handling timer "check-buildbucket-build-status" (chromium/Linux MSan Tests:9017559285670409456:30:0)
[19:17:48.664] Build:
{
"id": "8852129223612545808",
"builder": {
"project": "chromium",
"bucket": "ci",
"builder": "Linux MSan Tests"
},
"number": 27801,
"createdBy": "project:chromium",
"createTime": "2021-03-21T17:45:36.139515Z",
"startTime": "2021-03-21T18:21:03.462704Z",
"endTime": "2021-03-21T19:16:51.885200468Z",
"updateTime": "2021-03-21T19:16:51.885475640Z",
"status": "FAILURE",
"input": {
"gitilesCommit": {
"host": "chromium.googlesource.com",
"project": "chromium/src",
"id": "b1a9dec29bf7faeef5ad1be2592dd64bb864d64c",
"ref": "refs/heads/master"
}
},
"canary": true
}
[19:17:48.664] Invocation finished in 1h32m13.871122982s with status FAILED