[01:12:33.603] New invocation is queued and will start shortly
[01:12:33.603] Triggered by user:fuchsia-ci-builder@fuchsia-infra.iam.gserviceaccount.com
[01:12:34.679] Starting the invocation (attempt 1)
[01:12:34.707] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/4153c2dc0537de926b786efebf1849f9986313ef"
[01:12:34.707] Reconstructed gitiles commit from tags
[01:12:34.707] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[01:12:34.707] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[01:12:34.708] Buildbucket request:
{
"requestId": "8894591080720411712",
"builder": {
"project": "fuchsia",
"bucket": "ci",
"builder": "clang_toolchain.ci.core.x64-debug"
},
"properties": {
"$fuchsia/checkout": {
"clang_toolchain": {
"cas_digest": "e307b49063c20caf2f809da3544b1d46992bb278f1e6b2159a637ee01c3a60fa/578",
"cas_instance": "projects/chromium-swarm/instances/default_instance"
},
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "94aa7bb7daded8db9911e7b7a694b2e7badbcdef",
"project": "integration",
"ref": "refs/heads/releases/canary"
}
},
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8894591080720411712",
"job": "fuchsia/clang_toolchain.ci.core.x64-debug",
"triggers": [
{
"buildbucket": {
"properties": {
"$fuchsia/checkout": {
"clang_toolchain": {
"cas_digest": "9089c044e171a91e99f9050fab7d61277425660cef1340dbad4d3b584a436d34/578",
"cas_instance": "projects/chromium-swarm/instances/default_instance"
},
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "94aa7bb7daded8db9911e7b7a694b2e7badbcdef",
"project": "integration",
"ref": "refs/heads/releases/canary"
}
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "66f9448b4b14a117141a3efd014e1240b30b741f"
}
},
"tags": [
"buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/66f9448b4b14a117141a3efd014e1240b30b741f",
"gitiles_ref:refs/heads/main",
"parent_buildername:clang-linux-x64",
"user_agent:recipe"
]
},
"id": "c138a478-82f4-4e9a-9361-e7336b172b71",
"title": "clang-linux-x64/0"
},
{
"buildbucket": {
"properties": {
"$fuchsia/checkout": {
"clang_toolchain": {
"cas_digest": "0218be6845621900fcdf493296a51fc7ce162cbc8740cc3e5939b459683c5fd8/578",
"cas_instance": "projects/chromium-swarm/instances/default_instance"
},
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "94aa7bb7daded8db9911e7b7a694b2e7badbcdef",
"project": "integration",
"ref": "refs/heads/releases/canary"
}
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "1f9f68a1cdbfaed813b35137a600bd76532f0c7e"
}
},
"tags": [
"buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/1f9f68a1cdbfaed813b35137a600bd76532f0c7e",
"gitiles_ref:refs/heads/main",
"parent_buildername:clang-linux-x64",
"user_agent:recipe"
]
},
"id": "e0c05f1d-8458-4a45-af52-c8567237182b",
"title": "clang-linux-x64/0"
},
{
"buildbucket": {
"properties": {
"$fuchsia/checkout": {
"clang_toolchain": {
"cas_digest": "bd2a3a5abe85cc980567402f4efc8d6224c2760941abb5c601c87bfffe458be5/578",
"cas_instance": "projects/chromium-swarm/instances/default_instance"
},
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "94aa7bb7daded8db9911e7b7a694b2e7badbcdef",
"project": "integration",
"ref": "refs/heads/releases/canary"
}
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "639e1fa255206c1e82246b49afbd8c1e44a22c11"
}
},
"tags": [
"buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/639e1fa255206c1e82246b49afbd8c1e44a22c11",
"gitiles_ref:refs/heads/main",
"parent_buildername:clang-linux-x64",
"user_agent:recipe"
]
},
"id": "c90d1918-7819-406d-9df0-ffb77cb15958",
"title": "clang-linux-x64/0"
},
{
"buildbucket": {
"properties": {
"$fuchsia/checkout": {
"clang_toolchain": {
"cas_digest": "536d8ece3cbb913c712b3f0bbb376ccf9797c07cc4dce6756b1998c8e5d304bd/578",
"cas_instance": "projects/chromium-swarm/instances/default_instance"
},
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "94aa7bb7daded8db9911e7b7a694b2e7badbcdef",
"project": "integration",
"ref": "refs/heads/releases/canary"
}
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "7787328dd64c750c7acf30b86b31f0d7166c8f27"
}
},
"tags": [
"buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/7787328dd64c750c7acf30b86b31f0d7166c8f27",
"gitiles_ref:refs/heads/main",
"parent_buildername:clang-linux-x64",
"user_agent:recipe"
]
},
"id": "abc5d49c-2015-4c8e-98fa-1f6e2ffa8def",
"title": "clang-linux-x64/0"
},
{
"buildbucket": {
"properties": {
"$fuchsia/checkout": {
"clang_toolchain": {
"cas_digest": "e307b49063c20caf2f809da3544b1d46992bb278f1e6b2159a637ee01c3a60fa/578",
"cas_instance": "projects/chromium-swarm/instances/default_instance"
},
"gitiles_commit": {
"host": "fuchsia.googlesource.com",
"id": "94aa7bb7daded8db9911e7b7a694b2e7badbcdef",
"project": "integration",
"ref": "refs/heads/releases/canary"
}
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "4153c2dc0537de926b786efebf1849f9986313ef"
}
},
"tags": [
"buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/4153c2dc0537de926b786efebf1849f9986313ef",
"gitiles_ref:refs/heads/main",
"parent_buildername:clang-linux-x64",
"user_agent:recipe"
]
},
"id": "f05881f5-5109-4f51-8dc7-141e1d7f10c0",
"title": "clang-linux-x64/0"
}
]
},
"clang_toolchain": {
"git_repository": "https://llvm.googlesource.com/llvm-project",
"git_revision": "4153c2dc0537de926b786efebf1849f9986313ef"
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "4153c2dc0537de926b786efebf1849f9986313ef",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8894591080720411712"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/clang_toolchain.ci.core.x64-debug"
},
{
"key": "user_agent",
"value": "luci-scheduler"
},
{
"key": "parent_buildername",
"value": "clang-linux-x64"
},
{
"key": "user_agent",
"value": "recipe"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[01:12:35.220] Scheduled build:
{
"id": "8729161018776517425",
"builder": {
"project": "fuchsia",
"bucket": "ci",
"builder": "clang_toolchain.ci.core.x64-debug"
},
"createdBy": "project:fuchsia",
"createTime": "2024-12-08T01:12:34.826815680Z",
"updateTime": "2024-12-08T01:12:34.826815680Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "4153c2dc0537de926b786efebf1849f9986313ef",
"ref": "refs/heads/main"
}
}
}
[01:12:35.220] Task URL: https://cr-buildbucket.appspot.com/build/8729161018776517425
[01:12:35.221] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:2:0) after 7m57s
[01:12:36.203] Received PubSub notification, asking Buildbucket for the build status
[01:12:36.251] Build status: SCHEDULED
[01:12:43.038] Received PubSub notification, asking Buildbucket for the build status
[01:12:43.056] Build status: STARTED
[01:20:32.237] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:2:0)
[01:20:32.275] Build status: STARTED
[01:20:32.275] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:5:0) after 9m27s
[01:29:59.296] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:5:0)
[01:29:59.338] Build status: STARTED
[01:29:59.339] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:6:0) after 8m57s
[01:38:56.460] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:6:0)
[01:38:56.501] Build status: STARTED
[01:38:56.501] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:7:0) after 9m50s
[01:48:47.031] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:7:0)
[01:48:47.050] Build status: STARTED
[01:48:47.050] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:8:0) after 6m27s
[01:55:14.065] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:8:0)
[01:55:14.083] Build status: STARTED
[01:55:14.083] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:9:0) after 2m10s
[01:57:24.265] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:9:0)
[01:57:24.280] Build status: STARTED
[01:57:24.280] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:10:0) after 9m39s
[02:07:03.427] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:10:0)
[02:07:03.444] Build status: STARTED
[02:07:03.444] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:11:0) after 6m21s
[02:13:24.728] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:11:0)
[02:13:24.763] Build status: STARTED
[02:13:24.763] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:12:0) after 4m5s
[02:17:29.900] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:12:0)
[02:17:29.919] Build status: STARTED
[02:17:29.919] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:13:0) after 2m4s
[02:19:33.935] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:13:0)
[02:19:34.015] Build status: STARTED
[02:19:34.015] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:14:0) after 4m17s
[02:23:51.034] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:14:0)
[02:23:51.055] Build status: STARTED
[02:23:51.055] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:15:0) after 6m29s
[02:30:20.095] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:15:0)
[02:30:20.123] Build status: STARTED
[02:30:20.124] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:16:0) after 5m43s
[02:36:03.140] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:16:0)
[02:36:03.161] Build status: STARTED
[02:36:03.161] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:17:0) after 6m9s
[02:42:12.179] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:17:0)
[02:42:12.208] Build status: STARTED
[02:42:12.208] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:18:0) after 1m1s
[02:43:13.222] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:18:0)
[02:43:13.240] Build status: STARTED
[02:43:13.240] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:19:0) after 3m30s
[02:46:43.319] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:19:0)
[02:46:43.338] Build status: STARTED
[02:46:43.338] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:20:0) after 8m58s
[02:55:41.354] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:20:0)
[02:55:41.372] Build status: STARTED
[02:55:41.372] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:21:0) after 2m44s
[02:58:25.748] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:21:0)
[02:58:25.765] Build status: STARTED
[02:58:25.765] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:22:0) after 3m46s
[03:02:11.761] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:22:0)
[03:02:11.833] Build status: STARTED
[03:02:11.833] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:23:0) after 7m0s
[03:09:11.850] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:23:0)
[03:09:11.897] Build status: STARTED
[03:09:11.897] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:24:0) after 3m21s
[03:12:32.971] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:24:0)
[03:12:32.988] Build status: STARTED
[03:12:32.988] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:25:0) after 9m38s
[03:22:11.091] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:25:0)
[03:22:11.113] Build status: STARTED
[03:22:11.113] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:26:0) after 1m10s
[03:23:21.274] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:26:0)
[03:23:21.293] Build status: STARTED
[03:23:21.293] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:27:0) after 8m0s
[03:31:21.412] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:27:0)
[03:31:21.449] Build status: STARTED
[03:31:21.449] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:28:0) after 4m18s
[03:35:39.459] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:28:0)
[03:35:39.481] Build status: STARTED
[03:35:39.481] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:29:0) after 8m56s
[03:44:35.604] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:29:0)
[03:44:35.624] Build status: STARTED
[03:44:35.624] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:30:0) after 2m46s
[03:47:21.643] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:30:0)
[03:47:21.712] Build status: STARTED
[03:47:21.712] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:31:0) after 1m21s
[03:48:42.843] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:31:0)
[03:48:42.864] Build status: STARTED
[03:48:42.864] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:32:0) after 7m2s
[03:55:44.883] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:32:0)
[03:55:44.900] Build status: STARTED
[03:55:44.901] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:33:0) after 8m55s
[04:04:39.901] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:33:0)
[04:04:39.920] Build status: STARTED
[04:04:39.920] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:34:0) after 3m29s
[04:08:09.089] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:34:0)
[04:08:09.120] Build status: STARTED
[04:08:09.120] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:35:0) after 1m21s
[04:09:30.122] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:35:0)
[04:09:30.152] Build status: STARTED
[04:09:30.153] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:36:0) after 2m20s
[04:11:50.371] Handling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:36:0)
[04:11:50.386] Build status: STARTED
[04:11:50.386] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang_toolchain.ci.core.x64-debug:8894591080720411712:37:0) after 5m57s
[04:13:18.808] Received PubSub notification, asking Buildbucket for the build status
[04:13:18.833] Build:
{
"id": "8729161018776517425",
"builder": {
"project": "fuchsia",
"bucket": "ci",
"builder": "clang_toolchain.ci.core.x64-debug"
},
"createdBy": "project:fuchsia",
"createTime": "2024-12-08T01:12:34.826815680Z",
"startTime": "2024-12-08T01:12:42.822845776Z",
"endTime": "2024-12-08T04:13:18.411437587Z",
"updateTime": "2024-12-08T04:13:18.411437587Z",
"status": "FAILURE",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "4153c2dc0537de926b786efebf1849f9986313ef",
"ref": "refs/heads/main"
}
}
}
[04:13:18.833] Invocation finished in 3h0m45.244871535s with status FAILED