Build/Test Explorer

  ++ dirname tools/run_tests/helper_scripts/run_tests_in_workspace.sh
+ cd tools/run_tests/helper_scripts/../../..
++ pwd
+ repo_root=/tmpfs/altsrc/github/grpc
+ export repo_root
+ rm -rf workspace_python_macos_opt_native
+ git clone . workspace_python_macos_opt_native
Cloning into 'workspace_python_macos_opt_native'...
done.
Updating files:  24% (3027/12289)
Updating files:  25% (3073/12289)
Updating files:  26% (3196/12289)
Updating files:  27% (3319/12289)
Updating files:  28% (3441/12289)
Updating files:  29% (3564/12289)
Updating files:  30% (3687/12289)
Updating files:  31% (3810/12289)
Updating files:  32% (3933/12289)
Updating files:  33% (4056/12289)
Updating files:  34% (4179/12289)
Updating files:  35% (4302/12289)
Updating files:  36% (4425/12289)
Updating files:  37% (4547/12289)
Updating files:  38% (4670/12289)
Updating files:  39% (4793/12289)
Updating files:  40% (4916/12289)
Updating files:  41% (5039/12289)
Updating files:  42% (5162/12289)
Updating files:  42% (5238/12289)
Updating files:  43% (5285/12289)
Updating files:  44% (5408/12289)
Updating files:  45% (5531/12289)
Updating files:  46% (5653/12289)
Updating files:  47% (5776/12289)
Updating files:  48% (5899/12289)
Updating files:  49% (6022/12289)
Updating files:  50% (6145/12289)
Updating files:  51% (6268/12289)
Updating files:  52% (6391/12289)
Updating files:  53% (6514/12289)
Updating files:  54% (6637/12289)
Updating files:  55% (6759/12289)
Updating files:  56% (6882/12289)
Updating files:  57% (7005/12289)
Updating files:  58% (7128/12289)
Updating files:  59% (7251/12289)
Updating files:  60% (7374/12289)
Updating files:  61% (7497/12289)
Updating files:  62% (7620/12289)
Updating files:  63% (7743/12289)
Updating files:  64% (7865/12289)
Updating files:  65% (7988/12289)
Updating files:  66% (8111/12289)
Updating files:  67% (8234/12289)
Updating files:  68% (8357/12289)
Updating files:  69% (8480/12289)
Updating files:  70% (8603/12289)
Updating files:  71% (8726/12289)
Updating files:  72% (8849/12289)
Updating files:  73% (8971/12289)
Updating files:  74% (9094/12289)
Updating files:  75% (9217/12289)
Updating files:  76% (9340/12289)
Updating files:  77% (9463/12289)
Updating files:  77% (9487/12289)
Updating files:  78% (9586/12289)
Updating files:  79% (9709/12289)
Updating files:  80% (9832/12289)
Updating files:  81% (9955/12289)
Updating files:  82% (10077/12289)
Updating files:  83% (10200/12289)
Updating files:  84% (10323/12289)
Updating files:  85% (10446/12289)
Updating files:  86% (10569/12289)
Updating files:  87% (10692/12289)
Updating files:  88% (10815/12289)
Updating files:  89% (10938/12289)
Updating files:  90% (11061/12289)
Updating files:  91% (11183/12289)
Updating files:  92% (11306/12289)
Updating files:  93% (11429/12289)
Updating files:  94% (11552/12289)
Updating files:  95% (11675/12289)
Updating files:  96% (11798/12289)
Updating files:  97% (11921/12289)
Updating files:  98% (12044/12289)
Updating files:  98% (12129/12289)
Updating files:  99% (12167/12289)
Updating files: 100% (12289/12289)
Updating files: 100% (12289/12289), done.
+ git submodule foreach 'cd "${repo_root}/${WORKSPACE_NAME}" \
    && git submodule update --init --reference ${repo_root}/${name} ${name}'
