See <https://ci-beam.apache.org/job/beam_PerformanceTests_SparkReceiver_IO/371/display/redirect>
Changes: ------------------------------------------ [...truncated 359.83 KB...] Resolve mutations for :sdks:java:extensions:protobuf:testJar (Thread[Execution **** Thread 7,5,main]) completed. Took 0.0 secs. :sdks:java:extensions:protobuf:testJar (Thread[Execution **** Thread 7,5,main]) started. > Task :sdks:java:io:sparkreceiver:2:compileTestJava FROM-CACHE Custom actions are attached to task ':sdks:java:io:sparkreceiver:2:compileTestJava'. Build cache key for task ':sdks:java:io:sparkreceiver:2:compileTestJava' is f77d033d44bdb4faa9b723b14bfb5915 Task ':sdks:java:io:sparkreceiver:2:compileTestJava' is not up-to-date because: No history is available. Loaded cache entry for task ':sdks:java:io:sparkreceiver:2:compileTestJava' with cache key f77d033d44bdb4faa9b723b14bfb5915 :sdks:java:io:sparkreceiver:2:compileTestJava (Thread[Execution **** Thread 2,5,main]) completed. Took 0.414 secs. Resolve mutations for :sdks:java:io:sparkreceiver:2:testClasses (Thread[Execution ****,5,main]) started. Resolve mutations for :sdks:java:io:sparkreceiver:2:testClasses (Thread[Execution ****,5,main]) completed. Took 0.0 secs. :sdks:java:io:sparkreceiver:2:testClasses (Thread[Execution **** Thread 5,5,main]) started. > Task :sdks:java:io:sparkreceiver:2:testClasses UP-TO-DATE Skipping task ':sdks:java:io:sparkreceiver:2:testClasses' as it has no actions. :sdks:java:io:sparkreceiver:2:testClasses (Thread[Execution **** Thread 5,5,main]) completed. Took 0.0 secs. > Task :sdks:java:extensions:protobuf:testJar Caching disabled for task ':sdks:java:extensions:protobuf:testJar' because: Not worth caching Task ':sdks:java:extensions:protobuf:testJar' is not up-to-date because: No history is available. :sdks:java:extensions:protobuf:testJar (Thread[Execution **** Thread 7,5,main]) completed. Took 0.078 secs. work action resolve beam-sdks-java-extensions-protobuf-tests.jar (project :sdks:java:extensions:protobuf) (Thread[Execution ****,5,main]) started. work action null (Thread[Execution ****,5,main]) completed. Took 0.0 secs. Resolve mutations for :sdks:java:io:google-cloud-platform:compileTestJava (Thread[Execution **** Thread 5,5,main]) started. Resolve mutations for :sdks:java:io:google-cloud-platform:compileTestJava (Thread[Execution **** Thread 5,5,main]) completed. Took 0.0 secs. :sdks:java:io:google-cloud-platform:compileTestJava (Thread[Execution **** Thread 7,5,main]) started. > Task :runners:google-cloud-dataflow-java:****:compileJava FROM-CACHE Custom actions are attached to task ':runners:google-cloud-dataflow-java:****:compileJava'. Build cache key for task ':runners:google-cloud-dataflow-java:****:compileJava' is 5c39fbcef8dc3cef86028274d3c29edc Task ':runners:google-cloud-dataflow-java:****:compileJava' is not up-to-date because: No history is available. Loaded cache entry for task ':runners:google-cloud-dataflow-java:****:compileJava' with cache key 5c39fbcef8dc3cef86028274d3c29edc Resolve mutations for :runners:google-cloud-dataflow-java:****:classes (Thread[included builds,5,main]) started. Resolve mutations for :runners:google-cloud-dataflow-java:****:classes (Thread[included builds,5,main]) completed. Took 0.0 secs. :runners:google-cloud-dataflow-java:****:classes (Thread[included builds,5,main]) started. > Task :runners:google-cloud-dataflow-java:****:classes Skipping task ':runners:google-cloud-dataflow-java:****:classes' as it has no actions. :runners:google-cloud-dataflow-java:****:classes (Thread[included builds,5,main]) completed. Took 0.0 secs. Resolve mutations for :runners:google-cloud-dataflow-java:****:shadowJar (Thread[Execution **** Thread 4,5,main]) started. :runners:google-cloud-dataflow-java:****:compileJava (Thread[Execution **** Thread 3,5,main]) completed. Took 0.619 secs. Resolve mutations for :runners:google-cloud-dataflow-java:****:shadowJar (Thread[Execution **** Thread 4,5,main]) completed. Took 0.001 secs. :runners:google-cloud-dataflow-java:****:shadowJar (Thread[included builds,5,main]) started. > Task :runners:google-cloud-dataflow-java:****:shadowJar FROM-CACHE Custom actions are attached to task ':runners:google-cloud-dataflow-java:****:shadowJar'. Build cache key for task ':runners:google-cloud-dataflow-java:****:shadowJar' is 172d6db0e53ce55573e7f83f28df593e Task ':runners:google-cloud-dataflow-java:****:shadowJar' is not up-to-date because: No history is available. Loaded cache entry for task ':runners:google-cloud-dataflow-java:****:shadowJar' with cache key 172d6db0e53ce55573e7f83f28df593e :runners:google-cloud-dataflow-java:****:shadowJar (Thread[included builds,5,main]) completed. Took 0.518 secs. work action resolve beam-runners-google-cloud-dataflow-java-legacy-****.jar (project :runners:google-cloud-dataflow-java:****) (Thread[Execution **** Thread 3,5,main]) started. work action null (Thread[Execution **** Thread 3,5,main]) completed. Took 0.0 secs. work action resolve beam-runners-google-cloud-dataflow-java-legacy-****.jar (project :runners:google-cloud-dataflow-java:****) (Thread[Execution **** Thread 4,5,main]) started. work action null (Thread[Execution **** Thread 4,5,main]) completed. Took 0.0 secs. > Task :sdks:java:io:google-cloud-platform:compileTestJava FROM-CACHE Custom actions are attached to task ':sdks:java:io:google-cloud-platform:compileTestJava'. Build cache key for task ':sdks:java:io:google-cloud-platform:compileTestJava' is 81ac90136f4e0d1611237ab9102dde1f Task ':sdks:java:io:google-cloud-platform:compileTestJava' is not up-to-date because: No history is available. Loaded cache entry for task ':sdks:java:io:google-cloud-platform:compileTestJava' with cache key 81ac90136f4e0d1611237ab9102dde1f :sdks:java:io:google-cloud-platform:compileTestJava (Thread[Execution **** Thread 7,5,main]) completed. Took 0.962 secs. Resolve mutations for :sdks:java:io:google-cloud-platform:testClasses (Thread[included builds,5,main]) started. Resolve mutations for :sdks:java:io:google-cloud-platform:testClasses (Thread[included builds,5,main]) completed. Took 0.0 secs. :sdks:java:io:google-cloud-platform:testClasses (Thread[Execution **** Thread 4,5,main]) started. > Task :sdks:java:io:google-cloud-platform:testClasses Skipping task ':sdks:java:io:google-cloud-platform:testClasses' as it has no actions. :sdks:java:io:google-cloud-platform:testClasses (Thread[Execution **** Thread 4,5,main]) completed. Took 0.0 secs. Resolve mutations for :sdks:java:io:google-cloud-platform:testJar (Thread[Execution **** Thread 7,5,main]) started. Resolve mutations for :sdks:java:io:google-cloud-platform:testJar (Thread[Execution **** Thread 7,5,main]) completed. Took 0.0 secs. :sdks:java:io:google-cloud-platform:testJar (Thread[included builds,5,main]) started. > Task :sdks:java:io:google-cloud-platform:testJar Caching disabled for task ':sdks:java:io:google-cloud-platform:testJar' because: Not worth caching Task ':sdks:java:io:google-cloud-platform:testJar' is not up-to-date because: No history is available. :sdks:java:io:google-cloud-platform:testJar (Thread[included builds,5,main]) completed. Took 0.349 secs. work action resolve beam-sdks-java-io-google-cloud-platform-tests.jar (project :sdks:java:io:google-cloud-platform) (Thread[Execution **** Thread 4,5,main]) started. work action null (Thread[Execution **** Thread 4,5,main]) completed. Took 0.0 secs. Resolve mutations for :runners:google-cloud-dataflow-java:compileTestJava (Thread[Execution **** Thread 7,5,main]) started. Resolve mutations for :runners:google-cloud-dataflow-java:compileTestJava (Thread[Execution **** Thread 7,5,main]) completed. Took 0.001 secs. :runners:google-cloud-dataflow-java:compileTestJava (Thread[Execution **** Thread 3,5,main]) started. > Task :runners:google-cloud-dataflow-java:compileTestJava FROM-CACHE Custom actions are attached to task ':runners:google-cloud-dataflow-java:compileTestJava'. Build cache key for task ':runners:google-cloud-dataflow-java:compileTestJava' is 95d62ac4b18d1b1f58cd82d03fd1bcdf Task ':runners:google-cloud-dataflow-java:compileTestJava' is not up-to-date because: No history is available. Loaded cache entry for task ':runners:google-cloud-dataflow-java:compileTestJava' with cache key 95d62ac4b18d1b1f58cd82d03fd1bcdf :runners:google-cloud-dataflow-java:compileTestJava (Thread[Execution **** Thread 3,5,main]) completed. Took 0.392 secs. Resolve mutations for :runners:google-cloud-dataflow-java:testClasses (Thread[Execution **** Thread 2,5,main]) started. Resolve mutations for :runners:google-cloud-dataflow-java:testClasses (Thread[Execution **** Thread 2,5,main]) completed. Took 0.0 secs. :runners:google-cloud-dataflow-java:testClasses (Thread[Execution **** Thread 7,5,main]) started. > Task :runners:google-cloud-dataflow-java:testClasses UP-TO-DATE Skipping task ':runners:google-cloud-dataflow-java:testClasses' as it has no actions. :runners:google-cloud-dataflow-java:testClasses (Thread[Execution **** Thread 7,5,main]) completed. Took 0.0 secs. Resolve mutations for :runners:google-cloud-dataflow-java:testJar (Thread[Execution **** Thread 3,5,main]) started. Resolve mutations for :runners:google-cloud-dataflow-java:testJar (Thread[Execution **** Thread 3,5,main]) completed. Took 0.0 secs. :runners:google-cloud-dataflow-java:testJar (Thread[Execution **** Thread 2,5,main]) started. > Task :runners:google-cloud-dataflow-java:testJar Caching disabled for task ':runners:google-cloud-dataflow-java:testJar' because: Not worth caching Task ':runners:google-cloud-dataflow-java:testJar' is not up-to-date because: No history is available. file or directory '<https://ci-beam.apache.org/job/beam_PerformanceTests_SparkReceiver_IO/ws/src/runners/google-cloud-dataflow-java/build/resources/test',> not found :runners:google-cloud-dataflow-java:testJar (Thread[Execution **** Thread 2,5,main]) completed. Took 0.046 secs. work action resolve beam-runners-google-cloud-dataflow-java-tests.jar (project :runners:google-cloud-dataflow-java) (Thread[Execution **** Thread 7,5,main]) started. work action null (Thread[Execution **** Thread 7,5,main]) completed. Took 0.0 secs. Resolve mutations for :sdks:java:io:sparkreceiver:2:integrationTest (Thread[included builds,5,main]) started. Resolve mutations for :sdks:java:io:sparkreceiver:2:integrationTest (Thread[included builds,5,main]) completed. Took 0.0 secs. :sdks:java:io:sparkreceiver:2:integrationTest (Thread[Execution **** Thread 2,5,main]) started. producer locations for task group 0 (Thread[included builds,5,main]) started. producer locations for task group 0 (Thread[included builds,5,main]) completed. Took 0.0 secs. > Task :sdks:java:io:sparkreceiver:2:integrationTest Custom actions are attached to task ':sdks:java:io:sparkreceiver:2:integrationTest'. Build cache key for task ':sdks:java:io:sparkreceiver:2:integrationTest' is b7448c73a25facaf8e881ccd01dd937b Task ':sdks:java:io:sparkreceiver:2:integrationTest' is not up-to-date because: Task.upToDateWhen is false. Starting process 'Gradle Test Executor 1'. Working directory: <https://ci-beam.apache.org/job/beam_PerformanceTests_SparkReceiver_IO/ws/src/sdks/java/io/sparkreceiver/2> Command: /usr/lib/jvm/java-8-openjdk-amd64/bin/java -DbeamTestPipelineOptions=["--tempRoot=gs://temp-storage-for-perf-tests","--project=apache-beam-testing","--runner=DataflowRunner","--sourceOptions={\"numRecords\":\"5000000\",\"keySizeBytes\":\"1\",\"valueSizeBytes\":\"90\"}","--bigQueryDataset=beam_performance","--bigQueryTable=sparkreceiverioit_results","--influxMeasurement=sparkreceiverioit_results","--influxDatabase=beam_test_metrics","--influxHost=http://10.128.0.96:8086","--rabbitMqBootstrapServerAddress=amqp://guest:[email protected]:5672","--streamName=rabbitMqTestStream","--readTimeout=1800","--numWorkers=5","--autoscalingAlgorithm=NONE","--****HarnessContainerImage=","--dataflowWorkerJar=<https://ci-beam.apache.org/job/beam_PerformanceTests_SparkReceiver_IO/ws/src/runners/google-cloud-dataflow-java/****/build/libs/beam-runners-google-cloud-dataflow-java-legacy-****-2.48.0-SNAPSHOT.jar","--region=us-central1";]> -Djava.security.manager=****.org.gradle.process.internal.****.child.BootstrapSecurityManager -Dorg.gradle.internal.****.tmpdir=<https://ci-beam.apache.org/job/beam_PerformanceTests_SparkReceiver_IO/ws/src/sdks/java/io/sparkreceiver/2/build/tmp/integrationTest/work> -Dorg.gradle.native=false -Xmx2g -Dfile.encoding=UTF-8 -Duser.country=US -Duser.language=en -Duser.variant -ea -cp /home/jenkins/.gradle/caches/7.5.1/****Main/gradle-****.jar ****.org.gradle.process.internal.****.GradleWorkerMain 'Gradle Test Executor 1' Successfully started process 'Gradle Test Executor 1' Gradle Test Executor 1 started executing tests. > Task :sdks:java:io:sparkreceiver:2:integrationTest org.apache.beam.sdk.io.sparkreceiver.SparkReceiverIOIT STANDARD_ERROR SLF4J: Class path contains multiple SLF4J bindings. SLF4J: Found binding in [jar:file:/home/jenkins/.gradle/caches/modules-2/files-2.1/org.slf4j/slf4j-simple/1.7.30/e606eac955f55ecf1d8edcccba04eb8ac98088dd/slf4j-simple-1.7.30.jar!/org/slf4j/impl/StaticLoggerBinder.class] SLF4J: Found binding in [jar:<https://ci-beam.apache.org/job/beam_PerformanceTests_SparkReceiver_IO/ws/src/runners/google-cloud-dataflow-java/****/build/libs/beam-runners-google-cloud-dataflow-java-legacy-****-2.48.0-SNAPSHOT.jar!/org/slf4j/impl/StaticLoggerBinder.class]> SLF4J: See http://www.slf4j.org/codes.html#multiple_bindings for an explanation. SLF4J: Actual binding is of type [org.slf4j.impl.SimpleLoggerFactory] org.apache.beam.sdk.io.sparkreceiver.SparkReceiverIOIT > testSparkReceiverIOReadsInStreamingWithOffset STANDARD_ERROR [Test ****] INFO org.apache.beam.sdk.io.sparkreceiver.SparkReceiverIOIT - 5000000 records were successfully written to RabbitMQ [Test ****] INFO org.apache.beam.sdk.io.sparkreceiver.SparkReceiverIO - ReadFromSparkReceiverWithOffsetDoFn started reading [Test ****] WARN org.apache.beam.runners.dataflow.DataflowRunner - Prefer --sdkContainerImage over deprecated legacy option --****HarnessContainerImage. [Test ****] INFO org.apache.beam.sdk.extensions.gcp.options.GcpOptions$GcpTempLocationFactory - No tempLocation specified, attempting to use default bucket: dataflow-staging-us-central1-844138762903 [Test ****] WARN org.apache.beam.sdk.extensions.gcp.util.RetryHttpRequestInitializer - Request failed with code 409, performed 0 retries due to IOExceptions, performed 0 retries due to unsuccessful status codes, HTTP framework says request can be retried, (caller responsible for retrying): https://storage.googleapis.com/storage/v1/b?predefinedAcl=projectPrivate&predefinedDefaultObjectAcl=projectPrivate&project=apache-beam-testing. [Test ****] INFO org.apache.beam.runners.dataflow.options.DataflowPipelineOptions$StagingLocationFactory - No stagingLocation provided, falling back to gcpTempLocation [Test ****] INFO org.apache.beam.runners.dataflow.DataflowRunner - PipelineOptions.filesToStage was not specified. Defaulting to files from the classpath: will stage 428 files. Enable logging at DEBUG level to see which files will be staged. [Test ****] INFO org.apache.beam.runners.dataflow.DataflowRunner - Executing pipeline on the Dataflow Service, which will have billing implications related to Google Compute Engine usage and other Google Cloud Services. [Test ****] INFO org.apache.beam.runners.dataflow.util.PackageUtil - Uploading 429 files from PipelineOptions.filesToStage to staging location to prepare for execution. [pool-8-thread-1] INFO org.apache.beam.runners.dataflow.util.PackageUtil - Staging custom dataflow-****.jar as beam-runners-google-cloud-dataflow-java-legacy-****-2.48.0-SNAPSHOT-MMCuEYwPYdGiPxjVjXX9rQvJSsVVzLbx43buGdMPrSw.jar [pool-8-thread-19] INFO org.apache.beam.runners.dataflow.util.PackageUtil - Uploading /tmp/main3635151050505344155.zip to gs://dataflow-staging-us-central1-844138762903/temp/staging/main-l4FJcEg1qjZeua8BvXvqguLjZvuLPsZz8LNpMQ3tKmQ.jar [pool-8-thread-14] INFO org.apache.beam.runners.dataflow.util.PackageUtil - Uploading /tmp/test77735998369944492.zip to gs://dataflow-staging-us-central1-844138762903/temp/staging/test-59hqjDzOaiv_G9Eq4Uv7NZWVarLfU4co1iqmo3txiis.jar [pool-8-thread-20] INFO org.apache.beam.runners.dataflow.util.PackageUtil - Uploading /tmp/test7942527028441349995.zip to gs://dataflow-staging-us-central1-844138762903/temp/staging/test-qNvExhL-1IrUT-gNSbETYco5n-P3s3MZe1sPC_uRYKA.jar [Test ****] INFO org.apache.beam.runners.dataflow.util.PackageUtil - Staging files complete: 426 files cached, 3 files newly uploaded in 0 seconds [Test ****] INFO org.apache.beam.runners.dataflow.DataflowRunner - Staging portable pipeline proto to gs://dataflow-staging-us-central1-844138762903/temp/staging/ [pool-15-thread-1] INFO org.apache.beam.runners.dataflow.util.PackageUtil - Uploading <161326 bytes, hash 63a541bb57eb6c91542d201287dce69027b627d3e1da070d8b2ae5ba594db293> to gs://dataflow-staging-us-central1-844138762903/temp/staging/pipeline-Y6VBu1frbJFULSASh9zmkCe2J9Ph2gcNiyrlullNspM.pb [Test ****] INFO org.apache.beam.runners.dataflow.DataflowPipelineTranslator - Adding Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/Impulse as step s1 [Test ****] INFO org.apache.beam.runners.dataflow.DataflowPipelineTranslator - Adding Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Pair with initial restriction as step s2 [Test ****] INFO org.apache.beam.runners.dataflow.DataflowPipelineTranslator - Adding Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Split restriction as step s3 [Test ****] INFO org.apache.beam.runners.dataflow.DataflowPipelineTranslator - Adding Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Explode windows as step s4 [Test ****] INFO org.apache.beam.runners.dataflow.DataflowPipelineTranslator - Adding Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Assign unique key/AddKeys/Map as step s5 [Test ****] INFO org.apache.beam.runners.dataflow.DataflowPipelineTranslator - Adding Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/ProcessKeyedElements as step s6 [Test ****] INFO org.apache.beam.runners.dataflow.DataflowPipelineTranslator - Adding Measure read time as step s7 [Test ****] INFO org.apache.beam.runners.dataflow.DataflowPipelineTranslator - Adding Counting element as step s8 [Test ****] INFO org.apache.beam.runners.dataflow.DataflowRunner - Dataflow SDK version: 2.48.0-SNAPSHOT [Test ****] INFO org.apache.beam.runners.dataflow.DataflowRunner - To access the Dataflow monitoring console, please navigate to https://console.cloud.google.com/dataflow/jobs/us-central1/2023-04-12_05_47_51-11221096843911196050?project=apache-beam-testing [Test ****] INFO org.apache.beam.runners.dataflow.DataflowRunner - Submitted job: 2023-04-12_05_47_51-11221096843911196050 [Test ****] INFO org.apache.beam.runners.dataflow.DataflowRunner - To cancel the job using the 'gcloud' tool, run: > gcloud dataflow jobs --project=apache-beam-testing cancel --region=us-central1 2023-04-12_05_47_51-11221096843911196050 [Test ****] WARN org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:47:55.501Z: The workflow name is not a valid Cloud Label. Labels applied to Cloud resources (such as GCE Instances) for monitoring will be labeled with this modified job name: sparkreceiverioit0testsparkreceiverioreadsinstreamingwitho-hckl. For the best monitoring experience, please name your job with a valid Cloud Label. For details, see: https://cloud.google.com/compute/docs/labeling-resources#restrictions [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:09.325Z: Worker configuration: e2-standard-4 in us-central1-b. [Test ****] WARN org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:11.392Z: Querying the configuration of Pub/Sub subscription _starting_signal/ failed. If the ack deadline on the subscription has been changed from the default value, this may affect performance. Also, this prevents Dataflow from checking for unsupported settings on the subscription. See https://cloud.google.com/dataflow/docs/concepts/security-and-permissions#accessing_pubsub for further details. If the error is not correctable, the job may be updated with a valid Pub/Sub configuration. Specific error: INVALID_ARGUMENT: [type.googleapis.com/util.MessageSetPayload='[dist_proc.dax.internal.StackTraceProto] { stack_top_loc { filepath: "dist_proc/dax_extensions/workflow/cloud/service/pubsub_subscription_util.cc" line: 592 } address: 94865836528587 address: 94866037568275 address: 94866037547289 address: 94866037533987 address: 94866037538571 address: 94866037989753 address: 94865986850705 address: 94865995530534 address: 94865941069128 address: 140635978209241 address: 140635977639583 } [dist_proc.dax.internal.TrailProto] { trail_point { source_file_loc { filepath: "dist_proc/dax_extensions/workflow/cloud/service/pubsub_subscription_util.cc" line: 592 } } } [dist_proc.dax.MessageCode] { argument { string_val: "_starting_signal/" key: "subscription_name" } argument { string_val: "Invalid resource name given (name=_starting_signal/). Refer to https://cloud.google.com/pubsub/docs/admin#resource_names for more information." key: "error" } origin_id: 6362756278386561945 [dist_proc.dax.pubsub_resource_message_ext]: GETTING_PUBSUB_SUBSCRIPTION_FAILED }'] [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:11.459Z: Expanding CoGroupByKey operations into optimizable parts. [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:11.508Z: Expanding SplittableProcessKeyed operations into optimizable parts. [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:11.528Z: Expanding GroupByKey operations into streaming Read/Write steps [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:11.595Z: Lifting ValueCombiningMappingFns into MergeBucketsMappingFns [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:11.660Z: Fusing adjacent ParDo, Read, Write, and Flatten operations [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:11.688Z: Fusing consumer Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Pair with initial restriction into Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/Impulse [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:11.708Z: Fusing consumer Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Split restriction into Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Pair with initial restriction [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:11.731Z: Fusing consumer Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Explode windows into Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Split restriction [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:11.755Z: Fusing consumer Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Assign unique key/AddKeys/Map into Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Explode windows [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:11.775Z: Fusing consumer s6/GroupByKeyRaw/WriteStream into Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Assign unique key/AddKeys/Map [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:11.805Z: Fusing consumer s6/SplittableProcess into s6/GroupByKeyRaw/ReadStream [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:11.837Z: Fusing consumer Measure read time into s6/SplittableProcess [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:11.870Z: Fusing consumer Counting element into Measure read time [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:12.214Z: Executing operation s6/GroupByKeyRaw/ReadStream+s6/SplittableProcess+Measure read time+Counting element [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:12.291Z: Starting 5 ****s in us-central1-b... [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:12.821Z: Executing operation Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/Impulse+Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Pair with initial restriction+Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Split restriction+Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Explode windows+Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Assign unique key/AddKeys/Map+s6/GroupByKeyRaw/WriteStream [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:13.435Z: Your project already contains 100 Dataflow-created metric descriptors, so new user metrics of the form custom.googleapis.com/* will not be created. However, all user metrics are also available in the metric dataflow.googleapis.com/job/user_counter. If you rely on the custom metrics, you can delete old / unused metric descriptors. See https://developers.google.com/apis-explorer/#p/monitoring/v3/monitoring.projects.metricDescriptors.list and https://developers.google.com/apis-explorer/#p/monitoring/v3/monitoring.projects.metricDescriptors.delete [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:48:56.132Z: Autoscaling: Raised the number of ****s to 5 so that the pipeline can catch up with its backlog and keep up with its input rate. [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:49:28.278Z: Workers have started successfully. [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T12:49:30.254Z: All ****s have finished the startup processes and began to receive work requests. [Test ****] WARN org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T13:00:28.082Z: Querying the configuration of Pub/Sub subscription _starting_signal/ failed. If the ack deadline on the subscription has been changed from the default value, this may affect performance. Also, this prevents Dataflow from checking for unsupported settings on the subscription. See https://cloud.google.com/dataflow/docs/concepts/security-and-permissions#accessing_pubsub for further details. If the error is not correctable, the job may be updated with a valid Pub/Sub configuration. Specific error: INVALID_ARGUMENT: [type.googleapis.com/util.MessageSetPayload='[dist_proc.dax.internal.StackTraceProto] { stack_top_loc { filepath: "dist_proc/dax_extensions/workflow/cloud/service/pubsub_subscription_util.cc" line: 592 } address: 94865836528587 address: 94866037568275 address: 94866037547289 address: 94866037533987 address: 94866037538571 address: 94866037989753 address: 94866037527908 address: 94865863369740 address: 94865941069222 address: 140635978209241 address: 140635977639583 } [dist_proc.dax.internal.TrailProto] { trail_point { source_file_loc { filepath: "dist_proc/dax_extensions/workflow/cloud/service/pubsub_subscription_util.cc" line: 592 } } } [dist_proc.dax.MessageCode] { argument { string_val: "_starting_signal/" key: "subscription_name" } argument { string_val: "Invalid resource name given (name=_starting_signal/). Refer to https://cloud.google.com/pubsub/docs/admin#resource_names for more information." key: "error" } origin_id: 16784330308074434448 [dist_proc.dax.pubsub_resource_message_ext]: GETTING_PUBSUB_SUBSCRIPTION_FAILED }'] [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T13:11:54.035Z: Cancel request is committed for workflow job: 2023-04-12_05_47_51-11221096843911196050. [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T13:11:54.071Z: Finished operation Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/Impulse+Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Pair with initial restriction+Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Split restriction+Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Explode windows+Read from unbounded RabbitMq/SparkReceiverIO.ReadFromSparkReceiverViaSdf/ParDo(ReadFromSparkReceiverWithOffset)/ParMultiDo(ReadFromSparkReceiverWithOffset)/Assign unique key/AddKeys/Map+s6/GroupByKeyRaw/WriteStream [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T13:11:54.071Z: Finished operation s6/GroupByKeyRaw/ReadStream+s6/SplittableProcess+Measure read time+Counting element [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T13:11:54.163Z: Cleaning up. [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T13:11:54.213Z: Stopping **** pool... [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T13:14:09.489Z: Autoscaling: Reduced the number of ****s to 0 based on low average **** CPU utilization, and the pipeline having sufficiently low backlog and keeping up with input rate. [Test ****] INFO org.apache.beam.runners.dataflow.util.MonitoringUtil$LoggingHandler - 2023-04-12T13:14:09.548Z: Worker pool stopped. [Test ****] INFO org.apache.beam.runners.dataflow.DataflowPipelineJob - Job 2023-04-12_05_47_51-11221096843911196050 finished with status CANCELLED. org.apache.beam.sdk.io.sparkreceiver.SparkReceiverIOIT > testSparkReceiverIOReadsInStreamingWithOffset FAILED java.lang.AssertionError: expected:<5000000> but was:<980000> at org.junit.Assert.fail(Assert.java:89) at org.junit.Assert.failNotEquals(Assert.java:835) at org.junit.Assert.assertEquals(Assert.java:647) at org.junit.Assert.assertEquals(Assert.java:633) at org.apache.beam.sdk.io.sparkreceiver.SparkReceiverIOIT.testSparkReceiverIOReadsInStreamingWithOffset(SparkReceiverIOIT.java:337) Gradle Test Executor 1 finished executing tests. > Task :sdks:java:io:sparkreceiver:2:integrationTest FAILED 1 test completed, 1 failed Finished generating test XML results (0.027 secs) into: <https://ci-beam.apache.org/job/beam_PerformanceTests_SparkReceiver_IO/ws/src/sdks/java/io/sparkreceiver/2/build/test-results/integrationTest> Generating HTML test report... Finished generating test html results (0.034 secs) into: <https://ci-beam.apache.org/job/beam_PerformanceTests_SparkReceiver_IO/ws/src/sdks/java/io/sparkreceiver/2/build/reports/tests/integrationTest> :sdks:java:io:sparkreceiver:2:integrationTest (Thread[Execution **** Thread 2,5,main]) completed. Took 33 mins 3.018 secs. FAILURE: Build failed with an exception. * What went wrong: Execution failed for task ':sdks:java:io:sparkreceiver:2:integrationTest'. > There were failing tests. See the report at: > file://<https://ci-beam.apache.org/job/beam_PerformanceTests_SparkReceiver_IO/ws/src/sdks/java/io/sparkreceiver/2/build/reports/tests/integrationTest/index.html> * Try: > Run with --stacktrace option to get the stack trace. > Run with --debug option to get more log output. * Get more help at https://help.gradle.org Deprecated Gradle features were used in this build, making it incompatible with Gradle 8.0. You can use '--warning-mode all' to show the individual deprecation warnings and determine if they come from your own scripts or plugins. See https://docs.gradle.org/7.5.1/userguide/command_line_interface.html#sec:command_line_warnings BUILD FAILED in 33m 49s 145 actionable tasks: 86 executed, 57 from cache, 2 up-to-date Publishing build scan... https://gradle.com/s/y2gn5plt3srgq Build step 'Invoke Gradle script' changed build result to FAILURE Build step 'Invoke Gradle script' marked build as failure --------------------------------------------------------------------- To unsubscribe, e-mail: [email protected] For additional commands, e-mail: [email protected]
