[10:39:07.610] New invocation is queued and will start shortly
[10:39:09.175] Starting the invocation (attempt 1)
[10:39:09.210] Popped buildset tag "buildset:commit/gitiles/llvm.googlesource.com/llvm-project/+/408659c5b5c7d745042ae71db344d1ed10601512"
[10:39:09.210] Popped gitiles commit info from properties and tags
[10:39:09.210] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[10:39:09.210] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[10:39:09.211] Buildbucket request:
{
"requestId": "8896186180814396368",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-ci-trigger"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8896186180814396368",
"job": "fuchsia/clang-ci-trigger-40be1bb5",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "34881138ed94709d09f690a27cd457d6a830f123"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@34881138ed94709d09f690a27cd457d6a830f123",
"title": "34881138ed94709d09f690a27cd457d6a830f123",
"url": "https://llvm.googlesource.com/llvm-project/+/34881138ed94709d09f690a27cd457d6a830f123"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "5310855316a8356d5862714a21e1e6344f84225e"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@5310855316a8356d5862714a21e1e6344f84225e",
"title": "5310855316a8356d5862714a21e1e6344f84225e",
"url": "https://llvm.googlesource.com/llvm-project/+/5310855316a8356d5862714a21e1e6344f84225e"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "9111d531d85a743986ebc51b68fc1734086531ea"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@9111d531d85a743986ebc51b68fc1734086531ea",
"title": "9111d531d85a743986ebc51b68fc1734086531ea",
"url": "https://llvm.googlesource.com/llvm-project/+/9111d531d85a743986ebc51b68fc1734086531ea"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "92604d7c8061615dfb77568cc9cb2169f648290a"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@92604d7c8061615dfb77568cc9cb2169f648290a",
"title": "92604d7c8061615dfb77568cc9cb2169f648290a",
"url": "https://llvm.googlesource.com/llvm-project/+/92604d7c8061615dfb77568cc9cb2169f648290a"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "b7ddb97ac2cfb57f17c7f68815606cbd57918417"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@b7ddb97ac2cfb57f17c7f68815606cbd57918417",
"title": "b7ddb97ac2cfb57f17c7f68815606cbd57918417",
"url": "https://llvm.googlesource.com/llvm-project/+/b7ddb97ac2cfb57f17c7f68815606cbd57918417"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "288f05f63e5f3246657aca9561d75b2aa02cb6f5"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@288f05f63e5f3246657aca9561d75b2aa02cb6f5",
"title": "288f05f63e5f3246657aca9561d75b2aa02cb6f5",
"url": "https://llvm.googlesource.com/llvm-project/+/288f05f63e5f3246657aca9561d75b2aa02cb6f5"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "2b5214b9e16cdc784def1d521ce38074a2e8c90f"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@2b5214b9e16cdc784def1d521ce38074a2e8c90f",
"title": "2b5214b9e16cdc784def1d521ce38074a2e8c90f",
"url": "https://llvm.googlesource.com/llvm-project/+/2b5214b9e16cdc784def1d521ce38074a2e8c90f"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "9bccf61f5fd20a52f997b23a56c13ada72c46eae"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@9bccf61f5fd20a52f997b23a56c13ada72c46eae",
"title": "9bccf61f5fd20a52f997b23a56c13ada72c46eae",
"url": "https://llvm.googlesource.com/llvm-project/+/9bccf61f5fd20a52f997b23a56c13ada72c46eae"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "09c41246ed58344892a1a82f7256a4ad6e1c49d7"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@09c41246ed58344892a1a82f7256a4ad6e1c49d7",
"title": "09c41246ed58344892a1a82f7256a4ad6e1c49d7",
"url": "https://llvm.googlesource.com/llvm-project/+/09c41246ed58344892a1a82f7256a4ad6e1c49d7"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "9568f88b7f05015a438ed8beb4f4d07782c34dc2"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@9568f88b7f05015a438ed8beb4f4d07782c34dc2",
"title": "9568f88b7f05015a438ed8beb4f4d07782c34dc2",
"url": "https://llvm.googlesource.com/llvm-project/+/9568f88b7f05015a438ed8beb4f4d07782c34dc2"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "62bf5840a63fbe0856c47df3f9ed6b8f1202b385"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@62bf5840a63fbe0856c47df3f9ed6b8f1202b385",
"title": "62bf5840a63fbe0856c47df3f9ed6b8f1202b385",
"url": "https://llvm.googlesource.com/llvm-project/+/62bf5840a63fbe0856c47df3f9ed6b8f1202b385"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "77bf34c3154408eb49eda171fbf4d50e3d66f019"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@77bf34c3154408eb49eda171fbf4d50e3d66f019",
"title": "77bf34c3154408eb49eda171fbf4d50e3d66f019",
"url": "https://llvm.googlesource.com/llvm-project/+/77bf34c3154408eb49eda171fbf4d50e3d66f019"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://llvm.googlesource.com/llvm-project",
"revision": "408659c5b5c7d745042ae71db344d1ed10601512"
},
"id": "https://llvm.googlesource.com/llvm-project/+/refs/heads/main@408659c5b5c7d745042ae71db344d1ed10601512",
"title": "408659c5b5c7d745042ae71db344d1ed10601512",
"url": "https://llvm.googlesource.com/llvm-project/+/408659c5b5c7d745042ae71db344d1ed10601512"
}
]
}
},
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "408659c5b5c7d745042ae71db344d1ed10601512",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8896186180814396368"
},
{
"key": "scheduler_job_id",
"value": "fuchsia/clang-ci-trigger-40be1bb5"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[10:39:09.820] Scheduled build:
{
"id": "8730756118338104033",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-ci-trigger"
},
"createdBy": "project:fuchsia",
"createTime": "2024-11-20T10:39:09.342740502Z",
"updateTime": "2024-11-20T10:39:09.342740502Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "408659c5b5c7d745042ae71db344d1ed10601512",
"ref": "refs/heads/main"
}
}
}
[10:39:09.820] Task URL: https://cr-buildbucket.appspot.com/build/8730756118338104033
[10:39:09.820] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:2:0) after 9m42s
[10:39:10.802] Received PubSub notification, asking Buildbucket for the build status
[10:39:10.833] Build status: SCHEDULED
[10:39:15.697] Received PubSub notification, asking Buildbucket for the build status
[10:39:15.717] Build status: STARTED
[10:48:51.838] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:2:0)
[10:48:51.855] Build status: STARTED
[10:48:51.855] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:5:0) after 2m30s
[10:51:21.857] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:5:0)
[10:51:21.874] Build status: STARTED
[10:51:21.874] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:6:0) after 5m59s
[10:57:20.925] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:6:0)
[10:57:20.942] Build status: STARTED
[10:57:20.942] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:7:0) after 4m1s
[11:01:21.915] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:7:0)
[11:01:21.939] Build status: STARTED
[11:01:21.939] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:8:0) after 9m15s
[11:10:36.919] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:8:0)
[11:10:36.947] Build status: STARTED
[11:10:36.947] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:9:0) after 3m6s
[11:13:42.989] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:9:0)
[11:13:43.063] Build status: STARTED
[11:13:43.063] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:10:0) after 1m21s
[11:15:04.086] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:10:0)
[11:15:04.101] Build status: STARTED
[11:15:04.101] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:11:0) after 3m41s
[11:18:45.073] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:11:0)
[11:18:45.090] Build status: STARTED
[11:18:45.090] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:12:0) after 8m17s
[11:27:02.110] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:12:0)
[11:27:02.133] Build status: STARTED
[11:27:02.133] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:13:0) after 1m17s
[11:28:19.153] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:13:0)
[11:28:19.179] Build status: STARTED
[11:28:19.179] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:14:0) after 3m31s
[11:31:50.196] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:14:0)
[11:31:50.220] Build status: STARTED
[11:31:50.220] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:15:0) after 1m32s
[11:33:22.239] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:15:0)
[11:33:22.259] Build status: STARTED
[11:33:22.259] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:16:0) after 9m26s
[11:42:48.691] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:16:0)
[11:42:48.717] Build status: STARTED
[11:42:48.717] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:17:0) after 7m58s
[11:50:46.774] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:17:0)
[11:50:46.789] Build status: STARTED
[11:50:46.789] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:18:0) after 2m58s
[11:53:44.803] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:18:0)
[11:53:44.819] Build status: STARTED
[11:53:44.819] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:19:0) after 4m59s
[11:58:43.911] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:19:0)
[11:58:43.963] Build status: STARTED
[11:58:43.963] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:20:0) after 4m50s
[12:03:34.013] Handling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:20:0)
[12:03:34.040] Build status: STARTED
[12:03:34.040] Scheduling timer "check-buildbucket-build-status" (fuchsia/clang-ci-trigger-40be1bb5:8896186180814396368:21:0) after 6m49s
[12:03:58.350] Received PubSub notification, asking Buildbucket for the build status
[12:03:58.371] Build:
{
"id": "8730756118338104033",
"builder": {
"project": "fuchsia",
"bucket": "prod",
"builder": "clang-ci-trigger"
},
"createdBy": "project:fuchsia",
"createTime": "2024-11-20T10:39:09.342740502Z",
"startTime": "2024-11-20T10:39:15.356243262Z",
"endTime": "2024-11-20T12:03:57.989891954Z",
"updateTime": "2024-11-20T12:03:57.989891954Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "llvm.googlesource.com",
"project": "llvm-project",
"id": "408659c5b5c7d745042ae71db344d1ed10601512",
"ref": "refs/heads/main"
}
}
}
[12:03:58.371] Invocation finished in 1h24m50.774035591s with status SUCCEEDED