Entering 'third_party/abseil-cpp'
Submodule 'third_party/abseil-cpp' (https://github.com/abseil/abseil-cpp.git) registered for path 'third_party/abseil-cpp'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/abseil-cpp'...
Submodule path 'third_party/abseil-cpp': checked out '4a2c63365eff8823a5221db86ef490e828306f9d'
Entering 'third_party/benchmark'
Submodule 'third_party/benchmark' (https://github.com/google/benchmark) registered for path 'third_party/benchmark'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/benchmark'...
Submodule path 'third_party/benchmark': checked out '344117638c8ff7e239044fd0fa7085839fc03021'
Entering 'third_party/bloaty'
Submodule 'third_party/bloaty' (https://github.com/google/bloaty.git) registered for path 'third_party/bloaty'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/bloaty'...
Submodule path 'third_party/bloaty': checked out '60209eb1ccc34d5deefb002d1b7f37545204f7f2'
Entering 'third_party/boringssl-with-bazel'
Submodule 'third_party/boringssl-with-bazel' (https://github.com/google/boringssl.git) registered for path 'third_party/boringssl-with-bazel'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/boringssl-with-bazel'...
Submodule path 'third_party/boringssl-with-bazel': checked out 'b8b3e6e11166719a8ebfa43c0cde9ad7d57a84f6'
Entering 'third_party/cares/cares'
Submodule 'third_party/cares/cares' (https://github.com/c-ares/c-ares.git) registered for path 'third_party/cares/cares'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/cares/cares'...
Submodule path 'third_party/cares/cares': checked out '6360e96b5cf8e5980c887ce58ef727e53d77243a'
Entering 'third_party/envoy-api'
Submodule 'third_party/envoy-api' (https://github.com/envoyproxy/data-plane-api.git) registered for path 'third_party/envoy-api'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/envoy-api'...
Submodule path 'third_party/envoy-api': checked out 'f8b75d1efa92bbf534596a013d9ca5873f79dd30'
Entering 'third_party/googleapis'
Submodule 'third_party/googleapis' (https://github.com/googleapis/googleapis.git) registered for path 'third_party/googleapis'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/googleapis'...
Submodule path 'third_party/googleapis': checked out 'fe8ba054ad4f7eca946c2d14a63c3f07c0b586a0'
Entering 'third_party/googletest'
Submodule 'third_party/googletest' (https://github.com/google/googletest.git) registered for path 'third_party/googletest'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/googletest'...
Submodule path 'third_party/googletest': checked out '2dd1c131950043a8ad5ab0d2dda0e0970596586a'
Entering 'third_party/opencensus-proto'
Submodule 'third_party/opencensus-proto' (https://github.com/census-instrumentation/opencensus-proto.git) registered for path 'third_party/opencensus-proto'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/opencensus-proto'...
Submodule path 'third_party/opencensus-proto': checked out '4aa53e15cbf1a47bc9087e6cfdca214c1eea4e89'
Entering 'third_party/opentelemetry'
Submodule 'third_party/opentelemetry' (https://github.com/open-telemetry/opentelemetry-proto.git) registered for path 'third_party/opentelemetry'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/opentelemetry'...
Submodule path 'third_party/opentelemetry': checked out '60fa8754d890b5c55949a8c68dcfd7ab5c2395df'
Entering 'third_party/opentelemetry-cpp'
Submodule 'third_party/opentelemetry-cpp' (https://github.com/open-telemetry/opentelemetry-cpp) registered for path 'third_party/opentelemetry-cpp'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/opentelemetry-cpp'...
Submodule path 'third_party/opentelemetry-cpp': checked out '4bd64c9a336fd438d6c4c9dad2e6b61b0585311f'
Entering 'third_party/protobuf'
Submodule 'third_party/protobuf' (https://github.com/protocolbuffers/protobuf.git) registered for path 'third_party/protobuf'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/protobuf'...
Submodule path 'third_party/protobuf': checked out '63def39e881afa496502d9c410f4ea948e59490d'
Entering 'third_party/protoc-gen-validate'
Submodule 'third_party/protoc-gen-validate' (https://github.com/envoyproxy/protoc-gen-validate.git) registered for path 'third_party/protoc-gen-validate'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/protoc-gen-validate'...
Submodule path 'third_party/protoc-gen-validate': checked out 'fab737efbb4b4d03e7c771393708f75594b121e4'
Entering 'third_party/re2'
Submodule 'third_party/re2' (https://github.com/google/re2.git) registered for path 'third_party/re2'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/re2'...
Submodule path 'third_party/re2': checked out '0c5616df9c0aaa44c9440d87422012423d91c7d1'
Entering 'third_party/xds'
Submodule 'third_party/xds' (https://github.com/cncf/xds.git) registered for path 'third_party/xds'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/xds'...
Submodule path 'third_party/xds': checked out '3a472e524827f72d1ad621c4983dd5af54c46776'
Entering 'third_party/zlib'
Submodule 'third_party/zlib' (https://github.com/madler/zlib) registered for path 'third_party/zlib'
Cloning into '/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/third_party/zlib'...
Submodule path 'third_party/zlib': checked out '09155eaa2f9270dc4ed1fa13e2b4b2613e6e4851'
+ echo 'Running run_tests.py in workspace workspace_python_macos_opt_native'
Running run_tests.py in workspace workspace_python_macos_opt_native
+ python3 workspace_python_macos_opt_native/tools/run_tests/run_tests.py -t -j 4 -x run_tests/python_macos_opt_native/sponge_log.xml --report_suite_name python_macos_opt_native -l python -c opt --iomgr_platform native --bq_result_table aggregate_results --measure_cpu_costs --report_multi_target
2024-09-11 16:23:16,638 START: /Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/tools/run_tests/helper_scripts/build_python.sh
2024-09-11 16:38:53,980 PASSED: /Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/tools/run_tests/helper_scripts/build_python.sh [time=937.3sec, retries=0:0; cpu_cost=3.4; estimated=1.0]
2024-09-11 16:38:53,999 failed to detect port server
Traceback (most recent call last):
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/urllib/request.py", line 1348, in do_open
    h.request(req.get_method(), req.selector, req.data, headers,
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/http/client.py", line 1282, in request
    self._send_request(method, url, body, headers, encode_chunked)
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/http/client.py", line 1328, in _send_request
    self.endheaders(body, encode_chunked=encode_chunked)
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/http/client.py", line 1277, in endheaders
    self._send_output(message_body, encode_chunked=encode_chunked)
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/http/client.py", line 1037, in _send_output
    self.send(msg)
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/http/client.py", line 975, in send
    self.connect()
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/http/client.py", line 941, in connect
    self.sock = self._create_connection(
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/socket.py", line 845, in create_connection
    raise err
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/socket.py", line 833, in create_connection
    sock.connect(sa)
ConnectionRefusedError: [Errno 61] Connection refused

During handling of the above exception, another exception occurred:

Traceback (most recent call last):
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/tools/run_tests/python_utils/start_port_server.py", line 41, in start_port_server
    request.urlopen(
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/urllib/request.py", line 216, in urlopen
    return opener.open(url, data, timeout)
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/urllib/request.py", line 519, in open
    response = self._open(req, data)
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/urllib/request.py", line 536, in _open
    result = self._call_chain(self.handle_open, protocol, protocol +
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/urllib/request.py", line 496, in _call_chain
    result = func(*args)
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/urllib/request.py", line 1377, in http_open
    return self.do_open(http.client.HTTPConnection, req)
  File "/Users/kbuilder/.pyenv/versions/3.10.3/lib/python3.10/urllib/request.py", line 1351, in do_open
    raise URLError(err)
urllib.error.URLError: <urlopen error [Errno 61] Connection refused>
2024-09-11 16:38:54,016 starting port_server, with log file /var/folders/1d/z50_0t6s6fsb1yj3_svwklk80000gn/T/tmpnwghss_u
2024-09-11 16:38:55,175 port server is up and ready
2024-09-11 16:38:55,177 START: py38.native.tests.protoc_plugin._split_definitions_test.SplitProtoSingleProtocExecutionProtocStyleTest
2024-09-11 16:38:55,180 START: py38.native.tests.unit._abort_test.AbortTest
2024-09-11 16:38:55,184 START: py38.asyncio.tests_aio.unit.call_test.TestStreamUnaryCall
2024-09-11 16:38:55,189 START: py38.native.tests.unit._cython.cygrpc_test.SecureServerSecureClient
2024-09-11 16:38:57,469 PASSED: py38.native.tests.unit._cython.cygrpc_test.SecureServerSecureClient [time=2.3sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:38:57,469 START: py38.native.tests.status._grpc_status_test.StatusTest
2024-09-11 16:38:57,497 PASSED: py38.native.tests.protoc_plugin._split_definitions_test.SplitProtoSingleProtocExecutionProtocStyleTest [time=2.3sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:38:57,497 START: py38.native.tests.unit._exit_test.ExitTest
2024-09-11 16:38:57,503 PASSED: py38.native.tests.unit._abort_test.AbortTest [time=2.3sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:38:57,504 START: py38.native.tests.protoc_plugin.beta_python_plugin_test.PythonPluginTest
2024-09-11 16:38:59,491 PASSED: py38.native.tests.status._grpc_status_test.StatusTest [time=2.0sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:38:59,492 START: py38.native.tests.unit._signal_handling_test.SignalHandlingTest
2024-09-11 16:38:59,534 PASSED: py38.native.tests.unit._exit_test.ExitTest [time=2.0sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:38:59,535 START: py38.native.tests.unit.beta._beta_features_test.ContextManagementAndLifecycleTest
2024-09-11 16:39:00,446 PASSED: py38.asyncio.tests_aio.unit.call_test.TestStreamUnaryCall [time=5.3sec, retries=0:0; cpu_cost=0.4; estimated=1.0]
2024-09-11 16:39:00,447 START: py38.asyncio.tests_aio.unit.timeout_test.TestTimeout
2024-09-11 16:39:02,212 PASSED: py38.native.tests.unit._signal_handling_test.SignalHandlingTest [time=2.7sec, retries=0:0; cpu_cost=1.2; estimated=1.0]
2024-09-11 16:39:02,213 START: py38.native.tests.unit._cython._no_messages_server_completion_queue_per_call_test.Test
2024-09-11 16:39:07,179 PASSED: py38.native.tests.unit.beta._beta_features_test.ContextManagementAndLifecycleTest [time=7.6sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:07,179 START: py38.asyncio.tests_aio.unit.context_peer_test.TestContextPeer
2024-09-11 16:39:08,615 PASSED: py38.asyncio.tests_aio.unit.context_peer_test.TestContextPeer [time=1.4sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:39:08,617 START: py38.native.tests.unit._invalid_metadata_test.InvalidMetadataTest
2024-09-11 16:39:08,887 PASSED: py38.asyncio.tests_aio.unit.timeout_test.TestTimeout [time=8.4sec, retries=0:0; cpu_cost=0.2; estimated=1.0]
2024-09-11 16:39:08,887 START: py38.asyncio.tests_aio.unit.call_test.TestUnaryStreamCall
2024-09-11 16:39:10,453 PASSED: py38.native.tests.unit._invalid_metadata_test.InvalidMetadataTest [time=1.8sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:10,456 START: py38.native.tests.protoc_plugin._split_definitions_test.SplitProtoGrpcBeforeProtoProtocStyleTest
2024-09-11 16:39:12,044 PASSED: py38.native.tests.protoc_plugin._split_definitions_test.SplitProtoGrpcBeforeProtoProtocStyleTest [time=1.6sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:12,044 START: py38.native.tests.protoc_plugin._split_definitions_test.SameProtoProtoBeforeGrpcProtocStyleTest
2024-09-11 16:39:13,754 PASSED: py38.native.tests.protoc_plugin._split_definitions_test.SameProtoProtoBeforeGrpcProtocStyleTest [time=1.7sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:13,755 START: py38.native.tests.unit._auth_test.AccessTokenAuthMetadataPluginTest
2024-09-11 16:39:15,061 PASSED: py38.native.tests.unit._auth_test.AccessTokenAuthMetadataPluginTest [time=1.3sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:15,066 START: py38.native.tests.unit._cython._cancel_many_calls_test.CancelManyCallsTest
2024-09-11 16:39:16,986 PASSED: py38.native.tests.unit._cython._cancel_many_calls_test.CancelManyCallsTest [time=1.9sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:16,987 START: py38.asyncio.tests_aio.unit.secure_call_test.TestStreamStreamSecureCall
2024-09-11 16:39:17,416 PASSED: py38.asyncio.tests_aio.unit.call_test.TestUnaryStreamCall [time=8.5sec, retries=0:0; cpu_cost=0.3; estimated=1.0]
2024-09-11 16:39:17,417 START: py38.native.tests.unit._channel_connectivity_test.ChannelConnectivityTest
2024-09-11 16:39:18,236 PASSED: py38.asyncio.tests_aio.unit.secure_call_test.TestStreamStreamSecureCall [time=1.2sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:39:18,236 START: py38.native.tests.unit._cython._fork_test.ForkWindowsTester
2024-09-11 16:39:19,353 PASSED: py38.native.tests.unit._cython._no_messages_server_completion_queue_per_call_test.Test [time=17.1sec, retries=0:0; cpu_cost=1.2; estimated=1.0]
2024-09-11 16:39:19,354 START: py38.native.tests.unit._cython.cygrpc_test.TypeSmokeTest
2024-09-11 16:39:19,839 PASSED: py38.native.tests.unit._cython._fork_test.ForkWindowsTester [time=1.6sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:19,839 START: py38.native.tests.unit._reconnect_test.ReconnectTest
2024-09-11 16:39:20,535 PASSED: py38.native.tests.protoc_plugin.beta_python_plugin_test.PythonPluginTest [time=23.0sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:20,535 START: py38.asyncio.tests_aio.unit.channel_ready_test.TestChannelReady
2024-09-11 16:39:20,608 PASSED: py38.native.tests.unit._cython.cygrpc_test.TypeSmokeTest [time=1.3sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:20,609 START: py38.native.tests.unit._compression_test.CompressionTest
2024-09-11 16:39:26,914 PASSED: py38.native.tests.unit._reconnect_test.ReconnectTest [time=7.1sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:26,915 START: py38.native.tests.testing._client_test.ClientTest
2024-09-11 16:39:27,284 PASSED: py38.asyncio.tests_aio.unit.channel_ready_test.TestChannelReady [time=6.7sec, retries=0:0; cpu_cost=0.3; estimated=1.0]
2024-09-11 16:39:27,284 START: py38.native.tests.unit._api_test.AllTest
2024-09-11 16:39:27,587 PASSED: py38.native.tests.unit._channel_connectivity_test.ChannelConnectivityTest [time=10.2sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:27,588 START: py38.native.tests.unit._server_shutdown_test.ServerShutdown
2024-09-11 16:39:29,533 PASSED: py38.native.tests.unit._api_test.AllTest [time=2.2sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:39:29,534 START: py38.native.tests.health_check._health_servicer_test.HealthServicerTest
2024-09-11 16:39:29,585 PASSED: py38.native.tests.testing._client_test.ClientTest [time=2.7sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:29,590 START: py38.asyncio.tests_aio.reflection.reflection_servicer_test.ReflectionServicerTest
2024-09-11 16:39:29,734 PASSED: py38.native.tests.unit._compression_test.CompressionTest [time=9.1sec, retries=0:0; cpu_cost=1.2; estimated=1.0]
2024-09-11 16:39:29,738 START: py38.native.tests.unit._cython._no_messages_single_server_completion_queue_test.Test
2024-09-11 16:39:31,350 PASSED: py38.native.tests.unit._server_shutdown_test.ServerShutdown [time=3.8sec, retries=0:0; cpu_cost=1.1; estimated=1.0]
2024-09-11 16:39:31,351 START: py38.asyncio.tests_aio.unit.call_test.TestStreamStreamCall
2024-09-11 16:39:31,671 PASSED: py38.asyncio.tests_aio.reflection.reflection_servicer_test.ReflectionServicerTest [time=2.1sec, retries=0:0; cpu_cost=0.7; estimated=1.0]
2024-09-11 16:39:31,671 START: py38.native.tests.unit.beta._beta_features_test.BetaFeaturesTest
2024-09-11 16:39:33,473 PASSED: py38.native.tests.unit.beta._beta_features_test.BetaFeaturesTest [time=1.8sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:33,479 START: py38.native.tests.protoc_plugin._python_plugin_test.SimpleStubsPluginTest
2024-09-11 16:39:35,208 PASSED: py38.native.tests.protoc_plugin._python_plugin_test.SimpleStubsPluginTest [time=1.7sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:35,209 START: py38.native.tests.protoc_plugin._split_definitions_test.SplitProtoProtoBeforeGrpcProtocStyleTest
2024-09-11 16:39:35,267 PASSED: py38.asyncio.tests_aio.unit.call_test.TestStreamStreamCall [time=3.9sec, retries=0:0; cpu_cost=0.4; estimated=1.0]
2024-09-11 16:39:35,267 START: py38.native.tests.reflection._reflection_client_test.ReflectionClientTest
2024-09-11 16:39:35,918 PASSED: py38.native.tests.health_check._health_servicer_test.HealthServicerTest [time=6.4sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:35,919 START: py38.native.tests.unit._local_credentials_test.LocalCredentialsTest
2024-09-11 16:39:36,897 PASSED: py38.native.tests.protoc_plugin._split_definitions_test.SplitProtoProtoBeforeGrpcProtocStyleTest [time=1.7sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:36,898 START: py38.native.tests.unit._channel_args_test.ChannelArgsTest
2024-09-11 16:39:37,123 PASSED: py38.native.tests.reflection._reflection_client_test.ReflectionClientTest [time=1.9sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:37,124 START: py38.native.tests.unit._contextvars_propagation_test.ContextVarsPropagationTest
2024-09-11 16:39:37,661 PASSED: py38.native.tests.unit._local_credentials_test.LocalCredentialsTest [time=1.7sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:37,662 START: py38.native.tests.unit.beta._implementations_test.CallCredentialsTest
2024-09-11 16:39:38,555 PASSED: py38.native.tests.unit._channel_args_test.ChannelArgsTest [time=1.7sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:38,558 START: py38.native.tests.unit._server_ssl_cert_config_test.ServerSSLCertReloadTestCertConfigReuse
2024-09-11 16:39:39,981 PASSED: py38.native.tests.unit.beta._implementations_test.CallCredentialsTest [time=2.3sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:39:39,982 START: py38.asyncio.tests_aio.unit.channel_argument_test.TestChannelArgument
2024-09-11 16:39:40,254 PASSED: py38.native.tests.unit._contextvars_propagation_test.ContextVarsPropagationTest [time=3.1sec, retries=0:0; cpu_cost=1.1; estimated=1.0]
2024-09-11 16:39:40,254 START: py38.asyncio.tests_aio.interop.local_interop_test.SecureLocalInteropTest
2024-09-11 16:39:41,435 PASSED: py38.native.tests.unit._server_ssl_cert_config_test.ServerSSLCertReloadTestCertConfigReuse [time=2.9sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:39:41,436 START: py38.native.tests.unit._invocation_defects_test.InvocationDefectsTest
2024-09-11 16:39:41,518 PASSED: py38.asyncio.tests_aio.unit.channel_argument_test.TestChannelArgument [time=1.5sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:41,519 START: py38.native.tests.unit._version_test.VersionTest
2024-09-11 16:39:43,165 PASSED: py38.native.tests.unit._version_test.VersionTest [time=1.6sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:43,179 START: py38.asyncio.tests_aio.unit.auth_context_test.TestAuthContext
2024-09-11 16:39:43,580 PASSED: py38.native.tests.unit._invocation_defects_test.InvocationDefectsTest [time=2.1sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:43,586 START: py38.native.tests.unit._channel_close_test.ChannelCloseTest
2024-09-11 16:39:43,857 PASSED: py38.asyncio.tests_aio.interop.local_interop_test.SecureLocalInteropTest [time=3.6sec, retries=0:0; cpu_cost=0.6; estimated=1.0]
2024-09-11 16:39:43,858 START: py38.asyncio.tests_aio.unit.connectivity_test.TestConnectivityState
2024-09-11 16:39:44,952 PASSED: py38.asyncio.tests_aio.unit.auth_context_test.TestAuthContext [time=1.8sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:39:44,953 START: py38.native.tests.health_check._health_servicer_test.HealthServicerBackwardsCompatibleWatchTest
2024-09-11 16:39:46,361 PASSED: py38.native.tests.unit._cython._no_messages_single_server_completion_queue_test.Test [time=16.6sec, retries=0:0; cpu_cost=1.1; estimated=1.0]
2024-09-11 16:39:46,362 START: py38.native.tests.unit._credentials_test.CredentialsTest
2024-09-11 16:39:47,547 PASSED: py38.native.tests.unit._credentials_test.CredentialsTest [time=1.2sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:47,548 START: py38.asyncio.tests_aio.unit.client_stream_stream_interceptor_test.TestStreamStreamClientInterceptor
2024-09-11 16:39:49,099 PASSED: py38.asyncio.tests_aio.unit.connectivity_test.TestConnectivityState [time=5.2sec, retries=0:0; cpu_cost=0.2; estimated=1.0]
2024-09-11 16:39:49,100 START: py38.native.tests.observability._observability_plugin_test.ObservabilityPluginTest
2024-09-11 16:39:49,151 PASSED: py38.asyncio.tests_aio.unit.client_stream_stream_interceptor_test.TestStreamStreamClientInterceptor [time=1.6sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:49,156 START: py38.asyncio.tests_aio.interop.local_interop_test.InsecureLocalInteropTest
2024-09-11 16:39:50,696 PASSED: py38.native.tests.observability._observability_plugin_test.ObservabilityPluginTest [time=1.6sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:50,697 START: py38.native.tests.csds.csds_test.TestCsds
2024-09-11 16:39:50,751 PASSED: py38.native.tests.health_check._health_servicer_test.HealthServicerBackwardsCompatibleWatchTest [time=5.8sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:50,751 START: py38.native.tests.unit._rpc_part_1_test.RPCPart1Test
2024-09-11 16:39:52,284 PASSED: py38.asyncio.tests_aio.interop.local_interop_test.InsecureLocalInteropTest [time=3.1sec, retries=0:0; cpu_cost=0.6; estimated=1.0]
2024-09-11 16:39:52,286 START: py38.native.tests.unit._server_test.ServerTest
2024-09-11 16:39:53,704 PASSED: py38.native.tests.unit._server_test.ServerTest [time=1.4sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:53,704 START: py38.native.tests.unit._xds_credentials_test.XdsCredentialsTest
2024-09-11 16:39:53,853 PASSED: py38.native.tests.csds.csds_test.TestCsds [time=3.2sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:53,857 START: py38.native.tests.reflection._reflection_servicer_test.ReflectionServicerTest
2024-09-11 16:39:55,304 PASSED: py38.native.tests.unit._channel_close_test.ChannelCloseTest [time=11.7sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:55,304 START: py38.native.tests.unit._rpc_part_2_test.RPCPart2Test
2024-09-11 16:39:55,469 PASSED: py38.native.tests.unit._xds_credentials_test.XdsCredentialsTest [time=1.8sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:55,470 START: py38.asyncio.tests_aio.unit.init_test.TestInit
2024-09-11 16:39:55,590 PASSED: py38.native.tests.reflection._reflection_servicer_test.ReflectionServicerTest [time=1.7sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:55,594 START: py38.native.tests.protoc_plugin._python_plugin_test.ModuleMainTest
2024-09-11 16:39:56,667 PASSED: py38.asyncio.tests_aio.unit.init_test.TestInit [time=1.2sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:56,669 START: py38.asyncio.tests_aio.unit.wait_for_ready_test.TestWaitForReady
2024-09-11 16:39:57,630 PASSED: py38.native.tests.protoc_plugin._python_plugin_test.ModuleMainTest [time=2.0sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:39:57,630 START: py38.native.tests.interop._secure_intraop_test.SecureIntraopTest
2024-09-11 16:39:59,590 PASSED: py38.native.tests.interop._secure_intraop_test.SecureIntraopTest [time=2.0sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:39:59,591 START: py38.asyncio.tests_aio.unit._metadata_test.TestMetadataWithServer
2024-09-11 16:40:01,251 PASSED: py38.asyncio.tests_aio.unit._metadata_test.TestMetadataWithServer [time=1.7sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:40:01,256 START: py38.native.tests.observability._observability_api_test.AllTest
2024-09-11 16:40:01,841 PASSED: py38.asyncio.tests_aio.unit.wait_for_ready_test.TestWaitForReady [time=5.2sec, retries=0:0; cpu_cost=0.3; estimated=1.0]
2024-09-11 16:40:01,841 START: py38.native.tests.unit._auth_test.GoogleCallCredentialsTest
2024-09-11 16:40:03,493 PASSED: py38.native.tests.observability._observability_api_test.AllTest [time=2.2sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:40:03,493 START: py38.native.tests.admin.admin_test.TestAdmin
2024-09-11 16:40:04,089 PASSED: py38.native.tests.unit._auth_test.GoogleCallCredentialsTest [time=2.2sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:40:04,090 START: py38.native.tests.unit._metadata_test.MetadataTest
2024-09-11 16:40:05,815 PASSED: py38.native.tests.admin.admin_test.TestAdmin [time=2.3sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:40:05,816 START: py38.native.tests.unit._channel_ready_future_test.ChannelReadyFutureTest
2024-09-11 16:40:06,595 PASSED: py38.native.tests.unit._metadata_test.MetadataTest [time=2.5sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:06,595 START: py38.asyncio.tests_aio.unit.client_unary_unary_interceptor_test.TestUnaryUnaryClientInterceptor
2024-09-11 16:40:08,510 PASSED: py38.native.tests.unit._rpc_part_1_test.RPCPart1Test [time=17.8sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:40:08,515 START: py38.native.tests.unit._dynamic_stubs_test.DynamicStubTest
2024-09-11 16:40:09,346 PASSED: py38.asyncio.tests_aio.unit.client_unary_unary_interceptor_test.TestUnaryUnaryClientInterceptor [time=2.7sec, retries=0:0; cpu_cost=0.6; estimated=1.0]
2024-09-11 16:40:09,347 START: py38.asyncio.tests_aio.unit.server_test.TestServer
2024-09-11 16:40:10,346 PASSED: py38.native.tests.unit._dynamic_stubs_test.DynamicStubTest [time=1.8sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:10,348 START: py38.native.tests.unit._metadata_flags_test.MetadataFlagsTest
2024-09-11 16:40:11,674 PASSED: py38.native.tests.unit._channel_ready_future_test.ChannelReadyFutureTest [time=5.9sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:11,728 START: py38.native.tests.observability._csm_observability_plugin_test.MetadataExchangeTest
2024-09-11 16:40:13,524 PASSED: py38.native.tests.observability._csm_observability_plugin_test.MetadataExchangeTest [time=1.8sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:40:13,525 START: py38.asyncio.tests_aio.channelz.channelz_servicer_test.ChannelzServicerTest
2024-09-11 16:40:13,790 PASSED: py38.native.tests.unit._metadata_flags_test.MetadataFlagsTest [time=3.4sec, retries=0:0; cpu_cost=1.1; estimated=1.0]
2024-09-11 16:40:13,791 START: py38.asyncio.tests_aio.health_check.health_servicer_test.HealthServicerTest
2024-09-11 16:40:17,515 PASSED: py38.asyncio.tests_aio.channelz.channelz_servicer_test.ChannelzServicerTest [time=4.0sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:40:17,515 START: py38.native.tests.unit._cython._fork_test.ForkPosixTester
2024-09-11 16:40:19,386 PASSED: py38.native.tests.unit._cython._fork_test.ForkPosixTester [time=1.9sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:19,387 START: py38.native.tests.unit._session_cache_test.SSLSessionCacheTest
2024-09-11 16:40:20,561 PASSED: py38.native.tests.unit._session_cache_test.SSLSessionCacheTest [time=1.2sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:20,561 START: py38.asyncio.tests_aio.unit.abort_test.TestAbort
2024-09-11 16:40:21,289 PASSED: py38.asyncio.tests_aio.health_check.health_servicer_test.HealthServicerTest [time=7.5sec, retries=0:0; cpu_cost=0.4; estimated=1.0]
2024-09-11 16:40:21,289 START: py38.asyncio.tests_aio.unit.secure_call_test.TestUnaryUnarySecureCall
2024-09-11 16:40:22,231 PASSED: py38.asyncio.tests_aio.unit.server_test.TestServer [time=12.9sec, retries=0:0; cpu_cost=0.2; estimated=1.0]
2024-09-11 16:40:22,232 START: py38.native.tests.protoc_plugin._python_plugin_test.PythonPluginTest
2024-09-11 16:40:22,427 PASSED: py38.asyncio.tests_aio.unit.abort_test.TestAbort [time=1.9sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:40:22,428 START: py38.native.tests.unit._server_ssl_cert_config_test.ServerSSLCertConfigFetcherParamsChecks
2024-09-11 16:40:22,581 PASSED: py38.asyncio.tests_aio.unit.secure_call_test.TestUnaryUnarySecureCall [time=1.3sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:40:22,582 START: py38.native.tests.protoc_plugin._split_definitions_test.SplitProtoMid2016ProtocStyleTest
2024-09-11 16:40:22,667 PASSED: py38.native.tests.unit._rpc_part_2_test.RPCPart2Test [time=27.4sec, retries=0:0; cpu_cost=1.1; estimated=1.0]
2024-09-11 16:40:22,670 START: py38.native.tests.protoc_plugin._split_definitions_test.SameProtoSingleProtocExecutionProtocStyleTest
2024-09-11 16:40:24,322 PASSED: py38.native.tests.unit._server_ssl_cert_config_test.ServerSSLCertConfigFetcherParamsChecks [time=1.9sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:24,323 START: py38.asyncio.tests_aio.unit.wait_for_connection_test.TestWaitForConnection
2024-09-11 16:40:24,417 PASSED: py38.native.tests.protoc_plugin._split_definitions_test.SplitProtoMid2016ProtocStyleTest [time=1.8sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:24,417 START: py38.native.tests.csds.csds_test.TestCsdsStream
2024-09-11 16:40:24,432 PASSED: py38.native.tests.protoc_plugin._split_definitions_test.SameProtoSingleProtocExecutionProtocStyleTest [time=1.8sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:24,432 START: py38.asyncio.tests_aio.unit.client_unary_unary_interceptor_test.TestInterceptedUnaryUnaryCall
2024-09-11 16:40:26,337 PASSED: py38.asyncio.tests_aio.unit.wait_for_connection_test.TestWaitForConnection [time=2.0sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:40:26,338 START: py38.native.tests.unit._server_ssl_cert_config_test.ServerSSLCertReloadTestWithoutClientAuth
2024-09-11 16:40:26,471 PASSED: py38.asyncio.tests_aio.unit.client_unary_unary_interceptor_test.TestInterceptedUnaryUnaryCall [time=2.0sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:40:26,471 START: py38.native.tests.testing._server_test.FirstServiceServicerTest
2024-09-11 16:40:27,500 PASSED: py38.native.tests.csds.csds_test.TestCsdsStream [time=3.1sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:27,501 START: py38.native.tests.unit.beta._connectivity_channel_test.ConnectivityStatesTest
2024-09-11 16:40:28,762 PASSED: py38.native.tests.unit.beta._connectivity_channel_test.ConnectivityStatesTest [time=1.3sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:28,763 START: py38.native.tests.unit._server_ssl_cert_config_test.ServerSSLCertReloadTestWithClientAuth
2024-09-11 16:40:28,971 PASSED: py38.native.tests.testing._server_test.FirstServiceServicerTest [time=2.5sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:28,973 START: py38.native.tests.channelz._channelz_servicer_test.ChannelzServicerTest
2024-09-11 16:40:29,668 PASSED: py38.native.tests.unit._server_ssl_cert_config_test.ServerSSLCertReloadTestWithoutClientAuth [time=3.3sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:29,669 START: py38.asyncio.tests_aio.unit.compatibility_test.TestCompatibility
2024-09-11 16:40:31,896 PASSED: py38.native.tests.unit._server_ssl_cert_config_test.ServerSSLCertReloadTestWithClientAuth [time=3.1sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:31,897 START: py38.native.tests.unit._grpc_shutdown_test.GrpcShutdownTest
2024-09-11 16:40:32,591 PASSED: py38.asyncio.tests_aio.unit.compatibility_test.TestCompatibility [time=2.9sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:40:32,592 START: py38.asyncio.tests_aio.unit._metadata_test.TestTypeMetadata
2024-09-11 16:40:33,131 PASSED: py38.native.tests.channelz._channelz_servicer_test.ChannelzServicerTest [time=4.1sec, retries=0:0; cpu_cost=1.1; estimated=1.0]
2024-09-11 16:40:33,142 START: py38.native.tests.unit._api_test.ChannelTest
2024-09-11 16:40:34,215 PASSED: py38.asyncio.tests_aio.unit._metadata_test.TestTypeMetadata [time=1.6sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:34,215 START: py38.native.tests.unit._interceptor_test.InterceptorTest
2024-09-11 16:40:34,996 PASSED: py38.native.tests.unit._api_test.ChannelTest [time=1.8sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:35,000 START: py38.asyncio.tests_aio._sanity._sanity_test.AioSanityTest
2024-09-11 16:40:36,907 PASSED: py38.asyncio.tests_aio._sanity._sanity_test.AioSanityTest [time=1.9sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:40:36,907 START: py38.asyncio.tests_aio.unit.call_test.TestUnaryUnaryCall
2024-09-11 16:40:39,323 PASSED: py38.native.tests.unit._interceptor_test.InterceptorTest [time=5.1sec, retries=0:0; cpu_cost=1.1; estimated=1.0]
2024-09-11 16:40:39,324 START: py38.native.tests.testing._time_test.StrictRealTimeTest
2024-09-11 16:40:39,702 PASSED: py38.asyncio.tests_aio.unit.call_test.TestUnaryUnaryCall [time=2.8sec, retries=0:0; cpu_cost=0.7; estimated=1.0]
2024-09-11 16:40:39,703 START: py38.asyncio.tests_aio.unit.outside_init_test.TestOutsideInit
2024-09-11 16:40:42,281 PASSED: py38.asyncio.tests_aio.unit.outside_init_test.TestOutsideInit [time=2.6sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:40:42,282 START: py38.asyncio.tests_aio.unit.channel_test.TestChannel
2024-09-11 16:40:43,948 PASSED: py38.native.tests.unit._grpc_shutdown_test.GrpcShutdownTest [time=12.0sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:40:43,949 START: py38.native.tests.unit._utilities_test.UtilityTest
2024-09-11 16:40:44,589 PASSED: py38.asyncio.tests_aio.unit.channel_test.TestChannel [time=2.3sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:40:44,590 START: py38.native.tests.unit._metadata_code_details_test.InspectContextTest
2024-09-11 16:40:45,723 PASSED: py38.native.tests.protoc_plugin._python_plugin_test.PythonPluginTest [time=23.5sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:40:45,724 START: py38.asyncio.tests_aio.status.grpc_status_test.StatusTest
2024-09-11 16:40:46,094 PASSED: py38.native.tests.unit._utilities_test.UtilityTest [time=2.1sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:46,095 START: py38.native.tests.unit._error_message_encoding_test.ErrorMessageEncodingTest
2024-09-11 16:40:46,872 PASSED: py38.native.tests.unit._metadata_code_details_test.InspectContextTest [time=2.3sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:40:46,873 START: py38.asyncio.tests_aio.unit.metadata_test.TestMetadata
2024-09-11 16:40:47,515 PASSED: py38.asyncio.tests_aio.status.grpc_status_test.StatusTest [time=1.8sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:40:47,517 START: py38.native.tests.unit.framework.foundation._logging_pool_test.LoggingPoolTest
2024-09-11 16:40:48,061 PASSED: py38.native.tests.unit._error_message_encoding_test.ErrorMessageEncodingTest [time=2.0sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:48,061 START: py38.native.tests.unit._server_test.ServerHandlerTest
2024-09-11 16:40:49,009 PASSED: py38.asyncio.tests_aio.unit.metadata_test.TestMetadata [time=2.1sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:40:49,010 START: py38.native.tests.protoc_plugin._split_definitions_test.SameProtoGrpcBeforeProtoProtocStyleTest
2024-09-11 16:40:49,186 PASSED: py38.native.tests.unit.framework.foundation._logging_pool_test.LoggingPoolTest [time=1.7sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:49,187 START: py38.asyncio.tests_aio.unit.compression_test.TestCompression
2024-09-11 16:40:50,868 PASSED: py38.native.tests.unit._server_test.ServerHandlerTest [time=2.8sec, retries=0:0; cpu_cost=1.1; estimated=1.0]
2024-09-11 16:40:50,873 START: py38.asyncio.tests_aio.unit.done_callback_test.TestServerSideDoneCallback
2024-09-11 16:40:51,597 PASSED: py38.native.tests.protoc_plugin._split_definitions_test.SameProtoGrpcBeforeProtoProtocStyleTest [time=2.6sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:40:51,598 START: py38.asyncio.tests_aio.unit.close_channel_test.TestCloseChannel
2024-09-11 16:40:51,893 PASSED: py38.asyncio.tests_aio.unit.compression_test.TestCompression [time=2.7sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:40:51,893 START: py38.native.tests.unit._cython._read_some_but_not_all_responses_test.ReadSomeButNotAllResponsesTest
2024-09-11 16:40:53,748 PASSED: py38.asyncio.tests_aio.unit.close_channel_test.TestCloseChannel [time=2.1sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:40:53,753 START: py38.native.tests.unit._api_test.ChannelConnectivityTest
2024-09-11 16:40:54,045 PASSED: py38.native.tests.unit._cython._read_some_but_not_all_responses_test.ReadSomeButNotAllResponsesTest [time=2.1sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:54,050 START: py38.native.tests.unit._cython._channel_test.ChannelTest
2024-09-11 16:40:55,336 PASSED: py38.native.tests.unit._api_test.ChannelConnectivityTest [time=1.6sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:55,337 START: py38.asyncio.tests_aio.unit.client_stream_unary_interceptor_test.TestStreamUnaryClientInterceptor
2024-09-11 16:40:56,669 PASSED: py38.native.tests.testing._time_test.StrictRealTimeTest [time=17.3sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:40:56,669 START: py38.native.tests.interop._insecure_intraop_test.InsecureIntraopTest
2024-09-11 16:40:58,650 PASSED: py38.asyncio.tests_aio.unit.client_stream_unary_interceptor_test.TestStreamUnaryClientInterceptor [time=3.3sec, retries=0:0; cpu_cost=0.8; estimated=1.0]
2024-09-11 16:40:58,651 START: py38.native.tests.unit.beta._not_found_test.NotFoundTest
2024-09-11 16:40:59,032 PASSED: py38.native.tests.interop._insecure_intraop_test.InsecureIntraopTest [time=2.4sec, retries=0:0; cpu_cost=1.1; estimated=1.0]
2024-09-11 16:40:59,033 START: py38.native.tests.unit._dns_resolver_test.DNSResolverTest
2024-09-11 16:41:00,770 PASSED: py38.native.tests.unit.beta._not_found_test.NotFoundTest [time=2.1sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:00,770 START: py38.native.tests.protoc_plugin._split_definitions_test.SameProtoMid2016ProtocStyleTest
2024-09-11 16:41:01,175 PASSED: py38.native.tests.unit._dns_resolver_test.DNSResolverTest [time=2.1sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:01,175 START: py38.native.tests.unit._metadata_code_details_test.MetadataCodeDetailsTest
2024-09-11 16:41:02,450 PASSED: py38.native.tests.protoc_plugin._split_definitions_test.SameProtoMid2016ProtocStyleTest [time=1.7sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:02,453 START: py38.native.tests.unit._cython.cygrpc_test.InsecureServerInsecureClient
2024-09-11 16:41:04,670 PASSED: py38.native.tests.unit._cython.cygrpc_test.InsecureServerInsecureClient [time=2.2sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:04,673 START: py38.native.tests.unit._resource_exhausted_test.ResourceExhaustedTest
2024-09-11 16:41:07,331 PASSED: py38.native.tests.unit._metadata_code_details_test.MetadataCodeDetailsTest [time=6.2sec, retries=0:0; cpu_cost=1.2; estimated=1.0]
2024-09-11 16:41:07,332 START: py38.native.tests.observability._csm_observability_plugin_test.CSMObservabilityPluginTest
2024-09-11 16:41:09,605 PASSED: py38.native.tests.observability._csm_observability_plugin_test.CSMObservabilityPluginTest [time=2.3sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:41:09,605 START: py38.native.tests.protoc_plugin._split_definitions_test.WellKnownTypesTest
2024-09-11 16:41:10,934 PASSED: py38.native.tests.unit._resource_exhausted_test.ResourceExhaustedTest [time=6.3sec, retries=0:0; cpu_cost=1.2; estimated=1.0]
2024-09-11 16:41:10,934 START: py38.asyncio.tests_aio.unit.server_interceptor_test.TestServerInterceptor
2024-09-11 16:41:11,456 PASSED: py38.native.tests.protoc_plugin._split_definitions_test.WellKnownTypesTest [time=1.8sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:11,457 START: py38.asyncio.tests_aio.unit.server_time_remaining_test.TestServerTimeRemaining
2024-09-11 16:41:12,282 PASSED: py38.asyncio.tests_aio.unit.server_interceptor_test.TestServerInterceptor [time=1.3sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:12,284 START: py38.native.tests.unit._auth_context_test.AuthContextTest
2024-09-11 16:41:13,004 PASSED: py38.asyncio.tests_aio.unit.server_time_remaining_test.TestServerTimeRemaining [time=1.5sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:41:13,005 START: py38.native.tests.unit.beta._implementations_test.ChannelCredentialsTest
2024-09-11 16:41:14,352 PASSED: py38.native.tests.unit._auth_context_test.AuthContextTest [time=2.1sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:14,353 START: py38.asyncio.tests_aio.unit.done_callback_test.TestClientSideDoneCallback
2024-09-11 16:41:14,864 PASSED: py38.native.tests.unit.beta._implementations_test.ChannelCredentialsTest [time=1.9sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:14,865 START: py38.native.tests._sanity._sanity_test.SanityTest
2024-09-11 16:41:16,412 PASSED: py38.asyncio.tests_aio.unit.done_callback_test.TestClientSideDoneCallback [time=2.1sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:41:16,414 START: py38.native.tests.unit._server_wait_for_termination_test.ServerWaitForTerminationTest
2024-09-11 16:41:17,380 PASSED: py38.native.tests._sanity._sanity_test.SanityTest [time=2.5sec, retries=0:0; cpu_cost=1.1; estimated=1.0]
2024-09-11 16:41:17,380 START: py38.native.tests.observability._open_telemetry_observability_test.OpenTelemetryObservabilityTest
2024-09-11 16:41:19,322 PASSED: py38.native.tests.observability._open_telemetry_observability_test.OpenTelemetryObservabilityTest [time=1.9sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:19,323 START: py38.native.tests.unit._cython._server_test.Test
2024-09-11 16:41:23,895 PASSED: py38.native.tests.unit._server_wait_for_termination_test.ServerWaitForTerminationTest [time=7.5sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:23,896 START: py38.native.tests.unit.beta._utilities_test.ChannelConnectivityTest
2024-09-11 16:41:25,552 PASSED: py38.native.tests.unit._cython._server_test.Test [time=6.2sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:25,553 START: py38.native.tests.unit._empty_message_test.EmptyMessageTest
2024-09-11 16:41:25,594 PASSED: py38.native.tests.unit.beta._utilities_test.ChannelConnectivityTest [time=1.7sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:25,594 START: py38.asyncio.tests_aio.unit.secure_call_test.TestUnaryStreamSecureCall
2024-09-11 16:41:27,336 PASSED: py38.asyncio.tests_aio.unit.secure_call_test.TestUnaryStreamSecureCall [time=1.7sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:41:27,337 START: py38.asyncio.tests_aio.unit.client_unary_stream_interceptor_test.TestUnaryStreamClientInterceptor
2024-09-11 16:41:28,051 PASSED: py38.native.tests.unit._empty_message_test.EmptyMessageTest [time=2.5sec, retries=0:0; cpu_cost=1.1; estimated=1.0]
2024-09-11 16:41:28,056 START: py38.native.tests.fork._fork_interop_test.ForkInteropTest
2024-09-11 16:41:29,679 PASSED: py38.asyncio.tests_aio.unit.client_unary_stream_interceptor_test.TestUnaryStreamClientInterceptor [time=2.3sec, retries=0:0; cpu_cost=0.9; estimated=1.0]
2024-09-11 16:41:29,680 START: py38.xds_protos
2024-09-11 16:41:30,045 PASSED: py38.native.tests.fork._fork_interop_test.ForkInteropTest [time=2.0sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:30,050 START: py38.native.tests.unit._logging_test.LoggingTest
2024-09-11 16:41:32,139 PASSED: py38.xds_protos [time=2.5sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:32,139 START: py38.native.tests.testing._time_test.StrictFakeTimeTest
2024-09-11 16:41:33,200 PASSED: py38.native.tests.unit._logging_test.LoggingTest [time=3.1sec, retries=0:0; cpu_cost=1.3; estimated=1.0]
2024-09-11 16:41:33,200 START: py38.asyncio.tests_aio.unit.aio_rpc_error_test.TestAioRpcError
2024-09-11 16:41:34,342 PASSED: py38.asyncio.tests_aio.unit.aio_rpc_error_test.TestAioRpcError [time=1.1sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:36,230 PASSED: py38.native.tests.unit._cython._channel_test.ChannelTest [time=42.2sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:41:37,155 PASSED: py38.native.tests.testing._time_test.StrictFakeTimeTest [time=5.0sec, retries=0:0; cpu_cost=1.0; estimated=1.0]
2024-09-11 16:48:57,385 ++ dirname /Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/tools/run_tests/helper_scripts/run_python.sh
+ cd /Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/tools/run_tests/helper_scripts/../../..
++ pwd
+ PYTHON=/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/bin/python
++ pwd
+ ROOT=/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native
+ /Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/bin/python /Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/src/python/grpcio_tests/setup.py test_aio
running test_aio
Running       tests_aio.unit.done_callback_test.TestServerSideDoneCallback.test_error_in_callback
WARNING: All log messages before absl::InitializeLog() is called are written to STDERR
W0000 00:00:1726098052.012137   65794 log.cc:112] Log level DEBUG is not suitable for production. Prefer WARNING or ERROR. However if you see this message in a debug environmenmt or test environmenmt it is safe to ignore this message.
/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/lib/python3.8/site-packages/google/protobuf/runtime_version.py:112: UserWarning: Protobuf gencode version 5.27.2 is older than the runtime version 5.28.1 at grpc_channelz/v1/channelz.proto. Please avoid checked-in Protobuf gencode that can be obsolete.
  warnings.warn(
/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/lib/python3.8/site-packages/google/protobuf/runtime_version.py:112: UserWarning: Protobuf gencode version 5.27.2 is older than the runtime version 5.28.1 at grpc_health/v1/health.proto. Please avoid checked-in Protobuf gencode that can be obsolete.
  warnings.warn(
/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/lib/python3.8/site-packages/google/protobuf/runtime_version.py:112: UserWarning: Protobuf gencode version 5.27.2 is older than the runtime version 5.28.1 at src/proto/grpc/testing/empty.proto. Please avoid checked-in Protobuf gencode that can be obsolete.
  warnings.warn(
/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/lib/python3.8/site-packages/google/protobuf/runtime_version.py:112: UserWarning: Protobuf gencode version 5.27.2 is older than the runtime version 5.28.1 at src/proto/grpc/testing/messages.proto. Please avoid checked-in Protobuf gencode that can be obsolete.
  warnings.warn(
/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/lib/python3.8/site-packages/google/protobuf/runtime_version.py:112: UserWarning: Protobuf gencode version 5.27.2 is older than the runtime version 5.28.1 at grpc_reflection/v1alpha/reflection.proto. Please avoid checked-in Protobuf gencode that can be obsolete.
  warnings.warn(
/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/lib/python3.8/site-packages/google/protobuf/runtime_version.py:112: UserWarning: Protobuf gencode version 5.27.2 is older than the runtime version 5.28.1 at src/proto/grpc/testing/proto2/empty2_extensions.proto. Please avoid checked-in Protobuf gencode that can be obsolete.
  warnings.warn(
/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/lib/python3.8/site-packages/google/protobuf/runtime_version.py:112: UserWarning: Protobuf gencode version 5.27.2 is older than the runtime version 5.28.1 at src/proto/grpc/testing/proto2/empty2.proto. Please avoid checked-in Protobuf gencode that can be obsolete.
  warnings.warn(
Error in callback for method [/test/Test]
Traceback (most recent call last):
  File "src/python/grpcio/grpc/_cython/_cygrpc/aio/server.pyx.pxi", line 748, in grpc._cython.cygrpc._add_callback_handler.handle_callbacks
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/src/python/grpcio_tests/tests_aio/unit/done_callback_test.py", line 258, in exception_raiser
    raise RuntimeError("A test RuntimeError")
RuntimeError: A test RuntimeError
_GatheringFuture exception was never retrieved
future: <_GatheringFuture finished exception=CancelledError() created at /Library/Frameworks/Python.framework/Versions/3.8/lib/python3.8/asyncio/tasks.py:709>
source_traceback: Object created at (most recent call last):
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/src/python/grpcio_tests/setup.py", line 104, in <module>
    setuptools.setup(
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/lib/python3.8/site-packages/setuptools/__init__.py", line 103, in setup
    return distutils.core.setup(**attrs)
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/lib/python3.8/site-packages/setuptools/_distutils/core.py", line 184, in setup
    return run_commands(dist)
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/lib/python3.8/site-packages/setuptools/_distutils/core.py", line 200, in run_commands
    dist.run_commands()
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/lib/python3.8/site-packages/setuptools/_distutils/dist.py", line 969, in run_commands
    self.run_command(cmd)
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/lib/python3.8/site-packages/setuptools/dist.py", line 976, in run_command
    super().run_command(command)
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/py38/lib/python3.8/site-packages/setuptools/_distutils/dist.py", line 988, in run_command
    cmd_obj.run()
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/src/python/grpcio_tests/commands.py", line 150, in run
    result = runner.run(loader.suite)
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/src/python/grpcio_tests/tests/_runner.py", line 241, in run
    augmented_case.case.run(result)
  File "/Library/Frameworks/Python.framework/Versions/3.8/lib/python3.8/unittest/case.py", line 676, in run
    self._callTestMethod(testMethod)
  File "/Library/Frameworks/Python.framework/Versions/3.8/lib/python3.8/unittest/case.py", line 633, in _callTestMethod
    method()
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/src/python/grpcio_tests/tests_aio/unit/_test_base.py", line 31, in wrapper
    return loop.run_until_complete(f(*args, **kwargs))
  File "/Library/Frameworks/Python.framework/Versions/3.8/lib/python3.8/asyncio/base_events.py", line 603, in run_until_complete
    self.run_forever()
  File "/Library/Frameworks/Python.framework/Versions/3.8/lib/python3.8/asyncio/base_events.py", line 570, in run_forever
    self._run_once()
  File "/Library/Frameworks/Python.framework/Versions/3.8/lib/python3.8/asyncio/base_events.py", line 1851, in _run_once
    handle._run()
  File "/Library/Frameworks/Python.framework/Versions/3.8/lib/python3.8/asyncio/events.py", line 81, in _run
    self._context.run(self._callback, *self._args)
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/src/python/grpcio_tests/tests_aio/unit/done_callback_test.py", line 274, in test_error_in_callback
    await validation
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/src/python/grpcio_tests/tests_aio/unit/_common.py", line 72, in validation
    asyncio.gather(
  File "/Library/Frameworks/Python.framework/Versions/3.8/lib/python3.8/asyncio/tasks.py", line 844, in gather
    outer = _GatheringFuture(children, loop=loop)
  File "/Library/Frameworks/Python.framework/Versions/3.8/lib/python3.8/asyncio/tasks.py", line 709, in __init__
    super().__init__(loop=loop)
asyncio.exceptions.CancelledError
Running       tests_aio.unit.done_callback_test.TestServerSideDoneCallback.test_error_in_handler
Unexpected [RuntimeError] raised by servicer method [/test/Test]
Traceback (most recent call last):
  File "src/python/grpcio/grpc/_cython/_cygrpc/aio/server.pyx.pxi", line 689, in grpc._cython.cygrpc._handle_exceptions
  File "src/python/grpcio/grpc/_cython/_cygrpc/aio/server.pyx.pxi", line 831, in _handle_rpc
  File "src/python/grpcio/grpc/_cython/_cygrpc/aio/server.pyx.pxi", line 554, in _handle_unary_unary_rpc
  File "src/python/grpcio/grpc/_cython/_cygrpc/aio/server.pyx.pxi", line 408, in _finish_handler_with_unary_response
  File "/Volumes/BuildData/tmpfs/altsrc/github/grpc/workspace_python_macos_opt_native/src/python/grpcio_tests/tests_aio/unit/done_callback_test.py", line 237, in test_handler
    raise RuntimeError("A test RuntimeError")
RuntimeError: A test RuntimeError
Running       tests_aio.unit.done_callback_test.TestServerSideDoneCallback.test_stream_stream
Running       tests_aio.unit.done_callback_test.TestServerSideDoneCallback.test_stream_unary
Running       tests_aio.unit.done_callback_test.TestServerSideDoneCallback.test_unary_stream
Running       tests_aio.unit.done_callback_test.TestServerSideDoneCallback.test_unary_unary
[95mTesting gRPC Python...
[0m[92mSUCCESS       tests_aio.unit.done_callback_test.TestServerSideDoneCallback.test_error_in_callback
[0m[92mSUCCESS       tests_aio.unit.done_callback_test.TestServerSideDoneCallback.test_error_in_handler
[0m[92mSUCCESS       tests_aio.unit.done_callback_test.TestServerSideDoneCallback.test_stream_stream
[0m[92mSUCCESS       tests_aio.unit.done_callback_test.TestServerSideDoneCallback.test_stream_unary
[0m[92mSUCCESS       tests_aio.unit.done_callback_test.TestServerSideDoneCallback.test_unary_stream
[0m[92mSUCCESS       tests_aio.unit.done_callback_test.TestServerSideDoneCallback.test_unary_unary
[0m6 tests finished:
	6 successful
	0 unsuccessful
	0 skipped
	0 expected failures
	0 unexpected successes
Interrupted Tests:
	[]

Errors/Failures: 

Unexpected successes: []

2024-09-11 16:48:57,385 TIMEOUT: py38.asyncio.tests_aio.unit.done_callback_test.TestServerSideDoneCallback [pid=11128, time=486.5sec]
2024-09-11 16:48:57,385 FAILED: py38.asyncio.tests_aio.unit.done_callback_test.TestServerSideDoneCallback
2024-09-11 16:48:57,409 Attempting refresh to obtain initial access_token
2024-09-11 16:48:57,417 Refreshing access_token
2024-09-11 16:48:59,213 FAILED: Some tests failed
Warning: Table aggregate_results already exists

=== run_tests.py DEBUG INFO ===
command: "workspace_python_macos_opt_native/tools/run_tests/run_tests.py -t -j 4 -x run_tests/python_macos_opt_native/sponge_log.xml --report_suite_name python_macos_opt_native -l python -c opt --iomgr_platform native --bq_result_table aggregate_results --measure_cpu_costs --report_multi_target"
kokoro job name: grpc/core/master/macos/grpc_basictests_python
===============================