[17:20:58.981] New invocation is queued and will start shortly
[17:21:00.627] Starting the invocation (attempt 1)
[17:21:00.651] Popped buildset tag "buildset:commit/gitiles/dawn.googlesource.com/dawn/+/c0bc42329f93bd96710b6150ab24d2fbc186eab6"
[17:21:00.651] Popped gitiles commit info from properties and tags
[17:21:00.651] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[17:21:00.651] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[17:21:00.651] Buildbucket request:
{
"requestId": "8909478652263103328",
"builder": {
"project": "dawn",
"bucket": "ci",
"builder": "cmake-linux-clang-dbg-x64-asan"
},
"properties": {
"$recipe_engine/scheduler": {
"hostname": "luci-scheduler.appspot.com",
"invocation": "8909478652263103328",
"job": "dawn/cmake-linux-clang-dbg-x64-asan",
"triggers": [
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://dawn.googlesource.com/dawn",
"revision": "7056f5eb819d2c71c303edd145d370894a46f1fa"
},
"id": "https://dawn.googlesource.com/dawn/+/refs/heads/main@7056f5eb819d2c71c303edd145d370894a46f1fa",
"title": "7056f5eb819d2c71c303edd145d370894a46f1fa",
"url": "https://dawn.googlesource.com/dawn/+/7056f5eb819d2c71c303edd145d370894a46f1fa"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://dawn.googlesource.com/dawn",
"revision": "747ef18816c8f375bb61400f478a89717b608d8a"
},
"id": "https://dawn.googlesource.com/dawn/+/refs/heads/main@747ef18816c8f375bb61400f478a89717b608d8a",
"title": "747ef18816c8f375bb61400f478a89717b608d8a",
"url": "https://dawn.googlesource.com/dawn/+/747ef18816c8f375bb61400f478a89717b608d8a"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://dawn.googlesource.com/dawn",
"revision": "4a186839476d5194f30fb2f7b745887e12f2d154"
},
"id": "https://dawn.googlesource.com/dawn/+/refs/heads/main@4a186839476d5194f30fb2f7b745887e12f2d154",
"title": "4a186839476d5194f30fb2f7b745887e12f2d154",
"url": "https://dawn.googlesource.com/dawn/+/4a186839476d5194f30fb2f7b745887e12f2d154"
},
{
"gitiles": {
"ref": "refs/heads/main",
"repo": "https://dawn.googlesource.com/dawn",
"revision": "c0bc42329f93bd96710b6150ab24d2fbc186eab6"
},
"id": "https://dawn.googlesource.com/dawn/+/refs/heads/main@c0bc42329f93bd96710b6150ab24d2fbc186eab6",
"title": "c0bc42329f93bd96710b6150ab24d2fbc186eab6",
"url": "https://dawn.googlesource.com/dawn/+/c0bc42329f93bd96710b6150ab24d2fbc186eab6"
}
]
}
},
"gitilesCommit": {
"host": "dawn.googlesource.com",
"project": "dawn",
"id": "c0bc42329f93bd96710b6150ab24d2fbc186eab6",
"ref": "refs/heads/main"
},
"tags": [
{
"key": "scheduler_invocation_id",
"value": "8909478652263103328"
},
{
"key": "scheduler_job_id",
"value": "dawn/cmake-linux-clang-dbg-x64-asan"
},
{
"key": "user_agent",
"value": "luci-scheduler"
}
],
"notify": {
"pubsubTopic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
}
}
[17:21:01.116] Scheduled build:
{
"id": "8744048589790520657",
"builder": {
"project": "dawn",
"bucket": "ci",
"builder": "cmake-linux-clang-dbg-x64-asan"
},
"createdBy": "project:dawn",
"createTime": "2024-06-26T17:21:00.716022743Z",
"updateTime": "2024-06-26T17:21:00.716022743Z",
"status": "SCHEDULED",
"input": {
"gitilesCommit": {
"host": "dawn.googlesource.com",
"project": "dawn",
"id": "c0bc42329f93bd96710b6150ab24d2fbc186eab6",
"ref": "refs/heads/main"
}
}
}
[17:21:01.116] Task URL: https://cr-buildbucket.appspot.com/build/8744048589790520657
[17:21:01.116] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:2:0) after 5m4s
[17:21:02.088] Received PubSub notification, asking Buildbucket for the build status
[17:21:02.108] Build status: SCHEDULED
[17:21:07.728] Received PubSub notification, asking Buildbucket for the build status
[17:21:07.751] Build status: STARTED
[17:26:05.134] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:2:0)
[17:26:05.183] Build status: STARTED
[17:26:05.183] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:5:0) after 2m44s
[17:28:49.199] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:5:0)
[17:28:49.225] Build status: STARTED
[17:28:49.225] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:6:0) after 8m14s
[17:37:03.240] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:6:0)
[17:37:03.260] Build status: STARTED
[17:37:03.260] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:7:0) after 6m14s
[17:43:17.500] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:7:0)
[17:43:17.519] Build status: STARTED
[17:43:17.519] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:8:0) after 8m11s
[17:51:28.554] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:8:0)
[17:51:28.574] Build status: STARTED
[17:51:28.574] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:9:0) after 5m32s
[17:57:00.589] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:9:0)
[17:57:00.610] Build status: STARTED
[17:57:00.610] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:10:0) after 8m5s
[18:05:05.649] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:10:0)
[18:05:05.668] Build status: STARTED
[18:05:05.668] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:11:0) after 2m19s
[18:07:24.785] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:11:0)
[18:07:24.803] Build status: STARTED
[18:07:24.803] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:12:0) after 1m26s
[18:08:50.840] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:12:0)
[18:08:50.887] Build status: STARTED
[18:08:50.887] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:13:0) after 8m53s
[18:17:43.901] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:13:0)
[18:17:43.919] Build status: STARTED
[18:17:43.919] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:14:0) after 7m27s
[18:25:10.938] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:14:0)
[18:25:10.976] Build status: STARTED
[18:25:10.976] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:15:0) after 6m54s
[18:32:05.019] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:15:0)
[18:32:05.042] Build status: STARTED
[18:32:05.042] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:16:0) after 6m47s
[18:38:52.036] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:16:0)
[18:38:52.055] Build status: STARTED
[18:38:52.055] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:17:0) after 2m8s
[18:41:00.152] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:17:0)
[18:41:00.212] Build status: STARTED
[18:41:00.212] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:18:0) after 9m40s
[18:50:40.285] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:18:0)
[18:50:40.303] Build status: STARTED
[18:50:40.303] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:19:0) after 7m18s
[18:57:58.366] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:19:0)
[18:57:58.399] Build status: STARTED
[18:57:58.399] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:20:0) after 4m23s
[19:02:21.512] Handling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:20:0)
[19:02:21.547] Build status: STARTED
[19:02:21.547] Scheduling timer "check-buildbucket-build-status" (dawn/cmake-linux-clang-dbg-x64-asan:8909478652263103328:21:0) after 5m8s
[19:05:16.649] Received PubSub notification, asking Buildbucket for the build status
[19:05:16.672] Build:
{
"id": "8744048589790520657",
"builder": {
"project": "dawn",
"bucket": "ci",
"builder": "cmake-linux-clang-dbg-x64-asan"
},
"createdBy": "project:dawn",
"createTime": "2024-06-26T17:21:00.716022743Z",
"startTime": "2024-06-26T17:21:07.511086487Z",
"endTime": "2024-06-26T19:05:16.400837006Z",
"updateTime": "2024-06-26T19:05:16.400837006Z",
"status": "SUCCESS",
"input": {
"gitilesCommit": {
"host": "dawn.googlesource.com",
"project": "dawn",
"id": "c0bc42329f93bd96710b6150ab24d2fbc186eab6",
"ref": "refs/heads/main"
}
}
}
[19:05:16.672] Invocation finished in 1h44m17.698006215s with status SUCCEEDED