[18:53:35.443] New invocation is queued and will start shortly
[18:53:36.862] Starting the invocation (attempt 1)
[18:53:36.958] Preparing PubSub topic for "https://cr-buildbucket.appspot.com"
[18:53:41.395] PubSub topic is "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
[18:53:41.395] Buildbucket request:
{
"bucket": "luci.v8.ci",
"client_operation_id": "9103531527989044128",
"parameters_json": "{\"builder_name\":\"V8 Clusterfuzz Linux64 ASAN - debug builder\",\"properties\":{\"branch\":\"refs/heads/master\",\"repository\":\"https://chromium.googlesource.com/v8/v8\",\"revision\":\"4d474c51d828b050b27c7152e567edc2fb5f9701\"}}",
"pubsub_callback": {
"auth_token": "...",
"topic": "projects/luci-scheduler/topics/scheduler.buildbucket.cr-buildbucket~appspot.gserviceaccount.com"
},
"tags": [
"builder:V8 Clusterfuzz Linux64 ASAN - debug builder",
"scheduler_invocation_id:9103531527989044128",
"scheduler_job_id:v8/V8 Clusterfuzz Linux64 ASAN - debug builder",
"user_agent:luci-scheduler",
"buildset:commit/git/4d474c51d828b050b27c7152e567edc2fb5f9701",
"buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/4d474c51d828b050b27c7152e567edc2fb5f9701",
"gitiles_ref:refs/heads/master"
]
}
[18:53:42.891] Buildbucket response:
{
"build": {
"bucket": "luci.v8.ci",
"canary_preference": "AUTO",
"created_by": "user:luci-scheduler@appspot.gserviceaccount.com",
"created_ts": "1534359221552380",
"id": "8938101460860264624",
"lease_expiration_ts": "1534474422659140",
"lease_key": "18215564",
"parameters_json": "{\"builder_name\": \"V8 Clusterfuzz Linux64 ASAN - debug builder\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/v8/v8\", \"revision\": \"4d474c51d828b050b27c7152e567edc2fb5f9701\"}}",
"project": "v8",
"result_details_json": "null",
"service_account": "v8-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"status": "SCHEDULED",
"status_changed_ts": "1534359222801570",
"tags": [
"build_address:luci.v8.ci/V8 Clusterfuzz Linux64 ASAN - debug builder/2517",
"builder:V8 Clusterfuzz Linux64 ASAN - debug builder",
"buildset:commit/git/4d474c51d828b050b27c7152e567edc2fb5f9701",
"buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/4d474c51d828b050b27c7152e567edc2fb5f9701",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9103531527989044128",
"scheduler_job_id:v8/V8 Clusterfuzz Linux64 ASAN - debug builder",
"swarming_dimension:cpu:x86-64",
"swarming_dimension:host_class:default",
"swarming_dimension:os:Ubuntu-14.04",
"swarming_dimension:pool:luci.v8.ci",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:build_address:luci.v8.ci/V8 Clusterfuzz Linux64 ASAN - debug builder/2517",
"swarming_tag:buildbucket_bucket:luci.v8.ci",
"swarming_tag:buildbucket_build_id:8938101460860264624",
"swarming_tag:buildbucket_hostname:cr-buildbucket.appspot.com",
"swarming_tag:buildbucket_template_canary:0",
"swarming_tag:buildbucket_template_revision:2c2670caa0fda1b73bab13446430570755b4a8c1",
"swarming_tag:builder:V8 Clusterfuzz Linux64 ASAN - debug builder",
"swarming_tag:buildset:commit/git/4d474c51d828b050b27c7152e567edc2fb5f9701",
"swarming_tag:buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/4d474c51d828b050b27c7152e567edc2fb5f9701",
"swarming_tag:cpu:x86-64",
"swarming_tag:gitiles_ref:refs/heads/master",
"swarming_tag:host_class:default",
"swarming_tag:log_location:logdog://logs.chromium.org/v8/buildbucket/cr-buildbucket.appspot.com/8938101460860264624/+/annotations",
"swarming_tag:luci_project:v8",
"swarming_tag:os:Ubuntu-14.04",
"swarming_tag:pool:luci.v8.ci",
"swarming_tag:priority:30",
"swarming_tag:recipe_name:v8",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_tag:scheduler_invocation_id:9103531527989044128",
"swarming_tag:scheduler_job_id:v8/V8 Clusterfuzz Linux64 ASAN - debug builder",
"swarming_tag:service_account:v8-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"swarming_tag:swarming.pool.template:skip",
"swarming_tag:swarming.pool.version:6570aa9bb13dbc403210ed751510fb993f5ad875",
"swarming_tag:user:None",
"swarming_tag:user_agent:luci-scheduler",
"swarming_tag:vpython:native-python-wrapper",
"swarming_task_id:3f57c13fe5561710",
"user_agent:luci-scheduler"
],
"updated_ts": "1534359222801690",
"url": "https://ci.chromium.org/p/v8/builders/luci.v8.ci/V8 Clusterfuzz Linux64 ASAN - debug builder/2517",
"utcnow_ts": "1534359222878620"
}
}
[18:53:42.891] Task URL: https://ci.chromium.org/p/v8/builders/luci.v8.ci/V8 Clusterfuzz Linux64 ASAN - debug builder/2517
[18:53:42.891] Scheduling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:2:0) after 1m0s
[18:54:43.154] Handling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:2:0)
[18:54:43.154] Timer tick, asking Buildbucket for the build status
[18:54:43.222] Build 8938101460860264624: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:54:43.222] Scheduling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:3:0) after 1m0s
[18:55:43.239] Handling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:3:0)
[18:55:43.239] Timer tick, asking Buildbucket for the build status
[18:55:43.289] Build 8938101460860264624: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:55:43.289] Scheduling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:4:0) after 1m0s
[18:56:43.325] Handling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:4:0)
[18:56:43.325] Timer tick, asking Buildbucket for the build status
[18:56:43.409] Build 8938101460860264624: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:56:43.409] Scheduling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:5:0) after 1m0s
[18:57:43.495] Handling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:5:0)
[18:57:43.495] Timer tick, asking Buildbucket for the build status
[18:57:43.560] Build 8938101460860264624: status "SCHEDULED", result "", failure_reason "", cancelation_reason ""
[18:57:43.561] Scheduling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:6:0) after 1m0s
[18:58:10.561] Received PubSub notification, asking Buildbucket for the build status
[18:58:10.664] Build 8938101460860264624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:58:43.586] Handling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:6:0)
[18:58:43.586] Timer tick, asking Buildbucket for the build status
[18:58:43.819] Build 8938101460860264624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:58:43.819] Scheduling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:8:0) after 1m0s
[18:59:43.840] Handling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:8:0)
[18:59:43.840] Timer tick, asking Buildbucket for the build status
[18:59:43.921] Build 8938101460860264624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[18:59:43.921] Scheduling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:9:0) after 1m0s
[19:00:43.939] Handling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:9:0)
[19:00:43.939] Timer tick, asking Buildbucket for the build status
[19:00:43.973] Build 8938101460860264624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:00:43.973] Scheduling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:10:0) after 1m0s
[19:01:43.995] Handling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:10:0)
[19:01:43.995] Timer tick, asking Buildbucket for the build status
[19:01:44.033] Build 8938101460860264624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:01:44.033] Scheduling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:11:0) after 1m0s
[19:02:44.052] Handling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:11:0)
[19:02:44.052] Timer tick, asking Buildbucket for the build status
[19:02:44.110] Build 8938101460860264624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:02:44.110] Scheduling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:12:0) after 1m0s
[19:03:44.129] Handling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:12:0)
[19:03:44.129] Timer tick, asking Buildbucket for the build status
[19:03:44.168] Build 8938101460860264624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:03:44.168] Scheduling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:13:0) after 1m0s
[19:04:44.395] Handling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:13:0)
[19:04:44.395] Timer tick, asking Buildbucket for the build status
[19:04:44.447] Build 8938101460860264624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:04:44.447] Scheduling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:14:0) after 1m0s
[19:05:44.464] Handling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:14:0)
[19:05:44.464] Timer tick, asking Buildbucket for the build status
[19:05:44.513] Build 8938101460860264624: status "STARTED", result "", failure_reason "", cancelation_reason ""
[19:05:44.513] Scheduling timer "check-buildbucket-build-status" (v8/V8 Clusterfuzz Linux64 ASAN - debug builder:9103531527989044128:15:0) after 1m0s
[19:06:09.190] Received PubSub notification, asking Buildbucket for the build status
[19:06:09.289] Build 8938101460860264624: status "COMPLETED", result "SUCCESS", failure_reason "", cancelation_reason ""
[19:06:09.289] Buildbucket build:
{
"build": {
"bucket": "luci.v8.ci",
"canary_preference": "AUTO",
"completed_ts": "1534359968203220",
"created_by": "user:luci-scheduler@appspot.gserviceaccount.com",
"created_ts": "1534359221552380",
"id": "8938101460860264624",
"parameters_json": "{\"builder_name\": \"V8 Clusterfuzz Linux64 ASAN - debug builder\", \"properties\": {\"branch\": \"refs/heads/master\", \"repository\": \"https://chromium.googlesource.com/v8/v8\", \"revision\": \"4d474c51d828b050b27c7152e567edc2fb5f9701\"}}",
"project": "v8",
"result": "SUCCESS",
"result_details_json": "{\"ui\": {\"info\": \"\"}, \"build_run_result\": {\"infraFailure\": null, \"recipeResult\": {\"jsonResult\": \"null\"}, \"recipeExitCode\": {\"value\": 0}, \"recipe\": {\"name\": \"v8\", \"repository\": \"\", \"revision\": \"\"}, \"annotationUrl\": \"logdog://logs.chromium.org/v8/buildbucket/cr-buildbucket.appspot.com/8938101460860264624/+/annotations\"}, \"swarming\": {\"bot_dimensions\": {\"zone\": [\"us\", \"us-central\", \"us-central1\", \"us-central1-b\"], \"inside_docker\": [\"0\"], \"python\": [\"2.7.6\"], \"kvm\": [\"1\"], \"gpu\": [\"none\"], \"cpu\": [\"x86\", \"x86-64\", \"x86-64-Haswell_GCE\", \"x86-64-avx2\"], \"server_version\": [\"3737-bc9fbdc\"], \"machine_type\": [\"n1-standard-8\"], \"host_class\": [\"default\"], \"cores\": [\"8\"], \"os\": [\"Linux\", \"Ubuntu\", \"Ubuntu-14.04\"], \"id\": [\"swarm348-c4\"], \"pool\": [\"luci.v8.ci\"], \"caches\": [\"builder_0d3f246d10cb46330191fca35d969255136e6047e1143766d300f136b362b785_v2\", \"builder_0d593ee5aa3cf9dabcc2383ca6866d4a1d75fbc9d5b6881380b2a0d6835e6902_v2\", \"builder_12192a34ab005009991d0fcd2f5ae8df26b7335e407f6b96270acabd3042bec2_v2\", \"builder_18ebe6078fc076431bdc13a701f8a5c51b997bd642467094d3bc87bfe3774bd3_v2\", \"builder_195a7061e86da43c0e4b7e8111b9cd77115f02f5451c411c16498294f4d01606_v2\", \"builder_1b1a70d2033fc50d4ad0f3dd5d21a58e3565244132c5a1927c85e0c9abe2b15d_v2\", \"builder_2f21895df9bc873580ae930152de1cb506fbe4d990f9f6e1a2c9716ae74f393b_v2\", \"builder_310d90edfd68e72473acbfaa3524469048c24dc0d5b8eb217b4f24559fbd57f9_v2\", \"builder_37cd46001166294fa2187097f5e27316d0a3aedc6cadc8641809f4a7f20ba893_v2\", \"builder_3db5e1b6b0647e7d9f8cc4e1bff4fe3e76258618fe20b2551da6ab5c5ef76653_v2\", \"builder_3e78f3a169643c658f03d1ac84d5a82a1ea642f06c4921c1e3d7cc5e443f3b7f_v2\", \"builder_478749f17381fe5fcbfd9933f1a7c5b8524aab2a32975ea43e8a497ba4d516a0_v2\", \"builder_5a67369fddbade6dab3059fef0b25253ac32788b8dd17172ccec94449b615b97_v2\", \"builder_5f93e2294e3f53b65ad2aa7ee4c1e3e92578e63e62508173fbff659f306a61d7_v2\", \"builder_67e05df6f475288c71eac33e1fe4e86c20b62be5c9403a6e253d36598b254339_v2\", \"builder_75977d865aa1ec579c4abb0e7c44501ab09275df43bd7230fc42cb2afcfc1d50_v2\", \"builder_7618236dcda6485ff7b7c49f5ba63222ca2ec4f80e755043529cad88aa2b97c4_v2\", \"builder_78a3fb6fe4014b671b6deffce6700a9789482d20c5429dfbf56dc08cfa7d7d9a_v2\", \"builder_7d0e7a2c76671fc4c6afb3d4214b262128ae61bd8a1acddb6488acf5acd8d383_v2\", \"builder_7d53e00b9f90f15bd8b4d4c3c67b8746a84f1ff4bdd4b3b752b53580e9a425fa_v2\", \"builder_84263641a01f2acc74af58d0b215a5f92709284d3a1fbbc17190bf41294861c5_v2\", \"builder_abd5fc0df1a2b4811582d2f5c8e46b499d34b7e47e71450c63862d6ca6536ff3_v2\", \"builder_ad960b15a90962e52694b875d512c3db2015a7405c9ee457d20ee5d26470f5dc_v2\", \"builder_b23728735871e54308b3f36ea235b6a6f5c5e902d810ed4e93bc48a80096c140_v2\", \"builder_cd5bd5d890c446f4d5e8e10bf1e58037146789300db5235094bfebe7993a6326_v2\", \"builder_ea9251ddcec5763b81e0ba679247997722099f1d9a89e01bf81bf67c62173a40_v2\", \"builder_f0a022c5310063eef96c9e5181ecc7ab364e2841ec527f1932fd765b150ef87c_v2\", \"git\", \"goma_v2\", \"vpython\"]}}, \"properties\": {\"$recipe_engine/path\": {\"cache_dir\": \"/b/swarming/w/ir/cache\", \"temp_dir\": \"/b/swarming/w/ir/tmp/rt\"}, \"buildnumber\": 2517, \"repository\": \"https://chromium.googlesource.com/v8/v8\", \"buildername\": \"V8 Clusterfuzz Linux64 ASAN - debug builder\", \"got_revision\": \"4d474c51d828b050b27c7152e567edc2fb5f9701\", \"got_swarming_client_revision\": \"486c9b53c4d54dd4b95bb6ce0e31160e600dfc11\", \"recipe\": \"v8\", \"mastername\": \"client.v8.clusterfuzz\", \"$recipe_engine/runtime\": {\"is_experimental\": false, \"is_luci\": true}, \"buildbucket\": {\"hostname\": \"cr-buildbucket.appspot.com\", \"build\": {\"created_ts\": 1534359221552380, \"tags\": [\"builder:V8 Clusterfuzz Linux64 ASAN - debug builder\", \"buildset:commit/git/4d474c51d828b050b27c7152e567edc2fb5f9701\", \"buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/4d474c51d828b050b27c7152e567edc2fb5f9701\", \"gitiles_ref:refs/heads/master\", \"scheduler_invocation_id:9103531527989044128\", \"scheduler_job_id:v8/V8 Clusterfuzz Linux64 ASAN - debug builder\", \"user_agent:luci-scheduler\"], \"bucket\": \"luci.v8.ci\", \"created_by\": \"user:luci-scheduler@appspot.gserviceaccount.com\", \"project\": \"v8\", \"id\": \"8938101460860264624\"}}, \"got_revision_cp\": \"refs/heads/master@{#55139}\", \"branch\": \"refs/heads/master\", \"path_config\": \"generic\", \"revision\": \"4d474c51d828b050b27c7152e567edc2fb5f9701\", \"bot_id\": \"swarm348-c4\"}}",
"service_account": "v8-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"started_ts": "1534359489585810",
"status": "COMPLETED",
"status_changed_ts": "1534359968832370",
"tags": [
"build_address:luci.v8.ci/V8 Clusterfuzz Linux64 ASAN - debug builder/2517",
"builder:V8 Clusterfuzz Linux64 ASAN - debug builder",
"buildset:commit/git/4d474c51d828b050b27c7152e567edc2fb5f9701",
"buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/4d474c51d828b050b27c7152e567edc2fb5f9701",
"gitiles_ref:refs/heads/master",
"scheduler_invocation_id:9103531527989044128",
"scheduler_job_id:v8/V8 Clusterfuzz Linux64 ASAN - debug builder",
"swarming_dimension:cpu:x86-64",
"swarming_dimension:host_class:default",
"swarming_dimension:os:Ubuntu-14.04",
"swarming_dimension:pool:luci.v8.ci",
"swarming_hostname:chromium-swarm.appspot.com",
"swarming_tag:build_address:luci.v8.ci/V8 Clusterfuzz Linux64 ASAN - debug builder/2517",
"swarming_tag:buildbucket_bucket:luci.v8.ci",
"swarming_tag:buildbucket_build_id:8938101460860264624",
"swarming_tag:buildbucket_hostname:cr-buildbucket.appspot.com",
"swarming_tag:buildbucket_template_canary:0",
"swarming_tag:buildbucket_template_revision:2c2670caa0fda1b73bab13446430570755b4a8c1",
"swarming_tag:builder:V8 Clusterfuzz Linux64 ASAN - debug builder",
"swarming_tag:buildset:commit/git/4d474c51d828b050b27c7152e567edc2fb5f9701",
"swarming_tag:buildset:commit/gitiles/chromium.googlesource.com/v8/v8/+/4d474c51d828b050b27c7152e567edc2fb5f9701",
"swarming_tag:cpu:x86-64",
"swarming_tag:gitiles_ref:refs/heads/master",
"swarming_tag:host_class:default",
"swarming_tag:log_location:logdog://logs.chromium.org/v8/buildbucket/cr-buildbucket.appspot.com/8938101460860264624/+/annotations",
"swarming_tag:luci_project:v8",
"swarming_tag:os:Ubuntu-14.04",
"swarming_tag:pool:luci.v8.ci",
"swarming_tag:priority:30",
"swarming_tag:recipe_name:v8",
"swarming_tag:recipe_package:infra/recipe_bundles/chromium.googlesource.com/chromium/tools/build",
"swarming_tag:scheduler_invocation_id:9103531527989044128",
"swarming_tag:scheduler_job_id:v8/V8 Clusterfuzz Linux64 ASAN - debug builder",
"swarming_tag:service_account:v8-ci-builder@chops-service-accounts.iam.gserviceaccount.com",
"swarming_tag:swarming.pool.template:skip",
"swarming_tag:swarming.pool.version:6570aa9bb13dbc403210ed751510fb993f5ad875",
"swarming_tag:user:None",
"swarming_tag:user_agent:luci-scheduler",
"swarming_tag:vpython:native-python-wrapper",
"swarming_task_id:3f57c13fe5561710",
"user_agent:luci-scheduler"
],
"updated_ts": "1534359968837120",
"url": "https://ci.chromium.org/p/v8/builders/luci.v8.ci/V8 Clusterfuzz Linux64 ASAN - debug builder/2517",
"utcnow_ts": "1534359969224700"
}
}
[19:06:09.289] Invocation finished in 12m33.919394s with status SUCCEEDED