See
<https://builds.apache.org/job/beam_PostCommit_Python_Verify/1509/display/redirect>
------------------------------------------
[...truncated 453.30 KB...]
"label": "Transform Function",
"namespace": "apache_beam.transforms.core.CallableWrapperDoFn",
"type": "STRING",
"value": "<lambda>"
},
{
"key": "fn",
"label": "Transform Function",
"namespace": "apache_beam.transforms.core.ParDo",
"shortValue": "CallableWrapperDoFn",
"type": "STRING",
"value": "apache_beam.transforms.core.CallableWrapperDoFn"
}
],
"non_parallel_inputs": {},
"output_info": [
{
"encoding": {
"@type": "kind:windowed_value",
"component_encodings": [
{
"@type":
"FastPrimitivesCoder$eNprYEpOLEhMzkiNT0pNzNVLzk9JLSqGUlxuicUlAUWZuZklmWWpxc4gQa5CBs3GQsbaQqZQ/vi0xJycpMTk7Hiw+kJmPEYFZCZn56RCjWABGsFaW8iWVJykBwDlGS3/",
"component_encodings": [
{
"@type":
"FastPrimitivesCoder$eNprYEpOLEhMzkiNT0pNzNVLzk9JLSqGUlxuicUlAUWZuZklmWWpxc4gQa5CBs3GQsbaQqZQ/vi0xJycpMTk7Hiw+kJmPEYFZCZn56RCjWABGsFaW8iWVJykBwDlGS3/",
"component_encodings": []
},
{
"@type":
"FastPrimitivesCoder$eNprYEpOLEhMzkiNT0pNzNVLzk9JLSqGUlxuicUlAUWZuZklmWWpxc4gQa5CBs3GQsbaQqZQ/vi0xJycpMTk7Hiw+kJmPEYFZCZn56RCjWABGsFaW8iWVJykBwDlGS3/",
"component_encodings": []
}
],
"is_pair_like": true
},
{
"@type": "kind:global_window"
}
],
"is_wrapper": true
},
"output_name": "out",
"user_name": "write/Write/WriteImpl/Extract.out"
}
],
"parallel_input": {
"@type": "OutputReference",
"output_name": "out",
"step_name": "s13"
},
"serialized_fn": "<string of 744 bytes>",
"user_name": "write/Write/WriteImpl/Extract"
}
},
{
"kind": "CollectionToSingleton",
"name": "s15",
"properties": {
"display_data": [],
"output_info": [
{
"encoding": {
"@type": "kind:windowed_value",
"component_encodings": [
{
"@type": "kind:windowed_value",
"component_encodings": [
{
"@type":
"FastPrimitivesCoder$eNprYEpOLEhMzkiNT0pNzNVLzk9JLSqGUlxuicUlAUWZuZklmWWpxc4gQa5CBs3GQsbaQqZQ/vi0xJycpMTk7Hiw+kJmPEYFZCZn56RCjWABGsFaW8iWVJykBwDlGS3/",
"component_encodings": [
{
"@type":
"FastPrimitivesCoder$eNprYEpOLEhMzkiNT0pNzNVLzk9JLSqGUlxuicUlAUWZuZklmWWpxc4gQa5CBs3GQsbaQqZQ/vi0xJycpMTk7Hiw+kJmPEYFZCZn56RCjWABGsFaW8iWVJykBwDlGS3/",
"component_encodings": []
},
{
"@type":
"FastPrimitivesCoder$eNprYEpOLEhMzkiNT0pNzNVLzk9JLSqGUlxuicUlAUWZuZklmWWpxc4gQa5CBs3GQsbaQqZQ/vi0xJycpMTk7Hiw+kJmPEYFZCZn56RCjWABGsFaW8iWVJykBwDlGS3/",
"component_encodings": []
}
],
"is_pair_like": true
},
{
"@type": "kind:global_window"
}
],
"is_wrapper": true
}
]
},
"output_name": "out",
"user_name":
"write/Write/WriteImpl/ViewAsIterable(write|Write|WriteImpl|Extract.None)/CreatePCollectionView.out"
}
],
"parallel_input": {
"@type": "OutputReference",
"output_name": "out",
"step_name": "s14"
},
"user_name":
"write/Write/WriteImpl/ViewAsIterable(write|Write|WriteImpl|Extract.None)/CreatePCollectionView"
}
},
{
"kind": "ParallelDo",
"name": "s16",
"properties": {
"display_data": [
{
"key": "fn",
"label": "Transform Function",
"namespace": "apache_beam.transforms.core.CallableWrapperDoFn",
"type": "STRING",
"value": "_finalize_write"
},
{
"key": "fn",
"label": "Transform Function",
"namespace": "apache_beam.transforms.core.ParDo",
"shortValue": "CallableWrapperDoFn",
"type": "STRING",
"value": "apache_beam.transforms.core.CallableWrapperDoFn"
}
],
"non_parallel_inputs": {
"s15": {
"@type": "OutputReference",
"output_name": "out",
"step_name": "s15"
},
"s9": {
"@type": "OutputReference",
"output_name": "out",
"step_name": "s9"
}
},
"output_info": [
{
"encoding": {
"@type": "kind:windowed_value",
"component_encodings": [
{
"@type":
"FastPrimitivesCoder$eNprYEpOLEhMzkiNT0pNzNVLzk9JLSqGUlxuicUlAUWZuZklmWWpxc4gQa5CBs3GQsbaQqZQ/vi0xJycpMTk7Hiw+kJmPEYFZCZn56RCjWABGsFaW8iWVJykBwDlGS3/",
"component_encodings": [
{
"@type":
"FastPrimitivesCoder$eNprYEpOLEhMzkiNT0pNzNVLzk9JLSqGUlxuicUlAUWZuZklmWWpxc4gQa5CBs3GQsbaQqZQ/vi0xJycpMTk7Hiw+kJmPEYFZCZn56RCjWABGsFaW8iWVJykBwDlGS3/",
"component_encodings": []
},
{
"@type":
"FastPrimitivesCoder$eNprYEpOLEhMzkiNT0pNzNVLzk9JLSqGUlxuicUlAUWZuZklmWWpxc4gQa5CBs3GQsbaQqZQ/vi0xJycpMTk7Hiw+kJmPEYFZCZn56RCjWABGsFaW8iWVJykBwDlGS3/",
"component_encodings": []
}
],
"is_pair_like": true
},
{
"@type": "kind:global_window"
}
],
"is_wrapper": true
},
"output_name": "out",
"user_name": "write/Write/WriteImpl/finalize_write.out"
}
],
"parallel_input": {
"@type": "OutputReference",
"output_name": "out",
"step_name": "s7"
},
"serialized_fn": "<string of 996 bytes>",
"user_name": "write/Write/WriteImpl/finalize_write"
}
}
],
"type": "JOB_TYPE_BATCH"
}
root: INFO: Create job: <Job
createTime: u'2017-03-15T02:15:08.860195Z'
currentStateTime: u'1970-01-01T00:00:00Z'
id: u'2017-03-14_19_15_08-14830685498213987975'
name: u'py-wordcount-1489539502'
projectId: u'apache-beam-testing'
steps: []
tempFiles: []
type: TypeValueValuesEnum(JOB_TYPE_BATCH, 1)>
root: INFO: Created job with id: [2017-03-14_19_15_08-14830685498213987975]
root: INFO: To access the Dataflow monitoring console, please navigate to
https://console.developers.google.com/project/apache-beam-testing/dataflow/job/2017-03-14_19_15_08-14830685498213987975
root: INFO: Job 2017-03-14_19_15_08-14830685498213987975 is in state
JOB_STATE_RUNNING
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf597a:
2017-03-15T02:15:08.410Z: JOB_MESSAGE_WARNING: (cdd12de26094f96b): Setting the
number of workers (1) disables autoscaling for this job. If you are trying to
cap autoscaling, consider only setting max_num_workers. If you want to disable
autoscaling altogether, the documented way is to explicitly use
autoscalingAlgorithm=NONE.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf5ec0:
2017-03-15T02:15:09.760Z: JOB_MESSAGE_DETAILED: (3a5c80e9af15669): Checking
required Cloud APIs are enabled.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf622d:
2017-03-15T02:15:10.637Z: JOB_MESSAGE_DEBUG: (3a5c80e9af155bb): Combiner
lifting skipped for step write/Write/WriteImpl/GroupByKey: GroupByKey not
followed by a combiner.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf622f:
2017-03-15T02:15:10.639Z: JOB_MESSAGE_DEBUG: (3a5c80e9af15265): Combiner
lifting skipped for step group: GroupByKey not followed by a combiner.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf6232:
2017-03-15T02:15:10.642Z: JOB_MESSAGE_DETAILED: (3a5c80e9af15f0f): Expanding
GroupByKey operations into optimizable parts.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf6235:
2017-03-15T02:15:10.645Z: JOB_MESSAGE_DETAILED: (3a5c80e9af15bb9): Lifting
ValueCombiningMappingFns into MergeBucketsMappingFns
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf623b:
2017-03-15T02:15:10.651Z: JOB_MESSAGE_DETAILED: (3a5c80e9af151b7): Annotating
graph with Autotuner information.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf6245:
2017-03-15T02:15:10.661Z: JOB_MESSAGE_DETAILED: (3a5c80e9af15160): Fusing
adjacent ParDo, Read, Write, and Flatten operations
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf6248:
2017-03-15T02:15:10.664Z: JOB_MESSAGE_DETAILED: (3a5c80e9af15e0a): Fusing
consumer split into read/Read
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf624a:
2017-03-15T02:15:10.666Z: JOB_MESSAGE_DETAILED: (3a5c80e9af15ab4): Fusing
consumer group/Reify into pair_with_one
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf624c:
2017-03-15T02:15:10.668Z: JOB_MESSAGE_DETAILED: (3a5c80e9af1575e): Fusing
consumer format into count
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf624e:
2017-03-15T02:15:10.670Z: JOB_MESSAGE_DETAILED: (3a5c80e9af15408): Fusing
consumer write/Write/WriteImpl/GroupByKey/GroupByWindow into
write/Write/WriteImpl/GroupByKey/Read
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf6250:
2017-03-15T02:15:10.672Z: JOB_MESSAGE_DETAILED: (3a5c80e9af150b2): Fusing
consumer write/Write/WriteImpl/GroupByKey/Write into
write/Write/WriteImpl/GroupByKey/Reify
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf6255:
2017-03-15T02:15:10.677Z: JOB_MESSAGE_DETAILED: (3a5c80e9af15a06): Fusing
consumer write/Write/WriteImpl/Extract into
write/Write/WriteImpl/GroupByKey/GroupByWindow
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf6257:
2017-03-15T02:15:10.679Z: JOB_MESSAGE_DETAILED: (3a5c80e9af156b0): Fusing
consumer count into group/GroupByWindow
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf6259:
2017-03-15T02:15:10.681Z: JOB_MESSAGE_DETAILED: (3a5c80e9af1535a): Fusing
consumer write/Write/WriteImpl/WindowInto(WindowIntoFn) into
write/Write/WriteImpl/Pair
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf625b:
2017-03-15T02:15:10.683Z: JOB_MESSAGE_DETAILED: (3a5c80e9af15004): Fusing
consumer write/Write/WriteImpl/GroupByKey/Reify into
write/Write/WriteImpl/WindowInto(WindowIntoFn)
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf625d:
2017-03-15T02:15:10.685Z: JOB_MESSAGE_DETAILED: (3a5c80e9af15cae): Fusing
consumer write/Write/WriteImpl/Pair into write/Write/WriteImpl/WriteBundles
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf625f:
2017-03-15T02:15:10.687Z: JOB_MESSAGE_DETAILED: (3a5c80e9af15958): Fusing
consumer pair_with_one into split
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf6262:
2017-03-15T02:15:10.690Z: JOB_MESSAGE_DETAILED: (3a5c80e9af15602): Fusing
consumer group/GroupByWindow into group/Read
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf6264:
2017-03-15T02:15:10.692Z: JOB_MESSAGE_DETAILED: (3a5c80e9af152ac): Fusing
consumer write/Write/WriteImpl/WriteBundles into format
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf6266:
2017-03-15T02:15:10.694Z: JOB_MESSAGE_DETAILED: (3a5c80e9af15f56): Fusing
consumer group/Write into group/Reify
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf62b4:
2017-03-15T02:15:10.772Z: JOB_MESSAGE_DEBUG: (3a5c80e9af15496): Workflow config
is missing a default resource spec.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf62b7:
2017-03-15T02:15:10.775Z: JOB_MESSAGE_DETAILED: (3a5c80e9af15140): Adding
StepResource setup and teardown to workflow graph.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf62b9:
2017-03-15T02:15:10.777Z: JOB_MESSAGE_DEBUG: (3a5c80e9af15dea): Adding workflow
start and stop steps.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf62bc:
2017-03-15T02:15:10.780Z: JOB_MESSAGE_DEBUG: (3a5c80e9af15a94): Assigning stage
ids.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf62df:
2017-03-15T02:15:10.815Z: JOB_MESSAGE_DEBUG: (4079fcc838ff349d): Executing wait
step start25
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf62e6:
2017-03-15T02:15:10.822Z: JOB_MESSAGE_BASIC: S01: (4079fcc838ff3603): Executing
operation group/Create
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf62e8:
2017-03-15T02:15:10.824Z: JOB_MESSAGE_DEBUG: (b74494551d26a9c7): Executing
operation write/Write/WriteImpl/DoOnce
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf62f2:
2017-03-15T02:15:10.834Z: JOB_MESSAGE_DEBUG: (b74494551d26a378): Value
"write/Write/WriteImpl/DoOnce.out" materialized.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf62fb:
2017-03-15T02:15:10.843Z: JOB_MESSAGE_BASIC: S04: (b74494551d26a7b0): Executing
operation write/Write/WriteImpl/InitializeWrite
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf63b2:
2017-03-15T02:15:11.026Z: JOB_MESSAGE_DEBUG: (7b5395c83800f5fc): Starting
worker pool setup.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf63b4:
2017-03-15T02:15:11.028Z: JOB_MESSAGE_BASIC: (7b5395c83800f1aa): Starting 1
workers...
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf63c0:
2017-03-15T02:15:11.040Z: JOB_MESSAGE_DEBUG: (4079fcc838ff301c): Value
"group/Session" materialized.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfbf63c8:
2017-03-15T02:15:11.048Z: JOB_MESSAGE_BASIC: S02: (4079fcc838ff3ca4): Executing
operation read/Read+split+pair_with_one+group/Reify+group/Write
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc04f19:
2017-03-15T02:16:11.289Z: JOB_MESSAGE_DETAILED: (aad9f80da636a35c): Workers
have started successfully.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc26e84:
2017-03-15T02:18:30.404Z: JOB_MESSAGE_DEBUG: (b74494551d26a74f): Value
"write/Write/WriteImpl/InitializeWrite.out" materialized.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc26e8f:
2017-03-15T02:18:30.415Z: JOB_MESSAGE_BASIC: S05: (b74494551d26a100): Executing
operation
write/Write/WriteImpl/ViewAsSingleton(write|Write|WriteImpl|InitializeWrite.None)/CreatePCollectionView
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc26ed6:
2017-03-15T02:18:30.486Z: JOB_MESSAGE_DEBUG: (b74494551d26a4cd): Value
"write/Write/WriteImpl/ViewAsSingleton(write|Write|WriteImpl|InitializeWrite.None)/CreatePCollectionView.out"
materialized.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc29119:
2017-03-15T02:18:39.257Z: JOB_MESSAGE_BASIC: S03: (4079fcc838ff3f70): Executing
operation group/Close
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc2912b:
2017-03-15T02:18:39.275Z: JOB_MESSAGE_BASIC: S06: (4079fcc838ff3989): Executing
operation write/Write/WriteImpl/GroupByKey/Create
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc291df:
2017-03-15T02:18:39.455Z: JOB_MESSAGE_DEBUG: (4079fcc838ff33a2): Value
"write/Write/WriteImpl/GroupByKey/Session" materialized.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc291e7:
2017-03-15T02:18:39.463Z: JOB_MESSAGE_BASIC: S07: (4079fcc838ff3299): Executing
operation
group/Read+group/GroupByWindow+count+format+write/Write/WriteImpl/WriteBundles+write/Write/WriteImpl/Pair+write/Write/WriteImpl/WindowInto(WindowIntoFn)+write/Write/WriteImpl/GroupByKey/Reify+write/Write/WriteImpl/GroupByKey/Write
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc2b7a8:
2017-03-15T02:18:49.128Z: JOB_MESSAGE_BASIC: S08: (4079fcc838ff3d0f): Executing
operation write/Write/WriteImpl/GroupByKey/Close
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc2b7c2:
2017-03-15T02:18:49.154Z: JOB_MESSAGE_BASIC: S09: (4079fcc838ff3997): Executing
operation
write/Write/WriteImpl/GroupByKey/Read+write/Write/WriteImpl/GroupByKey/GroupByWindow+write/Write/WriteImpl/Extract
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc2de82:
2017-03-15T02:18:59.074Z: JOB_MESSAGE_DEBUG: (4079fcc838ff3e26): Value
"write/Write/WriteImpl/Extract.out" materialized.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc2de89:
2017-03-15T02:18:59.081Z: JOB_MESSAGE_BASIC: S10: (4079fcc838ff3d1d): Executing
operation
write/Write/WriteImpl/ViewAsIterable(write|Write|WriteImpl|Extract.None)/CreatePCollectionView
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc2ded0:
2017-03-15T02:18:59.152Z: JOB_MESSAGE_DEBUG: (4079fcc838ff3258): Value
"write/Write/WriteImpl/ViewAsIterable(write|Write|WriteImpl|Extract.None)/CreatePCollectionView.out"
materialized.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc2ded8:
2017-03-15T02:18:59.160Z: JOB_MESSAGE_BASIC: S11: (4079fcc838ff314f): Executing
operation write/Write/WriteImpl/finalize_write
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc2ea57:
2017-03-15T02:19:02.103Z: JOB_MESSAGE_DEBUG: (4079fcc838ff3bc5): Executing
success step success23
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc2ea9c:
2017-03-15T02:19:02.172Z: JOB_MESSAGE_DETAILED: (3a5c80e9af1503b): Cleaning up.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc2eb14:
2017-03-15T02:19:02.292Z: JOB_MESSAGE_DEBUG: (3a5c80e9af15ce5): Starting worker
pool teardown.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc2eb16:
2017-03-15T02:19:02.294Z: JOB_MESSAGE_BASIC: (3a5c80e9af1598f): Stopping worker
pool...
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc3fc8d:
2017-03-15T02:20:12.301Z: JOB_MESSAGE_BASIC: (3a5c80e9af15c8e): Worker pool
stopped.
root: INFO: 2017-03-14_19_15_08-14830685498213987975_0000015acfc3fcaf:
2017-03-15T02:20:12.335Z: JOB_MESSAGE_DEBUG: (3a5c80e9af1528c): Tearing down
pending resources...
root: INFO: Job 2017-03-14_19_15_08-14830685498213987975 is in state
JOB_STATE_DONE
--------------------- >> end captured logging << ---------------------
----------------------------------------------------------------------
Ran 2 tests in 636.639s
FAILED (errors=1)
Build step 'Execute shell' marked build as failure