See http://qa.nuxeo.org/jenkins/view/Drive/job/FT-nuxeo-drive-master-linux/626/consoleFull
16:16:38 [INFO] [exec] ====================================================================== 16:16:38 [INFO] [exec] FAIL: test_versioning (nxdrive.tests.test_integration_remote_document_client.TestIntegrationRemoteDocumentClient) 16:16:38 [INFO] [exec] ---------------------------------------------------------------------- 16:16:38 [INFO] [exec] Traceback (most recent call last): 16:16:38 [INFO] [exec] File "/opt/jenkins/workspace/FT-nuxeo-drive-master-linux/nuxeo-drive-client/nxdrive/tests/test_integration_remote_document_client.py", line 407, in test_versioning 16:16:38 [INFO] [exec] "Twice updated content.") 16:16:38 [INFO] [exec] AssertionError: 'Updated content.' != 'Twice updated content.' 16:16:38 [INFO] [exec] -------------------- >> begin captured logging << -------------------- 16:16:38 [INFO] [exec] nxdrive.controller: INFO: nxdrive installed in '/opt/jenkins/workspace/FT-nuxeo-drive-master-linux/nuxeo-drive-client/nxdrive' 16:16:38 [INFO] [exec] nxdrive.controller: INFO: nxdrive configured in '/tmp/tmpuyNONZ-nxdrive-tests-user-1/nuxeo-drive-conf' 16:16:38 [INFO] [exec] alembic.migration: INFO: Context impl SQLiteImpl. 16:16:38 [INFO] [exec] alembic.migration: INFO: Will assume non-transactional DDL. 16:16:38 [INFO] [exec] nxdrive.migration: DEBUG: Checking if SQLite database migration is needed. 16:16:38 [INFO] [exec] nxdrive.migration: DEBUG: Head Alembic revision: 2f126b5f61a6 16:16:38 [INFO] [exec] nxdrive.migration: DEBUG: Alembic is not initialized, setting current revision to head revision: 2f126b5f61a6 16:16:38 [INFO] [exec] nxdrive.migration: DEBUG: Current Alembic revision: 2f126b5f61a6 16:16:38 [INFO] [exec] nxdrive.migration: DEBUG: No migration to process as current Alembic revision in SQLite database is already the head revision. 16:16:38 [INFO] [exec] nxdrive.model: DEBUG: Set client version to 1.3-dev 16:16:38 [INFO] [exec] nxdrive.controller: INFO: nxdrive installed in '/opt/jenkins/workspace/FT-nuxeo-drive-master-linux/nuxeo-drive-client/nxdrive' 16:16:38 [INFO] [exec] nxdrive.controller: INFO: nxdrive configured in '/tmp/tmpE3bbwR-nxdrive-tests-user-2/nuxeo-drive-conf' 16:16:38 [INFO] [exec] alembic.migration: INFO: Context impl SQLiteImpl. 16:16:38 [INFO] [exec] alembic.migration: INFO: Will assume non-transactional DDL. 16:16:38 [INFO] [exec] nxdrive.migration: DEBUG: Checking if SQLite database migration is needed. 16:16:38 [INFO] [exec] nxdrive.migration: DEBUG: Head Alembic revision: 2f126b5f61a6 16:16:38 [INFO] [exec] nxdrive.migration: DEBUG: Alembic is not initialized, setting current revision to head revision: 2f126b5f61a6 16:16:38 [INFO] [exec] nxdrive.migration: DEBUG: Current Alembic revision: 2f126b5f61a6 16:16:38 [INFO] [exec] nxdrive.migration: DEBUG: No migration to process as current Alembic revision in SQLite database is already the head revision. 16:16:38 [INFO] [exec] nxdrive.model: DEBUG: Set client version to 1.3-dev 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/ with headers {'X-Client-Version': '1.3-dev', 'X-Device-Id': u'nxdrive-test-administrator-device', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': 'Administrator', 'Cache-Control': 'no-cache', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic QWRtaW5pc3RyYXRvcjpBZG1pbmlzdHJhdG9y'} and cookies [] 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'value': u'/'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.Fetch with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-administrator-device', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': 'Administrator', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic QWRtaW5pc3RyYXRvcjpBZG1pbmlzdHJhdG9y'}, cookies [] and JSON payload '{"params": {"value": "/"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.Fetch' with cookies []: '{"entity-type":"document","repository":"default","uid":"36a70454-6bd8-47b8-b6ed-71b8b5aa024e","path":"/","type":"Root","state":null,"parentRef":"/","versionLabel":"","isCheckedOut":true,"title":"36a70454-6bd8-47b8-b6ed-71b8b5aa024e","properties":{"dc:creator":null,"dc:source":null,"dc:nature":null,"dc:contributors":[],"dc:created":null,"dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":null,"dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":null,"dc:lastContributor":null,"common:icon":null,"common:icon-expanded":null,"common:size":null},"facets":["Folderish","NotCollectionMember"],"changeToken":null,"contextParameters":{}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'userNames': 'user_1, user_2', 'permission': 'ReadWrite'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/NuxeoDrive.SetupIntegrationTests with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-administrator-device', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': 'Administrator', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic QWRtaW5pc3RyYXRvcjpBZG1pbmlzdHJhdG9y'}, cookies [] and JSON payload '{"params": {"userNames": "user_1, user_2", "permission": "ReadWrite"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/NuxeoDrive.SetupIntegrationTests' with cookies [] has content-type 'text/plain' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'value': u'/default-domain/workspaces/nuxeo-drive-test-workspace'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.Fetch with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-administrator-device', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': 'Administrator', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic QWRtaW5pc3RyYXRvcjpBZG1pbmlzdHJhdG9y'}, cookies [] and JSON payload '{"params": {"value": "/default-domain/workspaces/nuxeo-drive-test-workspace"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.Fetch' with cookies []: '{"entity-type":"document","repository":"default","uid":"87e9c894-ec66-4b1f-8d21-e292d691d023","path":"/default-domain/workspaces/nuxeo-drive-test-workspace","type":"Workspace","state":"project","parentRef":"5118834e-8ac1-4e4b-af06-62f016ae70ce","versionLabel":"","isCheckedOut":true,"title":"Nuxeo Drive Test Workspace","lastModified":"2014-12-10T15:03:44.09Z","properties":{"dc:creator":"Administrator","dc:source":null,"dc:nature":null,"dc:contributors":["Administrator"],"dc:created":"2014-12-10T15:03:44.09Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.09Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Nuxeo Drive Test Workspace","dc:lastContributor":"Administrator","files:files":[],"common:icon":"/icons/workspace.gif","common:icon-expanded":null,"common:size":null,"file:content":null,"file:filename":null,"webc:welcomeText":null,"webc:useCaptcha":null,"webc:welcomeMedia":null,"webc:theme":"sites","webc:isWebContainer":null,"webc:baseline":null,"webc:template":null,"webc:logo":null,"webc:themePerspective":null,"webc:themePage":"workspace","webc:name":null,"webc:moderationType":"aposteriori","webc:url":null,"webc:email":null,"publish:sections":[]},"facets":["SuperSpace","Folderish"],"changeToken":"1418223824097","contextParameters":{}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/ with headers {'X-Client-Version': '1.3-dev', 'X-Device-Id': u'nxdrive-test-device-1', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='} and cookies [] 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'value': u'87e9c894-ec66-4b1f-8d21-e292d691d023'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.Fetch with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"params": {"value": "87e9c894-ec66-4b1f-8d21-e292d691d023"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.Fetch' with cookies []: '{"entity-type":"document","repository":"default","uid":"87e9c894-ec66-4b1f-8d21-e292d691d023","path":"/default-domain/workspaces/nuxeo-drive-test-workspace","type":"Workspace","state":"project","parentRef":"5118834e-8ac1-4e4b-af06-62f016ae70ce","versionLabel":"","isCheckedOut":true,"title":"Nuxeo Drive Test Workspace","lastModified":"2014-12-10T15:03:44.09Z","properties":{"dc:creator":"Administrator","dc:source":null,"dc:nature":null,"dc:contributors":["Administrator"],"dc:created":"2014-12-10T15:03:44.09Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.09Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Nuxeo Drive Test Workspace","dc:lastContributor":"Administrator","files:files":[],"common:icon":"/icons/workspace.gif","common:icon-expanded":null,"common:size":null,"file:content":null,"file:filename":null,"webc:welcomeText":null,"webc:useCaptcha":null,"webc:welcomeMedia":null,"webc:theme":"sites","webc:isWebContainer":null,"webc:baseline":null,"webc:template":null,"webc:logo":null,"webc:themePerspective":null,"webc:themePage":"workspace","webc:name":null,"webc:moderationType":"aposteriori","webc:url":null,"webc:email":null,"publish:sections":[]},"facets":["SuperSpace","Folderish"],"changeToken":"1418223824097","contextParameters":{}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/ with headers {'X-Client-Version': '1.3-dev', 'X-Device-Id': u'nxdrive-test-device-2', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_2', 'Cache-Control': 'no-cache', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMjozNTEyMWU='} and cookies [] 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'value': u'87e9c894-ec66-4b1f-8d21-e292d691d023'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.Fetch with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-2', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_2', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMjozNTEyMWU='}, cookies [] and JSON payload '{"params": {"value": "87e9c894-ec66-4b1f-8d21-e292d691d023"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.Fetch' with cookies []: '{"entity-type":"document","repository":"default","uid":"87e9c894-ec66-4b1f-8d21-e292d691d023","path":"/default-domain/workspaces/nuxeo-drive-test-workspace","type":"Workspace","state":"project","parentRef":"5118834e-8ac1-4e4b-af06-62f016ae70ce","versionLabel":"","isCheckedOut":true,"title":"Nuxeo Drive Test Workspace","lastModified":"2014-12-10T15:03:44.09Z","properties":{"dc:creator":"Administrator","dc:source":null,"dc:nature":null,"dc:contributors":["Administrator"],"dc:created":"2014-12-10T15:03:44.09Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.09Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Nuxeo Drive Test Workspace","dc:lastContributor":"Administrator","files:files":[],"common:icon":"/icons/workspace.gif","common:icon-expanded":null,"common:size":null,"file:content":null,"file:filename":null,"webc:welcomeText":null,"webc:useCaptcha":null,"webc:welcomeMedia":null,"webc:theme":"sites","webc:isWebContainer":null,"webc:baseline":null,"webc:template":null,"webc:logo":null,"webc:themePerspective":null,"webc:themePage":"workspace","webc:name":null,"webc:moderationType":"aposteriori","webc:url":null,"webc:email":null,"publish:sections":[]},"facets":["SuperSpace","Folderish"],"changeToken":"1418223824097","contextParameters":{}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/ with headers {'X-Client-Version': '1.3-dev', 'X-Device-Id': u'nxdrive-test-device-1', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='} and cookies [] 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/ with headers {'X-Client-Version': '1.3-dev', 'X-Device-Id': u'nxdrive-test-device-2', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_2', 'Cache-Control': 'no-cache', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMjozNTEyMWU='} and cookies [] 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'input': u'doc:87e9c894-ec66-4b1f-8d21-e292d691d023', 'params': {'type': 'File', 'name': 'Document to version.txt', 'properties': 'dc:title=Document to version.txt'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.Create with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"input": "doc:87e9c894-ec66-4b1f-8d21-e292d691d023", "params": {"type": "File", "name": "Document to version.txt", "properties": "dc:title=Document to version.txt"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.Create' with cookies []: '{"entity-type":"document","repository":"default","uid":"a242e14b-b339-4902-9108-b570c027fa96","path":"/default-domain/workspaces/nuxeo-drive-test-workspace/Document to version.txt","type":"File","state":"project","parentRef":"87e9c894-ec66-4b1f-8d21-e292d691d023","versionLabel":"0.0","isCheckedOut":true,"title":"Document to version.txt","lastModified":"2014-12-10T15:03:44.30Z","properties":{"uid:uid":null,"uid:minor_version":0,"uid:major_version":0,"dc:creator":"nuxeoDriveTestUser_user_1","dc:source":null,"dc:nature":null,"dc:contributors":["nuxeoDriveTestUser_user_1"],"dc:created":"2014-12-10T15:03:44.30Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.30Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Document to version.txt","dc:lastContributor":"nuxeoDriveTestUser_user_1","files:files":[],"common:icon":"/icons/file.gif","common:icon-expanded":null,"common:size":null,"file:content":null,"file:filename":null,"relatedtext:relatedtextresources":[]},"facets":["Downloadable","Commentable","Versionable","Publishable","HasRelatedText"],"changeToken":"1418223824301","contextParameters":{}}' 16:16:38 [INFO] [exec] nxdrive.utils: TRACE: Guessed mime type 'text/plain' for 'Document to version.txt' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Using file system block size for the streaming upload buffer: 4096 bytes 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/batch/upload with headers {'Content-Length': 16, 'X-Client-Version': '1.3-dev', 'X-Device-Id': u'nxdrive-test-device-1', 'X-File-Type': 'text/plain', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'X-File-Size': 16, 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA=', 'Cache-Control': 'no-cache', 'X-Batch-Id': '1418223824.33_497479390', 'X-File-Idx': 0, 'Content-Type': 'application/octet-stream', 'X-Application-Name': 'Nuxeo Drive', 'X-File-Name': 'Document%20to%20version.txt'} and cookies [] for file /tmp/tmpwTPFjI-nxdrive-uploads/tmpFjsbSe-nxdrive-file-to-upload 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/batch/upload' with cookies []: '{"uploaded":"true","batchId":"1418223824.33_497479390"}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Using 300 seconds [max(300, 2 * upload time=0)] as Nuxeo transaction timeout for batch execution of Blob.Attach with file /tmp/tmpwTPFjI-nxdrive-uploads/tmpFjsbSe-nxdrive-file-to-upload 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'batchId': '1418223824.33_497479390', 'document': u'a242e14b-b339-4902-9108-b570c027fa96', 'fileIdx': '0', 'operationId': 'Blob.Attach'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/batch/execute with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'X-Application-Name': 'Nuxeo Drive', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'Nuxeo-Transaction-Timeout': 300, 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"params": {"batchId": "1418223824.33_497479390", "document": "a242e14b-b339-4902-9108-b570c027fa96", "fileIdx": "0", "operationId": "Blob.Attach"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/batch/execute' with cookies [] has content-type 'text/plain' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'input': u'doc:a242e14b-b339-4902-9108-b570c027fa96', 'params': {'increment': 'Major'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.CreateVersion with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"input": "doc:a242e14b-b339-4902-9108-b570c027fa96", "params": {"increment": "Major"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.CreateVersion' with cookies []: '{"entity-type":"document","repository":"default","uid":"a242e14b-b339-4902-9108-b570c027fa96","path":"/default-domain/workspaces/nuxeo-drive-test-workspace/Document to version.txt","type":"File","state":"project","parentRef":"87e9c894-ec66-4b1f-8d21-e292d691d023","versionLabel":"1.0","isCheckedOut":false,"title":"Document to version.txt","lastModified":"2014-12-10T15:03:44.37Z","properties":{"uid:uid":null,"uid:minor_version":0,"uid:major_version":1,"dc:creator":"nuxeoDriveTestUser_user_1","dc:source":null,"dc:nature":null,"dc:contributors":["nuxeoDriveTestUser_user_1"],"dc:created":"2014-12-10T15:03:44.30Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.37Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Document to version.txt","dc:lastContributor":"nuxeoDriveTestUser_user_1","files:files":[],"common:icon":"/icons/text.png","common:icon-expanded":null,"common:size":16,"file:content":{"name":"Document to version.txt","mime-type":"text/plain","encoding":null,"digest":"e8243f47118ab46922047814915ddb81","length":"16","data":"http://localhost:8080/nuxeo/nxbigfile/default/a242e14b-b339-4902-9108-b570c027fa96/file:content/Document%20to%20version.txt"},"file:filename":null,"relatedtext:relatedtextresources":[]},"facets":["Downloadable","Commentable","Versionable","Publishable","HasRelatedText"],"changeToken":"1418223824375","contextParameters":{}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'input': u'doc:a242e14b-b339-4902-9108-b570c027fa96', 'params': {}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.GetVersions with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"input": "doc:a242e14b-b339-4902-9108-b570c027fa96", "params": {}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.GetVersions' with cookies []: '{"entity-type":"documents","entries":[{"entity-type":"document","repository":"default","uid":"0d706103-a848-4caf-bdc6-0825fe9f1a43","path":"/default-domain/workspaces/nuxeo-drive-test-workspace/Document to version.txt","type":"File","state":"project","parentRef":"87e9c894-ec66-4b1f-8d21-e292d691d023","versionLabel":"1.0","isCheckedOut":false,"title":"Document to version.txt","lastModified":"2014-12-10T15:03:44.37Z","properties":{"uid:uid":null,"uid:minor_version":0,"uid:major_version":1,"dc:creator":"nuxeoDriveTestUser_user_1","dc:source":null,"dc:nature":null,"dc:contributors":["nuxeoDriveTestUser_user_1"],"dc:created":"2014-12-10T15:03:44.30Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.37Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Document to version.txt","dc:lastContributor":"nuxeoDriveTestUser_user_1","files:files":[],"thumb:thumbnail":null,"common:icon":"/icons/text.png","common:icon-expanded":null,"common:size":16,"file:content":{"name":"Document to version.txt","mime-type":"text/plain","encoding":null,"digest":"e8243f47118ab46922047814915ddb81","length":"16","data":"http://localhost:8080/nuxeo/nxbigfile/default/0d706103-a848-4caf-bdc6-0825fe9f1a43/file:content/Document%20to%20version.txt"},"file:filename":null,"relatedtext:relatedtextresources":[]},"facets":["Downloadable","Commentable","Immutable","Versionable","Publishable","HasRelatedText","Thumbnail"],"changeToken":"1418223824375","contextParameters":{}}]}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'query': u"SELECT * FROM Document WHERE ecm:uuid = '0d706103-a848-4caf-bdc6-0825fe9f1a43' AND ecm:currentLifeCycleState != 'deleted' LIMIT 1"}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.Query with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"params": {"query": "SELECT * FROM Document WHERE ecm:uuid = \'0d706103-a848-4caf-bdc6-0825fe9f1a43\' AND ecm:currentLifeCycleState != \'deleted\' LIMIT 1"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.Query' with cookies []: '{"entity-type":"documents","isPaginable":true,"resultsCount":1,"pageSize":0,"maxPageSize":1000,"currentPageSize":1,"currentPageIndex":0,"numberOfPages":1,"isPreviousPageAvailable":false,"isNextPageAvailable":false,"isLastPageAvailable":false,"isSortable":true,"hasError":false,"errorMessage":null,"totalSize":1,"pageIndex":0,"pageCount":1,"entries":[{"entity-type":"document","repository":"default","uid":"0d706103-a848-4caf-bdc6-0825fe9f1a43","path":"/default-domain/workspaces/nuxeo-drive-test-workspace/Document to version.txt","type":"File","state":"project","parentRef":"87e9c894-ec66-4b1f-8d21-e292d691d023","versionLabel":"1.0","isCheckedOut":false,"title":"Document to version.txt","lastModified":"2014-12-10T15:03:44.37Z","properties":{"uid:uid":null,"uid:minor_version":0,"uid:major_version":1,"dc:creator":"nuxeoDriveTestUser_user_1","dc:source":null,"dc:nature":null,"dc:contributors":["nuxeoDriveTestUser_user_1"],"dc:created":"2014-12-10T15:03:44.30Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.37Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Document to version.txt","dc:lastContributor":"nuxeoDriveTestUser_user_1","files:files":[],"thumb:thumbnail":null,"common:icon":"/icons/text.png","common:icon-expanded":null,"common:size":16,"file:content":{"name":"Document to version.txt","mime-type":"text/plain","encoding":null,"digest":"e8243f47118ab46922047814915ddb81","length":"16","data":"http://localhost:8080/nuxeo/nxbigfile/default/0d706103-a848-4caf-bdc6-0825fe9f1a43/file:content/Document%20to%20version.txt"},"file:filename":null,"relatedtext:relatedtextresources":[]},"facets":["Downloadable","Commentable","Immutable","Versionable","Publishable","HasRelatedText","Thumbnail"],"changeToken":"1418223824375","contextParameters":{"documentURL":"/nuxeo/nxdoc/default/0d706103-a848-4caf-bdc6-0825fe9f1a43/view_documents"}}]}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'value': u'0d706103-a848-4caf-bdc6-0825fe9f1a43'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.Fetch with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"params": {"value": "0d706103-a848-4caf-bdc6-0825fe9f1a43"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.Fetch' with cookies []: '{"entity-type":"document","repository":"default","uid":"0d706103-a848-4caf-bdc6-0825fe9f1a43","path":"/default-domain/workspaces/nuxeo-drive-test-workspace/Document to version.txt","type":"File","state":"project","parentRef":"87e9c894-ec66-4b1f-8d21-e292d691d023","versionLabel":"1.0","isCheckedOut":false,"title":"Document to version.txt","lastModified":"2014-12-10T15:03:44.37Z","properties":{"uid:uid":null,"uid:minor_version":0,"uid:major_version":1,"dc:creator":"nuxeoDriveTestUser_user_1","dc:source":null,"dc:nature":null,"dc:contributors":["nuxeoDriveTestUser_user_1"],"dc:created":"2014-12-10T15:03:44.30Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.37Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Document to version.txt","dc:lastContributor":"nuxeoDriveTestUser_user_1","files:files":[],"thumb:thumbnail":null,"common:icon":"/icons/text.png","common:icon-expanded":null,"common:size":16,"file:content":{"name":"Document to version.txt","mime-type":"text/plain","encoding":null,"digest":"e8243f47118ab46922047814915ddb81","length":"16","data":"http://localhost:8080/nuxeo/nxbigfile/default/0d706103-a848-4caf-bdc6-0825fe9f1a43/file:content/Document%20to%20version.txt"},"file:filename":null,"relatedtext:relatedtextresources":[]},"facets":["Downloadable","Commentable","Immutable","Versionable","Publishable","HasRelatedText","Thumbnail"],"changeToken":"1418223824375","contextParameters":{}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'value': u'/default-domain/workspaces/nuxeo-drive-test-workspace'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.Fetch with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"params": {"value": "/default-domain/workspaces/nuxeo-drive-test-workspace"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.Fetch' with cookies []: '{"entity-type":"document","repository":"default","uid":"87e9c894-ec66-4b1f-8d21-e292d691d023","path":"/default-domain/workspaces/nuxeo-drive-test-workspace","type":"Workspace","state":"project","parentRef":"5118834e-8ac1-4e4b-af06-62f016ae70ce","versionLabel":"","isCheckedOut":true,"title":"Nuxeo Drive Test Workspace","lastModified":"2014-12-10T15:03:44.09Z","properties":{"dc:creator":"Administrator","dc:source":null,"dc:nature":null,"dc:contributors":["Administrator"],"dc:created":"2014-12-10T15:03:44.09Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.09Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Nuxeo Drive Test Workspace","dc:lastContributor":"Administrator","files:files":[],"common:icon":"/icons/workspace.gif","common:icon-expanded":null,"common:size":null,"file:content":null,"file:filename":null,"webc:welcomeText":null,"webc:useCaptcha":null,"webc:welcomeMedia":null,"webc:theme":"sites","webc:isWebContainer":null,"webc:baseline":null,"webc:template":null,"webc:logo":null,"webc:themePerspective":null,"webc:themePage":"workspace","webc:name":null,"webc:moderationType":"aposteriori","webc:url":null,"webc:email":null,"publish:sections":[]},"facets":["SuperSpace","Folderish"],"changeToken":"1418223824097","contextParameters":{}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'input': u'doc:0d706103-a848-4caf-bdc6-0825fe9f1a43', 'params': {}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Blob.Get with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"input": "doc:0d706103-a848-4caf-bdc6-0825fe9f1a43", "params": {}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Blob.Get' with cookies [] has content-type 'text/plain' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'query': u"SELECT * FROM Document WHERE ecm:uuid = 'a242e14b-b339-4902-9108-b570c027fa96' AND ecm:currentLifeCycleState != 'deleted' AND ecm:isCheckedInVersion = 0 LIMIT 1"}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.Query with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"params": {"query": "SELECT * FROM Document WHERE ecm:uuid = \'a242e14b-b339-4902-9108-b570c027fa96\' AND ecm:currentLifeCycleState != \'deleted\' AND ecm:isCheckedInVersion = 0 LIMIT 1"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.Query' with cookies []: '{"entity-type":"documents","isPaginable":true,"resultsCount":1,"pageSize":0,"maxPageSize":1000,"currentPageSize":1,"currentPageIndex":0,"numberOfPages":1,"isPreviousPageAvailable":false,"isNextPageAvailable":false,"isLastPageAvailable":false,"isSortable":true,"hasError":false,"errorMessage":null,"totalSize":1,"pageIndex":0,"pageCount":1,"entries":[{"entity-type":"document","repository":"default","uid":"a242e14b-b339-4902-9108-b570c027fa96","path":"/default-domain/workspaces/nuxeo-drive-test-workspace/Document to version.txt","type":"File","state":"project","parentRef":"87e9c894-ec66-4b1f-8d21-e292d691d023","versionLabel":"1.0","isCheckedOut":false,"title":"Document to version.txt","lastModified":"2014-12-10T15:03:44.37Z","properties":{"uid:uid":null,"uid:minor_version":0,"uid:major_version":1,"dc:creator":"nuxeoDriveTestUser_user_1","dc:source":null,"dc:nature":null,"dc:contributors":["nuxeoDriveTestUser_user_1"],"dc:created":"2014-12-10T15:03:44.30Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.37Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Document to version.txt","dc:lastContributor":"nuxeoDriveTestUser_user_1","files:files":[],"thumb:thumbnail":null,"common:icon":"/icons/text.png","common:icon-expanded":null,"common:size":16,"file:content":{"name":"Document to version.txt","mime-type":"text/plain","encoding":null,"digest":"e8243f47118ab46922047814915ddb81","length":"16","data":"http://localhost:8080/nuxeo/nxbigfile/default/a242e14b-b339-4902-9108-b570c027fa96/file:content/Document%20to%20version.txt"},"file:filename":null,"relatedtext:relatedtextresources":[]},"facets":["Downloadable","Commentable","Versionable","Publishable","HasRelatedText","Thumbnail"],"changeToken":"1418223824375","contextParameters":{"documentURL":"/nuxeo/nxdoc/default/a242e14b-b339-4902-9108-b570c027fa96/view_documents"}}]}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'value': u'a242e14b-b339-4902-9108-b570c027fa96'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.Fetch with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"params": {"value": "a242e14b-b339-4902-9108-b570c027fa96"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.Fetch' with cookies []: '{"entity-type":"document","repository":"default","uid":"a242e14b-b339-4902-9108-b570c027fa96","path":"/default-domain/workspaces/nuxeo-drive-test-workspace/Document to version.txt","type":"File","state":"project","parentRef":"87e9c894-ec66-4b1f-8d21-e292d691d023","versionLabel":"1.0","isCheckedOut":false,"title":"Document to version.txt","lastModified":"2014-12-10T15:03:44.37Z","properties":{"uid:uid":null,"uid:minor_version":0,"uid:major_version":1,"dc:creator":"nuxeoDriveTestUser_user_1","dc:source":null,"dc:nature":null,"dc:contributors":["nuxeoDriveTestUser_user_1"],"dc:created":"2014-12-10T15:03:44.30Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.37Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Document to version.txt","dc:lastContributor":"nuxeoDriveTestUser_user_1","files:files":[],"thumb:thumbnail":null,"common:icon":"/icons/text.png","common:icon-expanded":null,"common:size":16,"file:content":{"name":"Document to version.txt","mime-type":"text/plain","encoding":null,"digest":"e8243f47118ab46922047814915ddb81","length":"16","data":"http://localhost:8080/nuxeo/nxbigfile/default/a242e14b-b339-4902-9108-b570c027fa96/file:content/Document%20to%20version.txt"},"file:filename":null,"relatedtext:relatedtextresources":[]},"facets":["Downloadable","Commentable","Versionable","Publishable","HasRelatedText","Thumbnail"],"changeToken":"1418223824375","contextParameters":{}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'value': u'/default-domain/workspaces/nuxeo-drive-test-workspace'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.Fetch with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"params": {"value": "/default-domain/workspaces/nuxeo-drive-test-workspace"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.Fetch' with cookies []: '{"entity-type":"document","repository":"default","uid":"87e9c894-ec66-4b1f-8d21-e292d691d023","path":"/default-domain/workspaces/nuxeo-drive-test-workspace","type":"Workspace","state":"project","parentRef":"5118834e-8ac1-4e4b-af06-62f016ae70ce","versionLabel":"","isCheckedOut":true,"title":"Nuxeo Drive Test Workspace","lastModified":"2014-12-10T15:03:44.09Z","properties":{"dc:creator":"Administrator","dc:source":null,"dc:nature":null,"dc:contributors":["Administrator"],"dc:created":"2014-12-10T15:03:44.09Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.09Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Nuxeo Drive Test Workspace","dc:lastContributor":"Administrator","files:files":[],"common:icon":"/icons/workspace.gif","common:icon-expanded":null,"common:size":null,"file:content":null,"file:filename":null,"webc:welcomeText":null,"webc:useCaptcha":null,"webc:welcomeMedia":null,"webc:theme":"sites","webc:isWebContainer":null,"webc:baseline":null,"webc:template":null,"webc:logo":null,"webc:themePerspective":null,"webc:themePage":"workspace","webc:name":null,"webc:moderationType":"aposteriori","webc:url":null,"webc:email":null,"publish:sections":[]},"facets":["SuperSpace","Folderish"],"changeToken":"1418223824097","contextParameters":{}}' 16:16:38 [INFO] [exec] nxdrive.utils: TRACE: Guessed mime type 'text/plain' for 'Document to version.txt' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Using file system block size for the streaming upload buffer: 4096 bytes 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/batch/upload with headers {'Content-Length': 16, 'X-Client-Version': '1.3-dev', 'X-Device-Id': u'nxdrive-test-device-1', 'X-File-Type': 'text/plain', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'X-File-Size': 16, 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA=', 'Cache-Control': 'no-cache', 'X-Batch-Id': '1418223824.58_40220929', 'X-File-Idx': 0, 'Content-Type': 'application/octet-stream', 'X-Application-Name': 'Nuxeo Drive', 'X-File-Name': 'Document%20to%20version.txt'} and cookies [] for file /tmp/tmpwTPFjI-nxdrive-uploads/tmpD_y5t9-nxdrive-file-to-upload 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/batch/upload' with cookies []: '{"uploaded":"true","batchId":"1418223824.58_40220929"}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Using 300 seconds [max(300, 2 * upload time=0)] as Nuxeo transaction timeout for batch execution of Blob.Attach with file /tmp/tmpwTPFjI-nxdrive-uploads/tmpD_y5t9-nxdrive-file-to-upload 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'batchId': '1418223824.58_40220929', 'document': u'a242e14b-b339-4902-9108-b570c027fa96', 'fileIdx': '0', 'operationId': 'Blob.Attach'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/batch/execute with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'X-Application-Name': 'Nuxeo Drive', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'Nuxeo-Transaction-Timeout': 300, 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"params": {"batchId": "1418223824.58_40220929", "document": "a242e14b-b339-4902-9108-b570c027fa96", "fileIdx": "0", "operationId": "Blob.Attach"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/batch/execute' with cookies [] has content-type 'text/plain' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'input': u'doc:a242e14b-b339-4902-9108-b570c027fa96', 'params': {'increment': 'Minor'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.CreateVersion with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"input": "doc:a242e14b-b339-4902-9108-b570c027fa96", "params": {"increment": "Minor"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.CreateVersion' with cookies []: '{"entity-type":"document","repository":"default","uid":"a242e14b-b339-4902-9108-b570c027fa96","path":"/default-domain/workspaces/nuxeo-drive-test-workspace/Document to version.txt","type":"File","state":"project","parentRef":"87e9c894-ec66-4b1f-8d21-e292d691d023","versionLabel":"1.1","isCheckedOut":false,"title":"Document to version.txt","lastModified":"2014-12-10T15:03:44.61Z","properties":{"uid:uid":null,"uid:minor_version":1,"uid:major_version":1,"dc:creator":"nuxeoDriveTestUser_user_1","dc:source":null,"dc:nature":null,"dc:contributors":["nuxeoDriveTestUser_user_1"],"dc:created":"2014-12-10T15:03:44.30Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.61Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Document to version.txt","dc:lastContributor":"nuxeoDriveTestUser_user_1","files:files":[],"thumb:thumbnail":null,"common:icon":"/icons/text.png","common:icon-expanded":null,"common:size":16,"file:content":{"name":"Document to version.txt","mime-type":"text/plain","encoding":null,"digest":"0788b34b5d5b3ff7ae0246e1ad99d62b","length":"16","data":"http://localhost:8080/nuxeo/nxbigfile/default/a242e14b-b339-4902-9108-b570c027fa96/file:content/Document%20to%20version.txt"},"file:filename":null,"relatedtext:relatedtextresources":[]},"facets":["Downloadable","Commentable","Versionable","Publishable","HasRelatedText","Thumbnail"],"changeToken":"1418223824616","contextParameters":{}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'input': u'doc:a242e14b-b339-4902-9108-b570c027fa96', 'params': {}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.GetVersions with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"input": "doc:a242e14b-b339-4902-9108-b570c027fa96", "params": {}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.GetVersions' with cookies []: '{"entity-type":"documents","entries":[{"entity-type":"document","repository":"default","uid":"0d706103-a848-4caf-bdc6-0825fe9f1a43","path":"/default-domain/workspaces/nuxeo-drive-test-workspace/Document to version.txt","type":"File","state":"project","parentRef":"87e9c894-ec66-4b1f-8d21-e292d691d023","versionLabel":"1.0","isCheckedOut":false,"title":"Document to version.txt","lastModified":"2014-12-10T15:03:44.37Z","properties":{"uid:uid":null,"uid:minor_version":0,"uid:major_version":1,"dc:creator":"nuxeoDriveTestUser_user_1","dc:source":null,"dc:nature":null,"dc:contributors":["nuxeoDriveTestUser_user_1"],"dc:created":"2014-12-10T15:03:44.30Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.37Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Document to version.txt","dc:lastContributor":"nuxeoDriveTestUser_user_1","files:files":[],"thumb:thumbnail":null,"common:icon":"/icons/text.png","common:icon-expanded":null,"common:size":16,"file:content":{"name":"Document to version.txt","mime-type":"text/plain","encoding":null,"digest":"e8243f47118ab46922047814915ddb81","length":"16","data":"http://localhost:8080/nuxeo/nxbigfile/default/0d706103-a848-4caf-bdc6-0825fe9f1a43/file:content/Document%20to%20version.txt"},"file:filename":null,"relatedtext:relatedtextresources":[]},"facets":["Downloadable","Commentable","Immutable","Versionable","Publishable","HasRelatedText","Thumbnail"],"changeToken":"1418223824375","contextParameters":{}},{"entity-type":"document","repository":"default","uid":"d29406fb-8d67-4d37-a687-8bc4331cab2e","path":"/default-domain/workspaces/nuxeo-drive-test-workspace/Document to version.txt","type":"File","state":"project","parentRef":"87e9c894-ec66-4b1f-8d21-e292d691d023","versionLabel":"1.1","isCheckedOut":false,"title":"Document to version.txt","lastModified":"2014-12-10T15:03:44.61Z","properties":{"uid:uid":null,"uid:minor_version":1,"uid:major_version":1,"dc:creator":"nuxeoDriveTestUser_user_1","dc:source":null,"dc:nature":null,"dc:contributors":["nuxeoDriveTestUser_user_1"],"dc:created":"2014-12-10T15:03:44.30Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.61Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Document to version.txt","dc:lastContributor":"nuxeoDriveTestUser_user_1","files:files":[],"thumb:thumbnail":null,"common:icon":"/icons/text.png","common:icon-expanded":null,"common:size":16,"file:content":{"name":"Document to version.txt","mime-type":"text/plain","encoding":null,"digest":"0788b34b5d5b3ff7ae0246e1ad99d62b","length":"16","data":"http://localhost:8080/nuxeo/nxbigfile/default/d29406fb-8d67-4d37-a687-8bc4331cab2e/file:content/Document%20to%20version.txt"},"file:filename":null,"relatedtext:relatedtextresources":[]},"facets":["Downloadable","Commentable","Immutable","Versionable","Publishable","HasRelatedText","Thumbnail"],"changeToken":"1418223824616","contextParameters":{}}]}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'input': u'doc:d29406fb-8d67-4d37-a687-8bc4331cab2e', 'params': {}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Blob.Get with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"input": "doc:d29406fb-8d67-4d37-a687-8bc4331cab2e", "params": {}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Blob.Get' with cookies [] has content-type 'text/plain' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'query': u"SELECT * FROM Document WHERE ecm:uuid = 'a242e14b-b339-4902-9108-b570c027fa96' AND ecm:currentLifeCycleState != 'deleted' AND ecm:isCheckedInVersion = 0 LIMIT 1"}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.Query with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"params": {"query": "SELECT * FROM Document WHERE ecm:uuid = \'a242e14b-b339-4902-9108-b570c027fa96\' AND ecm:currentLifeCycleState != \'deleted\' AND ecm:isCheckedInVersion = 0 LIMIT 1"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.Query' with cookies []: '{"entity-type":"documents","isPaginable":true,"resultsCount":1,"pageSize":0,"maxPageSize":1000,"currentPageSize":1,"currentPageIndex":0,"numberOfPages":1,"isPreviousPageAvailable":false,"isNextPageAvailable":false,"isLastPageAvailable":false,"isSortable":true,"hasError":false,"errorMessage":null,"totalSize":1,"pageIndex":0,"pageCount":1,"entries":[{"entity-type":"document","repository":"default","uid":"a242e14b-b339-4902-9108-b570c027fa96","path":"/default-domain/workspaces/nuxeo-drive-test-workspace/Document to version.txt","type":"File","state":"project","parentRef":"87e9c894-ec66-4b1f-8d21-e292d691d023","versionLabel":"1.1","isCheckedOut":false,"title":"Document to version.txt","lastModified":"2014-12-10T15:03:44.61Z","properties":{"uid:uid":null,"uid:minor_version":1,"uid:major_version":1,"dc:creator":"nuxeoDriveTestUser_user_1","dc:source":null,"dc:nature":null,"dc:contributors":["nuxeoDriveTestUser_user_1"],"dc:created":"2014-12-10T15:03:44.30Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.61Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Document to version.txt","dc:lastContributor":"nuxeoDriveTestUser_user_1","files:files":[],"thumb:thumbnail":null,"common:icon":"/icons/text.png","common:icon-expanded":null,"common:size":16,"file:content":{"name":"Document to version.txt","mime-type":"text/plain","encoding":null,"digest":"0788b34b5d5b3ff7ae0246e1ad99d62b","length":"16","data":"http://localhost:8080/nuxeo/nxbigfile/default/a242e14b-b339-4902-9108-b570c027fa96/file:content/Document%20to%20version.txt"},"file:filename":null,"relatedtext:relatedtextresources":[]},"facets":["Downloadable","Commentable","Versionable","Publishable","HasRelatedText","Thumbnail"],"changeToken":"1418223824616","contextParameters":{"documentURL":"/nuxeo/nxdoc/default/a242e14b-b339-4902-9108-b570c027fa96/view_documents"}}]}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'value': u'a242e14b-b339-4902-9108-b570c027fa96'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.Fetch with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"params": {"value": "a242e14b-b339-4902-9108-b570c027fa96"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.Fetch' with cookies []: '{"entity-type":"document","repository":"default","uid":"a242e14b-b339-4902-9108-b570c027fa96","path":"/default-domain/workspaces/nuxeo-drive-test-workspace/Document to version.txt","type":"File","state":"project","parentRef":"87e9c894-ec66-4b1f-8d21-e292d691d023","versionLabel":"1.1","isCheckedOut":false,"title":"Document to version.txt","lastModified":"2014-12-10T15:03:44.61Z","properties":{"uid:uid":null,"uid:minor_version":1,"uid:major_version":1,"dc:creator":"nuxeoDriveTestUser_user_1","dc:source":null,"dc:nature":null,"dc:contributors":["nuxeoDriveTestUser_user_1"],"dc:created":"2014-12-10T15:03:44.30Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.61Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Document to version.txt","dc:lastContributor":"nuxeoDriveTestUser_user_1","files:files":[],"thumb:thumbnail":null,"common:icon":"/icons/text.png","common:icon-expanded":null,"common:size":16,"file:content":{"name":"Document to version.txt","mime-type":"text/plain","encoding":null,"digest":"0788b34b5d5b3ff7ae0246e1ad99d62b","length":"16","data":"http://localhost:8080/nuxeo/nxbigfile/default/a242e14b-b339-4902-9108-b570c027fa96/file:content/Document%20to%20version.txt"},"file:filename":null,"relatedtext:relatedtextresources":[]},"facets":["Downloadable","Commentable","Versionable","Publishable","HasRelatedText","Thumbnail"],"changeToken":"1418223824616","contextParameters":{}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'value': u'/default-domain/workspaces/nuxeo-drive-test-workspace'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Document.Fetch with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"params": {"value": "/default-domain/workspaces/nuxeo-drive-test-workspace"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Document.Fetch' with cookies []: '{"entity-type":"document","repository":"default","uid":"87e9c894-ec66-4b1f-8d21-e292d691d023","path":"/default-domain/workspaces/nuxeo-drive-test-workspace","type":"Workspace","state":"project","parentRef":"5118834e-8ac1-4e4b-af06-62f016ae70ce","versionLabel":"","isCheckedOut":true,"title":"Nuxeo Drive Test Workspace","lastModified":"2014-12-10T15:03:44.09Z","properties":{"dc:creator":"Administrator","dc:source":null,"dc:nature":null,"dc:contributors":["Administrator"],"dc:created":"2014-12-10T15:03:44.09Z","dc:description":null,"dc:rights":null,"dc:subjects":[],"dc:publisher":null,"dc:valid":null,"dc:format":null,"dc:issued":null,"dc:modified":"2014-12-10T15:03:44.09Z","dc:expired":null,"dc:coverage":null,"dc:language":null,"dc:title":"Nuxeo Drive Test Workspace","dc:lastContributor":"Administrator","files:files":[],"common:icon":"/icons/workspace.gif","common:icon-expanded":null,"common:size":null,"file:content":null,"file:filename":null,"webc:welcomeText":null,"webc:useCaptcha":null,"webc:welcomeMedia":null,"webc:theme":"sites","webc:isWebContainer":null,"webc:baseline":null,"webc:template":null,"webc:logo":null,"webc:themePerspective":null,"webc:themePage":"workspace","webc:name":null,"webc:moderationType":"aposteriori","webc:url":null,"webc:email":null,"publish:sections":[]},"facets":["SuperSpace","Folderish"],"changeToken":"1418223824097","contextParameters":{}}' 16:16:38 [INFO] [exec] nxdrive.utils: TRACE: Guessed mime type 'text/plain' for 'Document to version.txt' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Using file system block size for the streaming upload buffer: 4096 bytes 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/batch/upload with headers {'Content-Length': 22, 'X-Client-Version': '1.3-dev', 'X-Device-Id': u'nxdrive-test-device-1', 'X-File-Type': 'text/plain', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'X-File-Size': 22, 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA=', 'Cache-Control': 'no-cache', 'X-Batch-Id': '1418223824.75_737809336', 'X-File-Idx': 0, 'Content-Type': 'application/octet-stream', 'X-Application-Name': 'Nuxeo Drive', 'X-File-Name': 'Document%20to%20version.txt'} and cookies [] for file /tmp/tmpwTPFjI-nxdrive-uploads/tmpqxLGUr-nxdrive-file-to-upload 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/batch/upload' with cookies []: '{"uploaded":"true","batchId":"1418223824.75_737809336"}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Using 300 seconds [max(300, 2 * upload time=0)] as Nuxeo transaction timeout for batch execution of Blob.Attach with file /tmp/tmpwTPFjI-nxdrive-uploads/tmpqxLGUr-nxdrive-file-to-upload 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'params': {'batchId': '1418223824.75_737809336', 'document': u'a242e14b-b339-4902-9108-b570c027fa96', 'fileIdx': '0', 'operationId': 'Blob.Attach'}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/batch/execute with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'X-Application-Name': 'Nuxeo Drive', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'Nuxeo-Transaction-Timeout': 300, 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"params": {"batchId": "1418223824.75_737809336", "document": "a242e14b-b339-4902-9108-b570c027fa96", "fileIdx": "0", "operationId": "Blob.Attach"}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/batch/execute' with cookies [] has content-type 'text/plain' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Dumping JSON structure: {'input': u'doc:a242e14b-b339-4902-9108-b570c027fa96', 'params': {}} 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Calling http://localhost:8080/nuxeo/site/automation/Blob.Get with headers {'X-Client-Version': '1.3-dev', 'X-NXDocumentProperties': '*', 'X-Device-Id': u'nxdrive-test-device-1', 'Accept': 'application/json+nxentity, */*', 'User-Agent': 'Nuxeo Drive/1.3-dev', 'X-User-Id': u'nuxeoDriveTestUser_user_1', 'Cache-Control': 'no-cache', 'Content-Type': 'application/json+nxrequest', 'X-Application-Name': 'Nuxeo Drive', 'Authorization': 'Basic bnV4ZW9Ecml2ZVRlc3RVc2VyX3VzZXJfMTo0M2VlMzA='}, cookies [] and JSON payload '{"input": "doc:a242e14b-b339-4902-9108-b570c027fa96", "params": {}}' 16:16:38 [INFO] [exec] nxdrive.client.base_automation_client: TRACE: Response for 'http://localhost:8080/nuxeo/site/automation/Blob.Get' with cookies [] has content-type 'text/plain' 16:16:38 [INFO] [exec] --------------------- >> end captured logging << --------------------- 16