builder: mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s slave: talos-linux64-ix-004 starttime: 1503319037.26 results: success (0) revision: ecf9cc9bfca0853c22f7cf78a88b5762a002164e ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-08-21 05:37:17.263942) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-08-21 05:37:17.264390) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-08-21 05:37:17.264659) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-08-21 05:37:17.281247) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-21 05:37:17.281615) ========= bash -c 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'wget -Oarchiver_client.py --no-check-certificate --tries=10 --waitretry=3 https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-08-21 05:37:18-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 49.7M=0s 2017-08-21 05:37:18 (49.7 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.164908 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-21 05:37:17.468431) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-08-21 05:37:17.468751) ========= rm -rf scripts properties in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-rf', 'scripts', 'properties'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020887 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-08-21 05:37:17.518344) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-21 05:37:17.518689) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev ecf9cc9bfca0853c22f7cf78a88b5762a002164e --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo mozilla-central --rev ecf9cc9bfca0853c22f7cf78a88b5762a002164e --destination scripts --debug'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-08-21 05:37:18,416 truncating revision to first 12 chars 2017-08-21 05:37:18,416 Setting DEBUG logging. 2017-08-21 05:37:18,416 attempt 1/10 2017-08-21 05:37:18,416 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/ecf9cc9bfca0?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-08-21 05:37:18,831 unpacking tar archive at: mozilla-central-ecf9cc9bfca0/testing/mozharness/ program finished with exit code 0 elapsedTime=0.765211 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-08-21 05:37:18.300685) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-08-21 05:37:18.301025) ========= script_repo_revision: ecf9cc9bfca0853c22f7cf78a88b5762a002164e ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-08-21 05:37:18.301405) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-08-21 05:37:18.301719) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-08-21 05:37:18.317670) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 54 secs) (at 2017-08-21 05:37:18.318031) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 05:37:19 INFO - MultiFileLogger online at 20170821 05:37:19 in /builds/slave/test 05:37:19 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 05:37:19 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 05:37:19 INFO - {'append_to_log': False, 05:37:19 INFO - 'base_work_dir': '/builds/slave/test', 05:37:19 INFO - 'blob_upload_branch': 'Firefox', 05:37:19 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 05:37:19 INFO - 'branch': 'Firefox', 05:37:19 INFO - 'buildbot_json_path': 'buildprops.json', 05:37:19 INFO - 'code_coverage': False, 05:37:19 INFO - 'config_files': ('talos/linux_config.py',), 05:37:19 INFO - 'default_actions': ('clobber', 05:37:19 INFO - 'read-buildbot-config', 05:37:19 INFO - 'download-and-extract', 05:37:19 INFO - 'populate-webroot', 05:37:19 INFO - 'create-virtualenv', 05:37:19 INFO - 'install', 05:37:19 INFO - 'setup-mitmproxy', 05:37:19 INFO - 'run-tests'), 05:37:19 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 05:37:19 INFO - 'disable_ccov_upload': False, 05:37:19 INFO - 'download_minidump_stackwalk': True, 05:37:19 INFO - 'download_symbols': 'ondemand', 05:37:19 INFO - 'enable_stylo': False, 05:37:19 INFO - 'enable_webrender': False, 05:37:19 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 05:37:19 INFO - 'tooltool.py': '/tools/tooltool.py', 05:37:19 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 05:37:19 INFO - '/tools/misc-python/virtualenv.py')}, 05:37:19 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 05:37:19 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 05:37:19 INFO - 'gecko_profile': False, 05:37:19 INFO - 'gecko_profile_interval': 0, 05:37:19 INFO - 'installer_path': 'installer.exe', 05:37:19 INFO - 'log_level': 'info', 05:37:19 INFO - 'log_name': 'talos', 05:37:19 INFO - 'log_to_console': True, 05:37:19 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 05:37:19 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 05:37:19 INFO - 'opt_config_files': (), 05:37:19 INFO - 'pip_index': False, 05:37:19 INFO - 'suite': 'dromaeojs-e10s', 05:37:19 INFO - 'system_bits': '32', 05:37:19 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 05:37:19 INFO - 'title': 'talos-linux64-ix-004', 05:37:19 INFO - 'tooltool_cache': '/builds/tooltool_cache', 05:37:19 INFO - 'use_talos_json': True, 05:37:19 INFO - 'verify': 'False', 05:37:19 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 05:37:19 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 05:37:19 INFO - 'work_dir': 'build'} 05:37:19 INFO - [mozharness: 2017-08-21 12:37:19.359074Z] Running clobber step. 05:37:19 INFO - Running pre-action listener: _resource_record_pre_action 05:37:19 INFO - Running main action method: clobber 05:37:19 INFO - rmtree: /builds/slave/test/build 05:37:19 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 05:37:20 INFO - Running post-action listener: _resource_record_post_action 05:37:20 INFO - [mozharness: 2017-08-21 12:37:20.535220Z] Finished clobber step (success) 05:37:20 INFO - [mozharness: 2017-08-21 12:37:20.535318Z] Running read-buildbot-config step. 05:37:20 INFO - Running pre-action listener: _resource_record_pre_action 05:37:20 INFO - Running main action method: read_buildbot_config 05:37:20 INFO - Using buildbot properties: 05:37:20 INFO - { 05:37:20 INFO - "project": "", 05:37:20 INFO - "product": "firefox", 05:37:20 INFO - "who": "archaeopteryx@coole-files.de", 05:37:20 INFO - "installer_path": "public/build/target.tar.bz2", 05:37:20 INFO - "builddir": "mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s", 05:37:20 INFO - "repository": "https://hg.mozilla.org/mozilla-central", 05:37:20 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo mozilla-central talos dromaeojs-e10s", 05:37:20 INFO - "stage_platform": "linux64-stylo", 05:37:20 INFO - "basedir": "/builds/slave/test", 05:37:20 INFO - "buildnumber": 93, 05:37:20 INFO - "platform": "ubuntu64_hw_stylo", 05:37:20 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 05:37:20 INFO - "slavebuilddir": "test", 05:37:20 INFO - "taskId": "a_VIT5q9T3Si35O-P4C0Bw", 05:37:20 INFO - "branch": "mozilla-central", 05:37:20 INFO - "script_repo_revision": "production", 05:37:20 INFO - "revision": "ecf9cc9bfca0853c22f7cf78a88b5762a002164e", 05:37:20 INFO - "slavename": "talos-linux64-ix-004", 05:37:20 INFO - "repo_path": "mozilla-central" 05:37:20 INFO - } 05:37:20 INFO - Finding installer, test and symbols from parent task. 05:37:20 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/a_VIT5q9T3Si35O-P4C0Bw'}, attempt #1 05:37:21 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/a_VIT5q9T3Si35O-P4C0Bw'}, attempt #1 05:37:21 INFO - Task dependencies: GY_CFQtjQZGJCDtqe6SoTw 05:37:21 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw'}, attempt #1 05:37:21 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.tar.bz2 05:37:21 INFO - Set test_packages_url: https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.test_packages.json 05:37:21 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.crashreporter-symbols.zip 05:37:21 INFO - Running post-action listener: _resource_record_post_action 05:37:21 INFO - [mozharness: 2017-08-21 12:37:21.913020Z] Finished read-buildbot-config step (success) 05:37:21 INFO - [mozharness: 2017-08-21 12:37:21.913239Z] Running download-and-extract step. 05:37:21 INFO - Running pre-action listener: _resource_record_pre_action 05:37:21 INFO - Running main action method: download_and_extract 05:37:21 INFO - mkdir: /builds/slave/test/build/tests 05:37:21 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:37:21 INFO - trying https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.test_packages.json 05:37:21 INFO - Downloading https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 05:37:21 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 05:37:22 INFO - Downloaded 989 bytes. 05:37:22 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 05:37:22 INFO - Using the following test package requirements: 05:37:22 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 05:37:22 INFO - u'common': [u'target.common.tests.zip'], 05:37:22 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 05:37:22 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 05:37:22 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 05:37:22 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 05:37:22 INFO - u'mozbase': [u'target.common.tests.zip'], 05:37:22 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 05:37:22 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 05:37:22 INFO - u'web-platform': [u'target.common.tests.zip', 05:37:22 INFO - u'target.web-platform.tests.tar.gz'], 05:37:22 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 05:37:22 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 05:37:22 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.common.tests.zip 05:37:22 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.common.tests.zip'}, attempt #1 05:37:22 INFO - Fetch https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.common.tests.zip into memory 05:37:23 INFO - Content-Length response header: 54005821 05:37:23 INFO - Bytes received: 54005821 05:37:34 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 05:37:34 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.common.tests.zip 05:37:34 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.common.tests.zip'}, attempt #1 05:37:34 INFO - Fetch https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.common.tests.zip into memory 05:37:35 INFO - Content-Length response header: 54005821 05:37:35 INFO - Bytes received: 54005821 05:37:47 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.talos.tests.zip 05:37:47 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.talos.tests.zip'}, attempt #1 05:37:47 INFO - Fetch https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.talos.tests.zip into memory 05:37:48 INFO - Content-Length response header: 14496256 05:37:48 INFO - Bytes received: 14496256 05:37:48 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:37:48 INFO - trying https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.tar.bz2 05:37:48 INFO - Downloading https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 05:37:48 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 05:37:49 INFO - Downloaded 62147803 bytes. 05:37:49 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.tar.bz2 05:37:49 INFO - mkdir: /builds/slave/test/properties 05:37:49 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 05:37:49 INFO - Writing to file /builds/slave/test/properties/build_url 05:37:49 INFO - Contents: 05:37:49 INFO - build_url:https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.tar.bz2 05:37:49 INFO - Running post-action listener: _resource_record_post_action 05:37:49 INFO - Running post-action listener: find_tests_for_verification 05:37:49 INFO - Running post-action listener: set_extra_try_arguments 05:37:49 INFO - [mozharness: 2017-08-21 12:37:49.730197Z] Finished download-and-extract step (success) 05:37:49 INFO - [mozharness: 2017-08-21 12:37:49.730295Z] Running populate-webroot step. 05:37:49 INFO - Running pre-action listener: _resource_record_pre_action 05:37:49 INFO - Running main action method: populate_webroot 05:37:49 INFO - {'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 05:37:49 INFO - 'chromez-stylo-e10s': {'talos_options': ['--stylo'], 05:37:49 INFO - 'tests': ['tresize', 'tcanvasmark']}, 05:37:49 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 05:37:49 INFO - 'dromaeojs-stylo-e10s': {'talos_options': ['--stylo'], 05:37:49 INFO - 'tests': ['dromaeo_css', 'kraken']}, 05:37:49 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 05:37:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:37:49 INFO - 'g1-stylo-e10s': {'pagesets_name': 'tp5n.zip', 05:37:49 INFO - 'talos_options': ['--stylo'], 05:37:49 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 05:37:49 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 05:37:49 INFO - 'tests': ['damp', 'tps']}, 05:37:49 INFO - 'g2-stylo-e10s': {'pagesets_name': 'tp5n.zip', 05:37:49 INFO - 'talos_options': ['--stylo'], 05:37:49 INFO - 'tests': ['damp', 'tps']}, 05:37:49 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 05:37:49 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 05:37:49 INFO - 'g4-stylo-e10s': {'talos_options': ['--stylo'], 05:37:49 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 05:37:49 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 05:37:49 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 05:37:49 INFO - 'g5-stylo-e10s': {'pagesets_name': 'tp5n.zip', 05:37:49 INFO - 'talos_options': ['--stylo'], 05:37:49 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 05:37:49 INFO - 'other-e10s': {'tests': ['a11yr', 05:37:49 INFO - 'ts_paint', 05:37:49 INFO - 'tpaint', 05:37:49 INFO - 'sessionrestore', 05:37:49 INFO - 'sessionrestore_many_windows', 05:37:49 INFO - 'sessionrestore_no_auto_restore', 05:37:49 INFO - 'tabpaint']}, 05:37:49 INFO - 'other-stylo-e10s': {'talos_options': ['--stylo'], 05:37:49 INFO - 'tests': ['a11yr', 05:37:49 INFO - 'ts_paint', 05:37:49 INFO - 'tpaint', 05:37:49 INFO - 'sessionrestore', 05:37:49 INFO - 'sessionrestore_many_windows', 05:37:49 INFO - 'sessionrestore_no_auto_restore', 05:37:49 INFO - 'tabpaint']}, 05:37:49 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 05:37:49 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 05:37:49 INFO - 'perf-reftest-singletons-stylo-e10s': {'talos_options': ['--stylo'], 05:37:49 INFO - 'tests': ['bloom_basic_singleton']}, 05:37:49 INFO - 'perf-reftest-stylo-e10s': {'talos_options': ['--stylo'], 05:37:49 INFO - 'tests': ['bloom_basic']}, 05:37:49 INFO - 'svgr-e10s': {'tests': ['tsvgx', 05:37:49 INFO - 'tsvgr_opacity', 05:37:49 INFO - 'tart', 05:37:49 INFO - 'tscrollx', 05:37:49 INFO - 'tsvg_static']}, 05:37:49 INFO - 'svgr-stylo-e10s': {'talos_options': ['--stylo'], 05:37:49 INFO - 'tests': ['tsvgx', 05:37:49 INFO - 'tsvgr_opacity', 05:37:49 INFO - 'tart', 05:37:49 INFO - 'tscrollx', 05:37:49 INFO - 'tsvg_static']}, 05:37:49 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 05:37:49 INFO - 'tp5o-stylo-e10s': {'pagesets_name': 'tp5n.zip', 05:37:49 INFO - 'talos_options': ['--stylo'], 05:37:49 INFO - 'tests': ['tp5o']}, 05:37:49 INFO - 'tp6-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 05:37:49 INFO - 'talos_options': ['--mitmproxy', 05:37:49 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 05:37:49 INFO - '--firstNonBlankPaint'], 05:37:49 INFO - 'tests': ['tp6_google', 05:37:49 INFO - 'tp6_youtube', 05:37:49 INFO - 'tp6_amazon', 05:37:49 INFO - 'tp6_facebook']}, 05:37:49 INFO - 'tp6-stylo-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 05:37:49 INFO - 'talos_options': ['--stylo', 05:37:49 INFO - '--mitmproxy', 05:37:49 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 05:37:49 INFO - '--firstNonBlankPaint'], 05:37:49 INFO - 'tests': ['tp6_google', 05:37:49 INFO - 'tp6_youtube', 05:37:49 INFO - 'tp6_amazon', 05:37:49 INFO - 'tp6_facebook']}, 05:37:49 INFO - 'tp6-stylo-threads-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 05:37:49 INFO - 'talos_options': ['--stylo', 05:37:49 INFO - '--stylo-threads=1', 05:37:49 INFO - '--mitmproxy', 05:37:49 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 05:37:49 INFO - '--firstNonBlankPaint'], 05:37:49 INFO - 'tests': ['tp6_google', 05:37:49 INFO - 'tp6_youtube', 05:37:49 INFO - 'tp6_amazon', 05:37:49 INFO - 'tp6_facebook']}, 05:37:49 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 05:37:49 INFO - 'talos_options': ['--xperf_path', 05:37:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:37:49 INFO - 'tests': ['tp5n']}, 05:37:49 INFO - 'xperf-stylo-e10s': {'pagesets_name': 'tp5n.zip', 05:37:49 INFO - 'talos_options': ['--stylo', 05:37:49 INFO - '--xperf_path', 05:37:49 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 05:37:49 INFO - 'tests': ['tp5n']}}} 05:37:49 INFO - Running post-action listener: _resource_record_post_action 05:37:49 INFO - [mozharness: 2017-08-21 12:37:49.744566Z] Finished populate-webroot step (success) 05:37:49 INFO - [mozharness: 2017-08-21 12:37:49.744656Z] Running create-virtualenv step. 05:37:49 INFO - Running pre-action listener: _resource_record_pre_action 05:37:49 INFO - Running main action method: create_virtualenv 05:37:49 INFO - Creating virtualenv /builds/slave/test/build/venv 05:37:49 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 05:37:49 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 05:37:49 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 05:37:49 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 05:37:49 INFO - Using real prefix '/usr' 05:37:49 INFO - New python executable in /builds/slave/test/build/venv/bin/python 05:37:50 INFO - Installing distribute.............................................................................................................................................................................................done. 05:37:52 INFO - Installing pip.................done. 05:37:52 INFO - Return code: 0 05:37:52 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 05:37:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 05:37:52 INFO - Reading from file tmpfile_stdout 05:37:52 INFO - Output received: 05:37:52 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 05:37:52 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 05:37:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:37:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:37:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x9db1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xba6a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd49f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd47130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd48030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd484c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:37:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'pip>=1.5'] in /builds/slave/test/build 05:37:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 05:37:52 INFO - Using env: {'DISPLAY': ':0', 05:37:52 INFO - 'HOME': '/home/cltbld', 05:37:52 INFO - 'LANG': 'en_US.UTF-8', 05:37:52 INFO - 'LANGUAGE': 'en_US:en', 05:37:52 INFO - 'LOGNAME': 'cltbld', 05:37:52 INFO - 'MAIL': '/var/mail/cltbld', 05:37:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:52 INFO - 'MOZ_NO_REMOTE': '1', 05:37:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:52 INFO - 'NO_EM_RESTART': '1', 05:37:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:37:52 INFO - 'PWD': '/builds/slave/test', 05:37:52 INFO - 'SHELL': '/bin/bash', 05:37:52 INFO - 'SHLVL': '1', 05:37:52 INFO - 'TERM': 'linux', 05:37:52 INFO - 'TMOUT': '86400', 05:37:52 INFO - 'USER': 'cltbld', 05:37:52 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 05:37:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:52 INFO - '_': '/tools/buildbot/bin/python'} 05:37:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:52 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 05:37:52 INFO - Cleaning up... 05:37:52 INFO - Return code: 0 05:37:52 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 05:37:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:37:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:52 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:37:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:52 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x9db1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xba6a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd49f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd47130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd48030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd484c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:37:52 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'psutil>=3.1.1'] in /builds/slave/test/build 05:37:52 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 05:37:52 INFO - Using env: {'DISPLAY': ':0', 05:37:52 INFO - 'HOME': '/home/cltbld', 05:37:52 INFO - 'LANG': 'en_US.UTF-8', 05:37:52 INFO - 'LANGUAGE': 'en_US:en', 05:37:52 INFO - 'LOGNAME': 'cltbld', 05:37:52 INFO - 'MAIL': '/var/mail/cltbld', 05:37:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:52 INFO - 'MOZ_NO_REMOTE': '1', 05:37:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:52 INFO - 'NO_EM_RESTART': '1', 05:37:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:37:52 INFO - 'PWD': '/builds/slave/test', 05:37:52 INFO - 'SHELL': '/bin/bash', 05:37:52 INFO - 'SHLVL': '1', 05:37:52 INFO - 'TERM': 'linux', 05:37:52 INFO - 'TMOUT': '86400', 05:37:52 INFO - 'USER': 'cltbld', 05:37:52 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 05:37:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:52 INFO - '_': '/tools/buildbot/bin/python'} 05:37:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:52 INFO - Downloading/unpacking psutil>=3.1.1 05:37:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:52 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:52 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 05:37:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:37:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:37:54 INFO - Installing collected packages: psutil 05:37:54 INFO - Running setup.py install for psutil 05:37:54 INFO - building 'psutil._psutil_linux' extension 05:37:54 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 05:37:54 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 05:37:54 INFO - building 'psutil._psutil_posix' extension 05:37:54 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 05:37:54 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 05:37:54 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 05:37:54 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 05:37:54 INFO - Successfully installed psutil 05:37:54 INFO - Cleaning up... 05:37:54 INFO - Return code: 0 05:37:54 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 05:37:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:37:54 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:54 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:37:54 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:54 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x9db1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xba6a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd49f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd47130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd48030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd484c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:37:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'mozsystemmonitor==0.3'] in /builds/slave/test/build 05:37:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 05:37:54 INFO - Using env: {'DISPLAY': ':0', 05:37:54 INFO - 'HOME': '/home/cltbld', 05:37:54 INFO - 'LANG': 'en_US.UTF-8', 05:37:54 INFO - 'LANGUAGE': 'en_US:en', 05:37:54 INFO - 'LOGNAME': 'cltbld', 05:37:54 INFO - 'MAIL': '/var/mail/cltbld', 05:37:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:54 INFO - 'MOZ_NO_REMOTE': '1', 05:37:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:54 INFO - 'NO_EM_RESTART': '1', 05:37:54 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:37:54 INFO - 'PWD': '/builds/slave/test', 05:37:54 INFO - 'SHELL': '/bin/bash', 05:37:54 INFO - 'SHLVL': '1', 05:37:54 INFO - 'TERM': 'linux', 05:37:54 INFO - 'TMOUT': '86400', 05:37:54 INFO - 'USER': 'cltbld', 05:37:54 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 05:37:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:54 INFO - '_': '/tools/buildbot/bin/python'} 05:37:54 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:54 INFO - Downloading/unpacking mozsystemmonitor==0.3 05:37:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:54 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:54 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:56 INFO - Downloading mozsystemmonitor-0.3.tar.gz 05:37:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 05:37:56 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 05:37:56 INFO - Installing collected packages: mozsystemmonitor 05:37:56 INFO - Running setup.py install for mozsystemmonitor 05:37:56 INFO - Successfully installed mozsystemmonitor 05:37:56 INFO - Cleaning up... 05:37:56 INFO - Return code: 0 05:37:56 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 05:37:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:37:56 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:56 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:37:56 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:56 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x9db1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xba6a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd49f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd47130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd48030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd484c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:37:56 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema==2.5.1'] in /builds/slave/test/build 05:37:56 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 05:37:56 INFO - Using env: {'DISPLAY': ':0', 05:37:56 INFO - 'HOME': '/home/cltbld', 05:37:56 INFO - 'LANG': 'en_US.UTF-8', 05:37:56 INFO - 'LANGUAGE': 'en_US:en', 05:37:56 INFO - 'LOGNAME': 'cltbld', 05:37:56 INFO - 'MAIL': '/var/mail/cltbld', 05:37:56 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:56 INFO - 'MOZ_NO_REMOTE': '1', 05:37:56 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:56 INFO - 'NO_EM_RESTART': '1', 05:37:56 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:56 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:37:56 INFO - 'PWD': '/builds/slave/test', 05:37:56 INFO - 'SHELL': '/bin/bash', 05:37:56 INFO - 'SHLVL': '1', 05:37:56 INFO - 'TERM': 'linux', 05:37:56 INFO - 'TMOUT': '86400', 05:37:56 INFO - 'USER': 'cltbld', 05:37:56 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 05:37:56 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:56 INFO - '_': '/tools/buildbot/bin/python'} 05:37:56 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:56 INFO - Downloading/unpacking jsonschema==2.5.1 05:37:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:57 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 05:37:57 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 05:37:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:57 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:57 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:57 INFO - Downloading functools32-3.2.3-2.tar.gz 05:37:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 05:37:57 INFO - warning: no files found matching '*.txt' 05:37:57 INFO - no previously-included directories found matching 'build' 05:37:57 INFO - no previously-included directories found matching 'dist' 05:37:57 INFO - no previously-included directories found matching '.git*' 05:37:57 INFO - Installing collected packages: jsonschema, functools32 05:37:57 INFO - Running setup.py install for functools32 05:37:57 INFO - warning: no files found matching '*.txt' 05:37:57 INFO - no previously-included directories found matching 'build' 05:37:57 INFO - no previously-included directories found matching 'dist' 05:37:57 INFO - no previously-included directories found matching '.git*' 05:37:57 INFO - Successfully installed jsonschema functools32 05:37:57 INFO - Cleaning up... 05:37:57 INFO - Return code: 0 05:37:57 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 05:37:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:37:57 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:57 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:37:57 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:57 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x9db1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xba6a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd49f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd47130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd48030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd484c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:37:57 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'functools32==3.2.3-2'] in /builds/slave/test/build 05:37:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 05:37:57 INFO - Using env: {'DISPLAY': ':0', 05:37:57 INFO - 'HOME': '/home/cltbld', 05:37:57 INFO - 'LANG': 'en_US.UTF-8', 05:37:57 INFO - 'LANGUAGE': 'en_US:en', 05:37:57 INFO - 'LOGNAME': 'cltbld', 05:37:57 INFO - 'MAIL': '/var/mail/cltbld', 05:37:57 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:57 INFO - 'MOZ_NO_REMOTE': '1', 05:37:57 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:57 INFO - 'NO_EM_RESTART': '1', 05:37:57 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:57 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:37:57 INFO - 'PWD': '/builds/slave/test', 05:37:57 INFO - 'SHELL': '/bin/bash', 05:37:57 INFO - 'SHLVL': '1', 05:37:57 INFO - 'TERM': 'linux', 05:37:57 INFO - 'TMOUT': '86400', 05:37:57 INFO - 'USER': 'cltbld', 05:37:57 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 05:37:57 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:57 INFO - '_': '/tools/buildbot/bin/python'} 05:37:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:58 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 05:37:58 INFO - Cleaning up... 05:37:58 INFO - Return code: 0 05:37:58 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 05:37:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:37:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:37:58 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:37:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:37:58 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x9db1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xba6a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd49f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd47130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd48030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd484c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:37:58 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'blobuploader==1.2.4'] in /builds/slave/test/build 05:37:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 05:37:58 INFO - Using env: {'DISPLAY': ':0', 05:37:58 INFO - 'HOME': '/home/cltbld', 05:37:58 INFO - 'LANG': 'en_US.UTF-8', 05:37:58 INFO - 'LANGUAGE': 'en_US:en', 05:37:58 INFO - 'LOGNAME': 'cltbld', 05:37:58 INFO - 'MAIL': '/var/mail/cltbld', 05:37:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:37:58 INFO - 'MOZ_NO_REMOTE': '1', 05:37:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:37:58 INFO - 'NO_EM_RESTART': '1', 05:37:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:37:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:37:58 INFO - 'PWD': '/builds/slave/test', 05:37:58 INFO - 'SHELL': '/bin/bash', 05:37:58 INFO - 'SHLVL': '1', 05:37:58 INFO - 'TERM': 'linux', 05:37:58 INFO - 'TMOUT': '86400', 05:37:58 INFO - 'USER': 'cltbld', 05:37:58 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 05:37:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:37:58 INFO - '_': '/tools/buildbot/bin/python'} 05:37:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:37:58 INFO - Downloading/unpacking blobuploader==1.2.4 05:37:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:58 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:58 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:59 INFO - Downloading blobuploader-1.2.4.tar.gz 05:37:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 05:37:59 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 05:37:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:59 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 05:37:59 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 05:37:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:59 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:37:59 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:37:59 INFO - Downloading docopt-0.6.1.tar.gz 05:38:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 05:38:00 INFO - Installing collected packages: blobuploader, requests, docopt 05:38:00 INFO - Running setup.py install for blobuploader 05:38:00 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 05:38:00 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 05:38:00 INFO - Running setup.py install for requests 05:38:00 INFO - Running setup.py install for docopt 05:38:00 INFO - Successfully installed blobuploader requests docopt 05:38:00 INFO - Cleaning up... 05:38:00 INFO - Return code: 0 05:38:00 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:38:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:38:00 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:38:00 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:38:00 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:38:00 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x9db1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xba6a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd49f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd47130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd48030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd484c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:38:00 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--no-deps', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 05:38:00 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --no-deps --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:38:00 INFO - Using env: {'DISPLAY': ':0', 05:38:00 INFO - 'HOME': '/home/cltbld', 05:38:00 INFO - 'LANG': 'en_US.UTF-8', 05:38:00 INFO - 'LANGUAGE': 'en_US:en', 05:38:00 INFO - 'LOGNAME': 'cltbld', 05:38:00 INFO - 'MAIL': '/var/mail/cltbld', 05:38:00 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:38:00 INFO - 'MOZ_NO_REMOTE': '1', 05:38:00 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:38:00 INFO - 'NO_EM_RESTART': '1', 05:38:00 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:38:00 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:38:00 INFO - 'PWD': '/builds/slave/test', 05:38:00 INFO - 'SHELL': '/bin/bash', 05:38:00 INFO - 'SHLVL': '1', 05:38:00 INFO - 'TERM': 'linux', 05:38:00 INFO - 'TMOUT': '86400', 05:38:00 INFO - 'USER': 'cltbld', 05:38:00 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 05:38:00 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:38:00 INFO - '_': '/tools/buildbot/bin/python'} 05:38:00 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:38:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:38:00 INFO - Running setup.py (path:/tmp/pip-ZWwck4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:38:00 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:38:00 INFO - Running setup.py (path:/tmp/pip-82VRHD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:38:01 INFO - Running setup.py (path:/tmp/pip-2zVK96-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:38:01 INFO - Running setup.py (path:/tmp/pip-pr5Nb3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:38:01 INFO - Running setup.py (path:/tmp/pip-j6btQs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:38:01 INFO - Running setup.py (path:/tmp/pip-zFC2aW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:38:01 INFO - Running setup.py (path:/tmp/pip-K3H_qa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:38:01 INFO - Running setup.py (path:/tmp/pip-kBLcnH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:38:01 INFO - Running setup.py (path:/tmp/pip-y7kO4x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:38:01 INFO - Running setup.py (path:/tmp/pip-hZkylS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:38:01 INFO - Running setup.py (path:/tmp/pip-UCFi_w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:38:01 INFO - Running setup.py (path:/tmp/pip-h0BWPQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:38:01 INFO - Running setup.py (path:/tmp/pip-d2FDAz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:38:01 INFO - Running setup.py (path:/tmp/pip-ipW7lE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:38:01 INFO - Running setup.py (path:/tmp/pip-23EOIQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:38:01 INFO - Running setup.py (path:/tmp/pip-japLg3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:38:01 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:38:02 INFO - Running setup.py (path:/tmp/pip-OtTmxW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:38:02 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 05:38:02 INFO - Running setup.py install for manifestparser 05:38:02 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 05:38:02 INFO - Running setup.py install for mozcrash 05:38:02 INFO - Running setup.py install for mozdebug 05:38:02 INFO - Running setup.py install for mozdevice 05:38:02 INFO - Installing dm script to /builds/slave/test/build/venv/bin 05:38:02 INFO - Running setup.py install for mozfile 05:38:02 INFO - Running setup.py install for mozhttpd 05:38:02 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 05:38:02 INFO - Running setup.py install for mozinfo 05:38:02 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 05:38:02 INFO - Running setup.py install for mozInstall 05:38:02 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 05:38:02 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 05:38:02 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 05:38:02 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 05:38:02 INFO - Running setup.py install for mozleak 05:38:02 INFO - Running setup.py install for mozlog 05:38:03 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 05:38:03 INFO - Running setup.py install for moznetwork 05:38:03 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 05:38:03 INFO - Running setup.py install for mozprocess 05:38:03 INFO - Running setup.py install for mozprofile 05:38:03 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 05:38:03 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 05:38:03 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 05:38:03 INFO - Running setup.py install for mozrunner 05:38:03 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 05:38:03 INFO - Running setup.py install for mozscreenshot 05:38:03 INFO - Running setup.py install for moztest 05:38:03 INFO - Running setup.py install for mozversion 05:38:03 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 05:38:03 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 05:38:03 INFO - Cleaning up... 05:38:03 INFO - Return code: 0 05:38:03 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:38:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:38:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:38:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:38:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:38:03 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x9db1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xba6a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd49f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd47130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd48030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd484c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/config', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:38:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/config/mozbase_requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/config 05:38:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/config/mozbase_requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:38:03 INFO - Using env: {'DISPLAY': ':0', 05:38:03 INFO - 'HOME': '/home/cltbld', 05:38:03 INFO - 'LANG': 'en_US.UTF-8', 05:38:03 INFO - 'LANGUAGE': 'en_US:en', 05:38:03 INFO - 'LOGNAME': 'cltbld', 05:38:03 INFO - 'MAIL': '/var/mail/cltbld', 05:38:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:38:03 INFO - 'MOZ_NO_REMOTE': '1', 05:38:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:38:03 INFO - 'NO_EM_RESTART': '1', 05:38:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:38:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:38:03 INFO - 'PWD': '/builds/slave/test', 05:38:03 INFO - 'SHELL': '/bin/bash', 05:38:03 INFO - 'SHLVL': '1', 05:38:03 INFO - 'TERM': 'linux', 05:38:03 INFO - 'TMOUT': '86400', 05:38:03 INFO - 'USER': 'cltbld', 05:38:03 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 05:38:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:38:03 INFO - '_': '/tools/buildbot/bin/python'} 05:38:04 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:38:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 05:38:04 INFO - Running setup.py (path:/tmp/pip-YE0tG6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 05:38:04 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 05:38:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 05:38:04 INFO - Running setup.py (path:/tmp/pip-QGXZfW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 05:38:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:38:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 05:38:04 INFO - Running setup.py (path:/tmp/pip-50QeaM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 05:38:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 05:38:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 05:38:04 INFO - Running setup.py (path:/tmp/pip-B8jWYW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 05:38:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.51 from file:///builds/slave/test/build/tests/mozbase/mozdevice in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:38:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 05:38:04 INFO - Running setup.py (path:/tmp/pip-Ao0abO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 05:38:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 05:38:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 05:38:04 INFO - Running setup.py (path:/tmp/pip-a8MhcS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 05:38:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 05:38:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 05:38:04 INFO - Running setup.py (path:/tmp/pip-0BvP1V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 05:38:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.10 from file:///builds/slave/test/build/tests/mozbase/mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 7)) 05:38:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 05:38:04 INFO - Running setup.py (path:/tmp/pip-vn3Imb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 05:38:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.13 from file:///builds/slave/test/build/tests/mozbase/mozinstall in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 05:38:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 05:38:04 INFO - Running setup.py (path:/tmp/pip-aoMQL7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 05:38:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 05:38:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 05:38:04 INFO - Running setup.py (path:/tmp/pip-zwnG1O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 05:38:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.5 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:38:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 05:38:04 INFO - Running setup.py (path:/tmp/pip-511e_Q-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 05:38:04 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 05:38:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 05:38:04 INFO - Running setup.py (path:/tmp/pip-8KIisL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 05:38:04 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.25 from file:///builds/slave/test/build/tests/mozbase/mozprocess in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 12)) 05:38:04 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 05:38:04 INFO - Running setup.py (path:/tmp/pip-25m42E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 05:38:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 05:38:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 05:38:05 INFO - Running setup.py (path:/tmp/pip-234BPT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 05:38:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 05:38:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 05:38:05 INFO - Running setup.py (path:/tmp/pip-yo4NPr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 05:38:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 05:38:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 05:38:05 INFO - Running setup.py (path:/tmp/pip-8tJ8S2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 05:38:05 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 from file:///builds/slave/test/build/tests/mozbase/moztest in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 16)) 05:38:05 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 05:38:05 INFO - Running setup.py (path:/tmp/pip-Ba4VuL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 05:38:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 05:38:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:38:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 05:38:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 05:38:05 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:38:05 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.19 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdevice==0.51->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 05:38:05 INFO - Requirement already satisfied (use --upgrade to upgrade): requests in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozInstall==1.13->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 8)) 05:38:05 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 05:38:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:38:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:38:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:38:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:38:06 INFO - Downloading blessings-1.6.tar.gz 05:38:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 05:38:06 INFO - Installing collected packages: blessings 05:38:06 INFO - Running setup.py install for blessings 05:38:06 INFO - Successfully installed blessings 05:38:06 INFO - Cleaning up... 05:38:06 INFO - Return code: 0 05:38:06 INFO - Done creating virtualenv /builds/slave/test/build/venv. 05:38:06 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:38:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:38:06 INFO - Reading from file tmpfile_stdout 05:38:06 INFO - Current package versions: 05:38:06 INFO - argparse == 1.2.1 05:38:06 INFO - blessings == 1.6 05:38:06 INFO - blobuploader == 1.2.4 05:38:06 INFO - docopt == 0.6.1 05:38:06 INFO - functools32 == 3.2.3-2 05:38:06 INFO - jsonschema == 2.5.1 05:38:06 INFO - manifestparser == 1.1 05:38:06 INFO - mozInstall == 1.13 05:38:06 INFO - mozcrash == 1.0 05:38:06 INFO - mozdebug == 0.1 05:38:06 INFO - mozdevice == 0.51 05:38:06 INFO - mozfile == 1.2 05:38:06 INFO - mozhttpd == 0.7 05:38:06 INFO - mozinfo == 0.10 05:38:06 INFO - mozleak == 0.1 05:38:06 INFO - mozlog == 3.5 05:38:06 INFO - moznetwork == 0.27 05:38:06 INFO - mozprocess == 0.25 05:38:06 INFO - mozprofile == 0.28 05:38:06 INFO - mozrunner == 6.13 05:38:06 INFO - mozscreenshot == 0.1 05:38:06 INFO - mozsystemmonitor == 0.3 05:38:06 INFO - moztest == 0.8 05:38:06 INFO - mozversion == 1.4 05:38:06 INFO - psutil == 3.1.1 05:38:06 INFO - requests == 1.2.3 05:38:06 INFO - wsgiref == 0.1.2 05:38:06 INFO - Installing None into virtualenv /builds/slave/test/build/venv 05:38:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:38:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:38:06 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:38:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:38:06 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x9db1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xba6a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd49f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd47130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd48030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd484c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build/tests/talos', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:38:06 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '-r', '/builds/slave/test/build/tests/talos/requirements.txt', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub'] in /builds/slave/test/build/tests/talos 05:38:06 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 -r /builds/slave/test/build/tests/talos/requirements.txt --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 05:38:06 INFO - Using env: {'DISPLAY': ':0', 05:38:06 INFO - 'HOME': '/home/cltbld', 05:38:06 INFO - 'LANG': 'en_US.UTF-8', 05:38:06 INFO - 'LANGUAGE': 'en_US:en', 05:38:06 INFO - 'LOGNAME': 'cltbld', 05:38:06 INFO - 'MAIL': '/var/mail/cltbld', 05:38:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:38:06 INFO - 'MOZ_NO_REMOTE': '1', 05:38:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:38:06 INFO - 'NO_EM_RESTART': '1', 05:38:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:38:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:38:06 INFO - 'PWD': '/builds/slave/test', 05:38:06 INFO - 'SHELL': '/bin/bash', 05:38:06 INFO - 'SHLVL': '1', 05:38:06 INFO - 'TERM': 'linux', 05:38:06 INFO - 'TMOUT': '86400', 05:38:06 INFO - 'USER': 'cltbld', 05:38:06 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 05:38:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:38:06 INFO - '_': '/tools/buildbot/bin/python'} 05:38:07 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:38:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:38:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 05:38:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 05:38:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 05:38:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 05:38:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 05:38:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 05:38:07 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 05:38:07 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 05:38:07 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 05:38:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:38:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:38:07 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 05:38:07 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 05:38:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 05:38:08 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 05:38:08 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 05:38:08 INFO - Installing collected packages: simplejson 05:38:08 INFO - Running setup.py install for simplejson 05:38:08 INFO - building 'simplejson._speedups' extension 05:38:08 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c simplejson/_speedups.c -o build/temp.linux-x86_64-2.7/simplejson/_speedups.o 05:38:09 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/simplejson/_speedups.o -o build/lib.linux-x86_64-2.7/simplejson/_speedups.so 05:38:09 INFO - Successfully installed simplejson 05:38:09 INFO - Cleaning up... 05:38:09 INFO - Return code: 0 05:38:09 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 05:38:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:38:09 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 05:38:09 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:38:09 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 05:38:09 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x9db1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xba6a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xd49f90>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd47130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd48030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd484c0>, 'level': 'critical'}], 'cwd': '/builds/slave/test/build', 'env': {'LANG': 'en_US.UTF-8', 'TERM': 'linux', 'SHELL': '/bin/bash', 'MOZ_NO_REMOTE': '1', 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 05:38:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 05:38:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 05:38:09 INFO - Using env: {'DISPLAY': ':0', 05:38:09 INFO - 'HOME': '/home/cltbld', 05:38:09 INFO - 'LANG': 'en_US.UTF-8', 05:38:09 INFO - 'LANGUAGE': 'en_US:en', 05:38:09 INFO - 'LOGNAME': 'cltbld', 05:38:09 INFO - 'MAIL': '/var/mail/cltbld', 05:38:09 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:38:09 INFO - 'MOZ_NO_REMOTE': '1', 05:38:09 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:38:09 INFO - 'NO_EM_RESTART': '1', 05:38:09 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:38:09 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:38:09 INFO - 'PWD': '/builds/slave/test', 05:38:09 INFO - 'SHELL': '/bin/bash', 05:38:09 INFO - 'SHLVL': '1', 05:38:09 INFO - 'TERM': 'linux', 05:38:09 INFO - 'TMOUT': '86400', 05:38:09 INFO - 'USER': 'cltbld', 05:38:09 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 05:38:09 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:38:09 INFO - '_': '/tools/buildbot/bin/python'} 05:38:09 INFO - Ignoring indexes: https://pypi.python.org/simple/ 05:38:09 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 05:38:09 INFO - Cleaning up... 05:38:09 INFO - Return code: 0 05:38:09 INFO - Running post-action listener: _resource_record_post_action 05:38:09 INFO - Running post-action listener: _start_resource_monitoring 05:38:09 INFO - Starting resource monitoring. 05:38:09 INFO - [mozharness: 2017-08-21 12:38:09.626490Z] Finished create-virtualenv step (success) 05:38:09 INFO - [mozharness: 2017-08-21 12:38:09.627011Z] Running install step. 05:38:09 INFO - Running pre-action listener: _resource_record_pre_action 05:38:09 INFO - Running main action method: install 05:38:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 05:38:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 05:38:09 INFO - Reading from file tmpfile_stdout 05:38:09 INFO - Detecting whether we're running mozinstall >=1.0... 05:38:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 05:38:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 05:38:09 INFO - Reading from file tmpfile_stdout 05:38:09 INFO - Output received: 05:38:09 INFO - Usage: mozinstall [options] installer 05:38:09 INFO - Options: 05:38:09 INFO - -h, --help show this help message and exit 05:38:09 INFO - -d DEST, --destination=DEST 05:38:09 INFO - Directory to install application into. [default: 05:38:09 INFO - "/builds/slave/test"] 05:38:09 INFO - --app=APP Application being installed. [default: firefox] 05:38:09 INFO - mkdir: /builds/slave/test/build/application 05:38:09 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 05:38:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 05:38:27 INFO - Reading from file tmpfile_stdout 05:38:27 INFO - Output received: 05:38:27 INFO - /builds/slave/test/build/application/firefox/firefox 05:38:27 INFO - Running post-action listener: _resource_record_post_action 05:38:27 INFO - [mozharness: 2017-08-21 12:38:27.980736Z] Finished install step (success) 05:38:27 INFO - [mozharness: 2017-08-21 12:38:27.980974Z] Running setup-mitmproxy step. 05:38:27 INFO - Running pre-action listener: _resource_record_pre_action 05:38:27 INFO - Running main action method: setup_mitmproxy 05:38:27 INFO - Skipping: mitmproxy is not required 05:38:27 INFO - Running post-action listener: _resource_record_post_action 05:38:27 INFO - [mozharness: 2017-08-21 12:38:27.981653Z] Finished setup-mitmproxy step (success) 05:38:27 INFO - [mozharness: 2017-08-21 12:38:27.981874Z] Running run-tests step. 05:38:27 INFO - Running pre-action listener: _resource_record_pre_action 05:38:27 INFO - Running pre-action listener: _set_gcov_prefix 05:38:27 INFO - Running main action method: run_tests 05:38:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 05:38:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 05:38:27 INFO - Python 2.7.3 05:38:27 INFO - Return code: 0 05:38:27 INFO - grabbing minidump binary from tooltool 05:38:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 05:38:27 INFO - retry: Calling run_command with args: (['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'],), kwargs: {'output_timeout': 600, 'error_list': [{'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd47130>, 'level': 'warning'}, {'substr': 'Traceback (most recent call last)', 'level': 'error'}, {'substr': 'SyntaxError: ', 'level': 'error'}, {'substr': 'TypeError: ', 'level': 'error'}, {'substr': 'NameError: ', 'level': 'error'}, {'substr': 'ZeroDivisionError: ', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xd48030>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xd484c0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 05:38:27 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 05:38:27 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 05:38:27 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 05:38:28 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 05:38:28 INFO - Return code: 0 05:38:28 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 05:38:28 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 05:38:28 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 05:38:28 INFO - ENV: RUST_BACKTRACE is now full 05:38:28 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 05:38:28 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 05:38:28 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-004', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 05:38:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-004 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 05:38:28 INFO - Using env: {'DISPLAY': ':0', 05:38:28 INFO - 'HOME': '/home/cltbld', 05:38:28 INFO - 'LANG': 'en_US.UTF-8', 05:38:28 INFO - 'LANGUAGE': 'en_US:en', 05:38:28 INFO - 'LOGNAME': 'cltbld', 05:38:28 INFO - 'MAIL': '/var/mail/cltbld', 05:38:28 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 05:38:28 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 05:38:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 05:38:28 INFO - 'MOZ_NO_REMOTE': '1', 05:38:28 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 05:38:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 05:38:28 INFO - 'NO_EM_RESTART': '1', 05:38:28 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 05:38:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 05:38:28 INFO - 'PWD': '/builds/slave/test', 05:38:28 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 05:38:28 INFO - 'RUST_BACKTRACE': 'full', 05:38:28 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 05:38:28 INFO - 'SHELL': '/bin/bash', 05:38:28 INFO - 'SHLVL': '1', 05:38:28 INFO - 'STYLO_FORCE_ENABLED': '1', 05:38:28 INFO - 'TERM': 'linux', 05:38:28 INFO - 'TMOUT': '86400', 05:38:28 INFO - 'USER': 'cltbld', 05:38:28 INFO - 'XDG_SESSION_COOKIE': 'c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778', 05:38:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 05:38:28 INFO - '_': '/tools/buildbot/bin/python'} 05:38:28 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-004', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 05:38:28 INFO - mozversion application_buildid: 20170821114050 05:38:28 INFO - mozversion application_changeset: ecf9cc9bfca0853c22f7cf78a88b5762a002164e 05:38:28 INFO - mozversion application_display_name: Nightly 05:38:28 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 05:38:28 INFO - mozversion application_name: Firefox 05:38:28 INFO - mozversion application_remotingname: firefox 05:38:28 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 05:38:28 INFO - mozversion application_vendor: Mozilla 05:38:28 INFO - mozversion application_version: 57.0a1 05:38:28 INFO - mozversion platform_buildid: 20170821114050 05:38:28 INFO - mozversion platform_changeset: ecf9cc9bfca0853c22f7cf78a88b5762a002164e 05:38:28 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 05:38:28 INFO - mozversion platform_version: 57.0a1 05:38:28 INFO - using testdate: 1503319108 05:38:28 INFO - actual date: 1503319108 05:38:28 INFO - starting webserver on 'localhost:40814' 05:38:28 INFO - SUITE-START | Running 2 tests 05:38:28 INFO - TEST-START | dromaeo_css 05:38:28 INFO - Initialising browser for dromaeo_css test... 05:38:28 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:40814/getInfo.html -profile /tmp/tmpN9ALjM/profile 05:38:28 INFO - TEST-INFO | started process 12501 (/builds/slave/test/build/application/firefox/firefox http://localhost:40814/getInfo.html) 05:38:33 INFO - TEST-INFO | 12501: exit 0 05:38:34 INFO - Browser initialized. 05:38:34 INFO - Running cycle 1/1 for dromaeo_css test... 05:38:34 INFO - TEST-INFO | started process 12687 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpN9ALjM/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 05:38:35 INFO - PID 12687 | 05:38:35 INFO - PID 12687 | (/builds/slave/test/build/application/firefox/firefox:12736): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 05:38:35 INFO - PID 12687 | 05:38:35 INFO - PID 12687 | 05:38:35 INFO - PID 12687 | (/builds/slave/test/build/application/firefox/firefox:12796): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 05:38:35 INFO - PID 12687 | 05:38:35 INFO - PID 12687 | __metrics Screen width/height:1600/1200 05:38:35 INFO - PID 12687 | colorDepth:24 05:38:35 INFO - PID 12687 | Browser inner width/height: 1024/768 05:38:35 INFO - PID 12687 | __metrics 05:38:45 INFO - PID 12687 | RSS: Main: 174407680 05:38:45 INFO - PID 12687 | 05:41:43 INFO - PID 12687 | Cycle 1(1): loaded http://localhost:40814/tests/dromaeo/cssquery-dojo.html (next: http://localhost:40814/tests/dromaeo/cssquery-ext.html) 05:41:45 INFO - PID 12687 | RSS: Main: 178708480 05:41:45 INFO - PID 12687 | 05:44:47 INFO - PID 12687 | Cycle 1(1): loaded http://localhost:40814/tests/dromaeo/cssquery-ext.html (next: http://localhost:40814/tests/dromaeo/cssquery-jquery.html) 05:44:48 INFO - PID 12687 | RSS: Main: 175226880 05:44:48 INFO - PID 12687 | 05:47:50 INFO - PID 12687 | Cycle 1(1): loaded http://localhost:40814/tests/dromaeo/cssquery-jquery.html (next: http://localhost:40814/tests/dromaeo/cssquery-mootools.html) 05:47:50 INFO - PID 12687 | RSS: Main: 177520640 05:47:50 INFO - PID 12687 | 05:50:52 INFO - PID 12687 | Cycle 1(1): loaded http://localhost:40814/tests/dromaeo/cssquery-mootools.html (next: http://localhost:40814/tests/dromaeo/cssquery-prototype.html) 05:50:53 INFO - PID 12687 | RSS: Main: 175640576 05:50:53 INFO - PID 12687 | 05:53:56 INFO - PID 12687 | Cycle 1(1): loaded http://localhost:40814/tests/dromaeo/cssquery-prototype.html (next: http://localhost:40814/tests/dromaeo/cssquery-yui.html) 05:53:57 INFO - PID 12687 | RSS: Main: 179273728 05:53:57 INFO - PID 12687 | 05:56:59 INFO - PID 12687 | Cycle 1(1): loaded http://localhost:40814/tests/dromaeo/cssquery-yui.html (next: http://localhost:40814/tests/dromaeo/cssquery-dojo.html) 05:56:59 INFO - PID 12687 | RSS: Main: 179470336 05:56:59 INFO - PID 12687 | 05:56:59 INFO - PID 12687 | __start_tp_report 05:56:59 INFO - PID 12687 | _x_x_mozilla_page_load 05:56:59 INFO - PID 12687 | _x_x_mozilla_page_load_details 05:56:59 INFO - PID 12687 | |i|pagename|runs| 05:56:59 INFO - PID 12687 | |0;dojo.html;3175.2220705927066;3185.347003864208;3199.2481766784804;3200.5359222912675;3223.6937490938367;6243.500519958404;6262.874742505147;6263.718132684029;6289.993601023837;6309.1482649842255;6143.32423433422;6232.750689972407;6237.3450787667325;6241.344658810816;6243.125962365272;5650.350209725872;5689.8577535561635;5709.942900570983;5728.112142617901;5788.971055144719;5805.912911306313;5806.506446951993;5808.622439541437;5823.941760582404;5873.030949893284;5633.746481408347;5744.971275143618;5785.103308987113;5836.328822185439;5868.325142608612;5668.149777533403;5684.346300175492;5769.624974376652;5783.739731712083;5801.767929282823;5631.746571404296;5660.85847853807;5732.484076433099;5737.540996720252;5744.798932037359;6028.276606807167;6138.84652883677;6169.691515424211;6213.782517611907;6221.004639257697;6721.6975236114;6726.327367263283;6759.831004224885;6770.966145169292;6778.152730908637;6772.356626120511;6835.179778426571;6845.623490708009;6847.863042739167;6884.827879303008;6211.503079753654;6212.844678882973;6270.278917924452;6303.46420554258;6321.715522801485;6716.764913228014;6785.796426107225;6900.171979362509;6906.136732908387;6971.477139214579;6434.292227854932;6450.838729031718;6522.576032557963;6549.6070235786;6573.737050517926;6577.750227456768;6670.933290667128;6694.765683201162;6707.53047286695;6721.092652491949;6592.538522303393;6616.239132499824;6683.164604424447;6694.464442844561;6697.095892054608;6577.769778057745;6624.072629831828;6687.732490700318;6688.398044176048;6693.899591506131;5349;5350.304460420199;5355.116405793078;5408.7566059526625;5471.863203419866;4627.5603817637275;4713.269443236304;4716.764161791897;4717.292406139107;4808.687435316693;5701.629394089454;5771.509421699118;5780.653160810365;5825.126231065289;5837.88324233513;6583.242927063353;6639.701213445406;6651.833704157338;6743.022261772016;6796.558223715443;5722.570807189478;5739.913901291484;5750.281214848144;5776.960147173465;5802.796902108406;5879.5002424794375;5908.497777688859;5957.76168953237;5965;5975.282966044103;6525;6558.672066396661;6566.080748695091;6572.441342485942;6624.56940298879;6714.060031595678;6767.796966091025;6780.796576102724;6827.829304267234;6869.690863911036;6419.390157934989;6505.121808555785;6533.379328963931;6581.967090164519;6614.735410583523;6543.738250470118;6550.868982620416;6611.702473388613;6613.941769316886;6617.239017513048;6701.1623547056615;6706.362895524917;6711.161104861892;6714.764983225564;6763.425108865605;6516.674166291572;6561.770338038145;6566.212054553484;6579.901301480578;6593.241777195492;6501.284858665448;6567.671616419256;6571.34286571339;6585.209774827052;6589.5387322888855;6356.586821856565;6412.61524308543;6460.3862633049785;6461.224653041665;6464.321246269262;6510.609363438209;6564.770233041821;6575.967120164369;6584.604923704593;6608.471322294301;6357.554971151975;6367.554271201157;6389.456896163878;6395.808125756234;6397 05:56:59 INFO - PID 12687 | |1;ext.html;741.5180132913606;818.8444195602837;825.8802473641322;849.3035710717206;1182.308349615475;28693.282667933312;30184.849075754617;40248.39627405588;41207.17585648285;41311.79344103283;41652;41940.58059419405;41975.58024419755;41975.79012104935;42099.368509472384;7654.234576542357;7683.884741728879;7824.061112666488;7825.295723384894;7866;7680.731174408897;7794.8441031179345;7795.376369890395;7799.6880124795225;7800.375969922393;7795.9220407795765;7823.921760782405;7824.374050076009;7829.960850195769;7850.9214907850765;7755;7784.455088143832;7798.298153166185;7806.4925779824125;7811.882821757678;7710.421718371144;7773.96113019437;7777.650005749755;7778.183290754502;7780.688772449095;37772;37824.81087594572;37929.62070379288;37959;38043.8097809512;3502.176988407722;3541.34485120251;3550.396432606463;3553.307105114504;3555.6622120898473;30637.234069148228;30761;30825.84587077073;30908.072757817077;30937.226569335722;5016.523430274155;5038.647294689373;5077.822276220351;5078.847634570969;5092.465291144414;189532;189867;190794;190837;191231;47224.52775472201;47313.76343118331;47436.76281618639;47440;47488.86300116503;48949.265761013616;48997.26504102441;49097.75451122793;49122.75438622784;49243.26135107976;13859;15719.68560628804;15965.840341596668;16158.75761863573;16160.353585856668;11571.42142892852;12953.676158095934;13073.673158171121;13092.476300947856;13108.279044652445;13830.792538111937;13850.099743516841;13913.165210087427;13985.79021314681;14063.648408789863;5779.624324418899;5814.476697097197;5863.824085277449;5873.853153671193;5875.853103672443;1001.1190152665607;1011.5650270383805;1014.9594016239415;1021.3514418344405;1032.390889375272;22848.086076557083;22908.656370154462;23013.19453819142;23042.423939401313;23223.883880580488;1110.7667389848061;1113.693734223079;1121.3720316622555;1126.6282126898104;1138.9031932285848;11814.822777658343;12166.965807906427;12203.221068877141;12277.815832762515;15762.842371576138;251144;252282;252460;252560;253514;52623.21065184025;52936;53032.73483632557;53245;54243.72878135663;1453.8473460286518;1456.7013762178728;1462.546610550754;1475.9852401475848;1477.5124209011;26549.469010620065;27273.45453090967;27463.588046179724;27813;27898.44203115967;36366.27267454689;36912.44631330478;37097;37156.814215928745;37225;208979;210233;211008;211635;212046;33941.66058339385;36098;37745.24509509849;37792.43311350387;37844;44901.77549112234;45298.32052519281;45474.31788523241;45868.54131458643;46139.30791038204;33670.32659346848;34040.65959340474;34167.82916085404;34287.82856085704;34639.480407794406;33143.502847456824;33506.83246583751;33583.32833343368;33767.4934875982;34516.48225276673;35680.82159589185;36967;37024.44463333106;37070;37336.253274933806;31970.20074498063;32435.35129297448;32527.67472325341;32564.51153232656;32881.835590821895;23291.417714557272;23997.400064998514;24782;25114;25134 05:56:59 INFO - PID 12687 | |2;jquery.html;557.7601631298545;559.6110703061371;569.1803802524367;574.6781802190774;594.7383151413378;22098.779012209874;22908.65637015444;22987.08051677933;22998.770012299872;23055.654165187534;26434.735652643467;26939.86530067352;26987.730122698766;27024.05415810447;27055.053073142444;6321.999999999988;6436.645984470852;6445.355464453564;6449.35506449356;6481.027845823117;6144.8156555303185;6253.906191407133;6387.712552935129;6420.06908998195;6428.389303016206;6399.296077431502;6402.359764023584;6405.167328247321;6421.678916054202;6426.228852537702;6371.681415929208;6380.649064301461;6392.968035159794;6408.423241908227;6421.8073457796345;5945.672987985659;5964.671943043131;5968.7910923117915;5970.074638431007;5984.162217289583;29700.257493562618;29868;30495.542566861513;30582.388352233054;30601.693983060108;1886.2549293029315;1921.9231230750754;1925.0663428237294;1927.0557426860878;1928.8553358498168;19289.903550482297;19898.502537436536;19900.502487437785;19924.402267931986;19990.200391984305;2185.836062295334;2204.4599073227;2242.7532971373134;2245.8989345479495;2332.125452955142;138459;146188;146923.26538367345;147019;147047.52952470444;14776.92611536957;15089.622759431102;15168.620784480476;15236.923815380853;15310.617234569225;22899.542009159723;23898.88050559736;23935.52128957411;24087.397815054414;24259;10417.374957502423;10465.895341046493;10615;10634.255602107778;10793.244472886823;9635.903640963501;9643.614255429704;9661.372010819416;9874.160696340892;9890.456024918698;9360.672376466928;9443.433393996382;9460.385074970105;9672.661456849117;9719.854202186973;2580.8838602262945;2598.4153565448;2687.479401983408;2736.097087960968;2780.708025657317;945.9148676619137;957.7366224288237;973.4402718436786;985.3989066669326;987.521052289639;19857.404277871687;20002.39992800218;20267.493312667008;20592.897035514725;20882.164713411294;1025.707673313117;1032.4476405123373;1034.1519953637944;1039.1946241662772;1049.3284298049255;11131.109371650326;11300.321980681021;11405.543778248943;11459;11495.677997030449;478379;515341;515902;521386;526658;117351;123975;127217.36391317984;127840.36079819727;128070;1214.3563911127117;1259.6787819106253;1276.368197742105;1277.4698500122345;1286.1318609938255;20836.27073052436;21011.159553618294;21049.47376315543;21347.46631334229;21541.676874846577;58701;59965;60346.698266508385;61152.694236528536;61851;70575;70774.29225707884;71546.28453715604;71681.6415917917;74910.62544687242;14293.928530357281;14732.263386830402;14760.63098422548;14836.258187090387;14876.107433554022;22879.31362059141;23181.88409057944;23210;23412.648810267518;23513.64729529024;18196.81803181951;18366.632667346847;18660.2535898568;18688.719669205246;19561.315353962542;17269.740953885954;17549.385771497935;17743;17863.553411164306;18487;19411.51471213231;19791.406257811712;19876.801231987494;19991.40025799228;20014.799852001877;14816.40734370613;15010.624734381729;15147.924260378628;15148;15259.618509537351;19291.903540482206;19388;19423.805761942764;19477.415677529698;19508.804911950698 05:56:59 INFO - PID 12687 | |3;mootools.html;1359.6532884114552;1393.400837639815;1424.0814674534925;1431.8424973252934;1432.3983926750757;14361.640958976031;14539.400665926765;14816.925915370408;15006;15008.324625391857;14984.10095394277;15203.771943420857;15270;15281;15311.234438278098;2678.2367025397716;2725.6592925884265;2726.086760935089;2727.0319036741967;2727.2500062482877;2658.1626787561954;2709.6612923384578;2754.752072313491;2760.903368382107;2769.57071653894;2646.1796842978642;2697.716739742328;2699.784017278613;2701.149138021517;2712.3083613678486;2624.3176774038793;2625.514279858223;2643.629891815138;2647.2587675450904;2648.841069535834;2567.9214729813525;2575.9098431554994;2577.7626739165307;2596.688397392325;2600.7919366450637;14196.219207943559;14433.927830360886;14509.564713058626;14569.490067847575;14583.635409114751;7288.6720097595735;7551.546907185587;7555.2067032961295;7560.962195189044;7575.09098908129;5147.897042059175;5195.142801437796;5237.73811309433;5362.597805164628;5392.379876314196;1799.9910000450045;1813.1206364913007;1818.7453756474104;1878.0985127138913;1880.0881572437493;23913.64129538041;24251;24369.390765230833;24392.87803560971;24504.142355017488;6263.154474146023;6366.204224471941;6378;6589.604623722592;6601.73593056282;16132.112733799519;16204.675906481805;16274.186290685655;16287.104209268367;16307.83692163087;7550.697972081055;7650.081990161217;7733.8453230935065;7734.690612375554;7739.458237923404;5912.615679980788;6058.848528786727;6343.651099189589;6933.68798404073;7060.7881763547175;5049.848504544796;5175.120229560984;5227.451117632594;5254.185601231815;5301.946980530222;1505.2548988250885;1535.332130523226;1538.438469958457;1558.789563408948;1576.1646327446472;875.6759998800485;895.4582477600958;900.3742399032609;905.1898550797132;906.9410488318238;7319.560826350329;7334.229905859915;7351.558906465629;7368.373688236453;7383.704651813868;718.6334969165658;724.0587236592409;724.4385601159144;727.3635568877232;727.6107282603782;4528.7509186994375;4574.405327307495;5289.629725919226;5297.523222909879;5343.332083489564;20025.599488010157;20888.791112088988;20964.89517552433;20977.056032478577;21065.684014739792;19790;20008.39974800758;20314.085866136058;20352.796472035385;20362.28731994373;10796.838047429295;11039.558417663364;11131.554737810397;11171.553137874556;11199.832002519968;7950.562719050507;8183.468074575134;8242.587870606565;8472.618732156945;8516.829663406821;17133.828661713724;17184.570385740455;17468.563285917953;17674;17801.910990444965;17766.378176763752;17840.643187136444;17997.460076197734;18005.459836204413;18640.161192746087;11488.310701357945;11765.588204413147;11904.404779761151;11904.58333958342;11907.583234586747;13142.60572182836;13340.599782006555;13468.730625387241;13479.19124852512;13497.662558436117;9727;9767.365121267096;9966.152877005536;9973.401595904268;10102.545385457819;10250.487475626338;10278.280520363802;10309.278350515391;10476.63331783384;10683.465826708789;8541.359398045048;8712.21590056898;8842.292616590787;9003.864942026006;9107.08929107084;6732.495062870206;6946.0622815919205;7013.4038606719005;7016.052832867702;7017.7192912282935;6974.755883544051;6987.231404545598;7008.614526201108;7052.330028647476;7092.751753688596 05:56:59 INFO - PID 12687 | |4;prototype.html;491.19029538704046;501.8134843742237;517.1260569637312;520.6433592988806;520.9114450543407;6134.969325153379;6181.083864002162;6197.845053873655;6199.163112979746;6206.6586337751405;5808.5023439920815;6004.159417681517;6016.548758843082;6057.969710151443;6102.694865256742;4938.382702162221;4940.530649588283;4951.405831300249;4968.130577149002;4984.806685058581;4967.602591792666;4975.7263350515705;4984.383198820612;4999.350084489011;5002.799888004475;4810.374651295344;4941.382327209099;4960.429550601672;4960.6527543072;4967.329410529568;4922.409310882699;4925.975370123145;4975.502449754996;4976.527229913152;4977.278294647292;4396.186705459469;4455.529675207206;4469.7651174412795;4496.64026877849;4518.638508919312;6061.121137435091;6065.090236464522;6074.271087469488;6086.421789929949;6118.724657390384;5682.232898558683;5694.117411801178;5733.340665823442;5745.983358736697;5767.88464230713;6383.585066970632;6471.1587493626;6503.512236582275;6528.902066469007;6551.213854337462;4798.4001999750035;4845.546336099156;4850.5877000455;4867.7322747249245;4876.707397556158;6727.293634168391;6799.11611490508;6802.693878775467;6874.2094659113845;6956.756513522002;4880.731559764247;4889.779959901813;4967.403911530567;4997.750112494434;5009.599232061426;5082.170418649283;5094.700851282899;5094.796208151706;5130.281760553451;5139.58883289336;5653.971730141323;5696.322728317684;5706.9429305707245;5726.398728133569;5761.53907687384;6493.480521558264;6550.377714117151;6552.180977377828;6571.901421478682;6597.439217666552;1611.7508930578895;1657.676753033171;1710.598009467774;1732.9913350433167;1760.1815155952543;1199.6580974422423;1212.0243204220687;1218.975620487603;1225.8467691538558;1235.5737270641614;5724.341700704389;5730.36965933747;5762.30852297727;5777.94222057774;5778.971105144447;6532.575382600211;6556.672166391661;6573.638449885207;6616.900746488806;6648.900266496006;5666.6400063985175;5698.430156984268;5761.868108799771;5773.162891380726;5808.215890854765;3532.947005794915;3559.661832125944;3588.7129029678085;3603.4955106285142;3609.4766258892314;6499.805005849832;6526.771562995273;6540.672966351759;6559.376859198369;6563.8359041023405;6723.193216814014;6777.120473259245;6818.386345228854;6895.965520172467;6950.235474097845;6461.515386346043;6468.870622587522;6514.57655252407;6545.247296560861;6603.537752357289;6652.667366631552;6662.700178492077;6666.366695163952;6688.732450702112;6766.1920303073675;6612.305707900601;6646.468282537482;6652.567583107082;6657.3009833966735;6721.529492935448;6449.935500644933;6450.225972883284;6508.967455162694;6582.539222254588;6599.703013364314;5375.274337964481;5476.3702174250475;5490.945090549043;5504.6421982571;5517.448255174611;6586.81437341264;6660.733570657313;6674.733010679518;6731.610278351311;6780.355866192704;6358.904616430665;6424.293327734039;6461.127747753993;6477.384648458389;6479.028145778171;6207.81376558704;6337.936620633919;6357.745690172342;6360.109584658244;6371.267304259884;6083.209182806207;6365.299817020032;6417.582857114273;6447.967760161357;6479.416852483299;6616.569922954993;6617.569857959217;6626.304238055128;6648.634325112165;6652.37659826416;6220.906686399617;6379.138816259746;6383.904241436289;6389.2971773105855;6425.293217746138 05:56:59 INFO - PID 12687 | |5;yui.html;908.4776253654146;921.341241012676;931.0968360690129;936.4474959773733;944.2540393089457;17623.735643965334;18267.451976440694;18306.08469576521;18355.449336519894;18369.816301836978;20788.584228315423;22616.09535618573;22813.4296642584;22816.20143294985;22866.199683011055;1022.2435397805626;1043.446973104256;1046.1317106801337;1051.1170616681986;1052.5684469367561;977.2670497127154;1057.1542765787378;1057.8730552333732;1058.978820423595;1059.5391004912888;1103.1505740579748;1105.4362275239646;1111.9110471162328;1116.6482557994245;1116.8213085906257;1100.9980917365199;1103.7516558774212;1105.618561596256;1116.2521110855705;1119.160629527854;816.3346872299057;817.9550124743137;820.9220124088203;821.0885916632533;821.2813787935556;18612.441626751082;18911.14899829511;19018.049097545205;19032.143553540125;19090.23639054436;19504.804951950442;19872.403827885188;19885.60228795416;19995.700064499044;20101.396958091136;16139.193040347936;16149.515514534583;16259;16334.101624410652;16824.663506729918;3676.963230367689;3703.0187000444903;3706.5181526401393;3706.592274849764;3712.3874560697454;133071;134045;134088;136455.999999999;137062.3146884269;17202.22589983454;17365.7395139073;17440.12799360027;17448.47654570365;17518.737218941726;31654.36691266162;31718;32348.83825580904;32595.348093038006;32790;8487.10885357041;8494;8569.657213711382;8572.057073721886;8877.822443551222;3623.1847834237615;3766.37854753968;4183.079722461053;4284.378765079046;4289.24938135825;5926.377730338339;6116.5718399711595;6136.6011209271255;6149.200603921461;6154.1999540059505;1071.6249312740633;1092.4756117063853;1119.2333251722434;1120.1151090638305;1121.327203677803;638.2532437048665;655.7868692674899;660.96364699941;663.2140913018089;675.152683382352;11080.390578518098;11363.261388009752;11514.76970460603;11879.70300742471;12129.87870121305;649.7368565730886;663.4360793325731;669.6484345718537;680.343468552839;691.4261163234503;4901.705897646081;4908.460069392364;5050.722210278396;5109.948900510947;5150.6137039721425;111281.44359278152;112253.43873280581;112439.43780281047;114421;115065;101251;102484;104359;105400;108394;87963;88900.5554972221;89375.55312223527;91177;92639;9439.433633981984;9443.480608566595;9514.666986655433;9611.134997849947;9762.02379762018;40047.1990560193;40273.395899062125;41258.174836502505;42623.78688106663;42952.140957181306;51315.743421282656;51381;52054;53555.46444535505;53785;14076.788848167082;14330.21183834899;14426.639334016314;14544.563663090124;14570.781438278222;14951.476698315506;16028.278727457526;16170.595735106717;16206.756898646294;19182.232710691416;16457.259423326217;16514.504564863073;16564.585885352964;16585.336586536403;16675.66648667044;16741.665166696843;16803.66392672164;16825.663486730442;16971.830281697024;17032.233549490054;16527.421540246032;16577.66844663076;16602.75095873587;16741.665166696843;16795.91602041982;12278.877211227773;12552.623421297376;12573.559925402567;12711.237325760114;12761.872381276069;13093.934530327288;13129.080964332405;13181.209127452383;13488.393022313823;13562.59312220635 05:56:59 INFO - PID 12687 | __end_tp_report 05:56:59 INFO - PID 12687 | __start_cc_report 05:56:59 INFO - PID 12687 | _x_x_mozilla_cycle_collect,374 05:56:59 INFO - PID 12687 | __end_cc_report 05:56:59 INFO - PID 12687 | __startTimestamp1503320219602__endTimestamp 05:56:59 INFO - PID 12687 | 05:56:59 INFO - PID 12687 | ------- Summary: start ------- 05:56:59 INFO - PID 12687 | Number of tests: 6 05:56:59 INFO - PID 12687 | 05:56:59 INFO - PID 12687 | [#0] dojo.html Cycles:165 Average:6174.89 Median:6419.39 stddev:720.19 (11.2%) stddev-sans-first:682.87 05:56:59 INFO - PID 12687 | Values: 3175.2 3185.3 3199.2 3200.5 3223.7 6243.5 6262.9 6263.7 6290.0 6309.1 6143.3 6232.8 6237.3 6241.3 6243.1 5650.4 5689.9 5709.9 5728.1 5789.0 5805.9 5806.5 5808.6 5823.9 5873.0 5633.7 5745.0 5785.1 5836.3 5868.3 5668.1 5684.3 5769.6 5783.7 5801.8 5631.7 5660.9 5732.5 5737.5 5744.8 6028.3 6138.8 6169.7 6213.8 6221.0 6721.7 6726.3 6759.8 6771.0 6778.2 6772.4 6835.2 6845.6 6847.9 6884.8 6211.5 6212.8 6270.3 6303.5 6321.7 6716.8 6785.8 6900.2 6906.1 6971.5 6434.3 6450.8 6522.6 6549.6 6573.7 6577.8 6670.9 6694.8 6707.5 6721.1 6592.5 6616.2 6683.2 6694.5 6697.1 6577.8 6624.1 6687.7 6688.4 6693.9 5349.0 5350.3 5355.1 5408.8 5471.9 4627.6 4713.3 4716.8 4717.3 4808.7 5701.6 5771.5 5780.7 5825.1 5837.9 6583.2 6639.7 6651.8 6743.0 6796.6 5722.6 5739.9 5750.3 5777.0 5802.8 5879.5 5908.5 5957.8 5965.0 5975.3 6525.0 6558.7 6566.1 6572.4 6624.6 6714.1 6767.8 6780.8 6827.8 6869.7 6419.4 6505.1 6533.4 6582.0 6614.7 6543.7 6550.9 6611.7 6613.9 6617.2 6701.2 6706.4 6711.2 6714.8 6763.4 6516.7 6561.8 6566.2 6579.9 6593.2 6501.3 6567.7 6571.3 6585.2 6589.5 6356.6 6412.6 6460.4 6461.2 6464.3 6510.6 6564.8 6576.0 6584.6 6608.5 6357.6 6367.6 6389.5 6395.8 6397.0 05:56:59 INFO - PID 12687 | 05:56:59 INFO - PID 12687 | [#1] ext.html Cycles:180 Average:38734.51 Median:3545.87 stddev:56898.96 (1604.7%) stddev-sans-first:56987.06 05:56:59 INFO - PID 12687 | Values: 741.5 818.8 825.9 849.3 1182.3 28693.3 30184.8 40248.4 41207.2 41311.8 41652.0 41940.6 41975.6 41975.8 42099.4 7654.2 7683.9 7824.1 7825.3 7866.0 7680.7 7794.8 7795.4 7799.7 7800.4 7795.9 7823.9 7824.4 7830.0 7850.9 7755.0 7784.5 7798.3 7806.5 7811.9 7710.4 7774.0 7777.7 7778.2 7780.7 37772.0 37824.8 37929.6 37959.0 38043.8 3502.2 3541.3 3550.4 3553.3 3555.7 30637.2 30761.0 30825.8 30908.1 30937.2 5016.5 5038.6 5077.8 5078.8 5092.5 189532.0 189867.0 190794.0 190837.0 191231.0 47224.5 47313.8 47436.8 47440.0 47488.9 48949.3 48997.3 49097.8 49122.8 49243.3 13859.0 15719.7 15965.8 16158.8 16160.4 11571.4 12953.7 13073.7 13092.5 13108.3 13830.8 13850.1 13913.2 13985.8 14063.6 5779.6 5814.5 5863.8 5873.9 5875.9 1001.1 1011.6 1015.0 1021.4 1032.4 22848.1 22908.7 23013.2 23042.4 23223.9 1110.8 1113.7 1121.4 1126.6 1138.9 11814.8 12167.0 12203.2 12277.8 15762.8 251144.0 252282.0 252460.0 252560.0 253514.0 52623.2 52936.0 53032.7 53245.0 54243.7 1453.8 1456.7 1462.5 1476.0 1477.5 26549.5 27273.5 27463.6 27813.0 27898.4 36366.3 36912.4 37097.0 37156.8 37225.0 208979.0 210233.0 211008.0 211635.0 212046.0 33941.7 36098.0 37745.2 37792.4 37844.0 44901.8 45298.3 45474.3 45868.5 46139.3 33670.3 34040.7 34167.8 34287.8 34639.5 33143.5 33506.8 33583.3 33767.5 34516.5 35680.8 36967.0 37024.4 37070.0 37336.3 31970.2 32435.4 32527.7 32564.5 32881.8 23291.4 23997.4 24782.0 25114.0 25134.0 05:56:59 INFO - PID 12687 | 05:56:59 INFO - PID 12687 | [#2] jquery.html Cycles:180 Average:36282.18 Median:22889.43 stddev:86416.71 (377.5%) stddev-sans-first:86617.50 05:56:59 INFO - PID 12687 | Values: 557.8 559.6 569.2 574.7 594.7 22098.8 22908.7 22987.1 22998.8 23055.7 26434.7 26939.9 26987.7 27024.1 27055.1 6322.0 6436.6 6445.4 6449.4 6481.0 6144.8 6253.9 6387.7 6420.1 6428.4 6399.3 6402.4 6405.2 6421.7 6426.2 6371.7 6380.6 6393.0 6408.4 6421.8 5945.7 5964.7 5968.8 5970.1 5984.2 29700.3 29868.0 30495.5 30582.4 30601.7 1886.3 1921.9 1925.1 1927.1 1928.9 19289.9 19898.5 19900.5 19924.4 19990.2 2185.8 2204.5 2242.8 2245.9 2332.1 138459.0 146188.0 146923.3 147019.0 147047.5 14776.9 15089.6 15168.6 15236.9 15310.6 22899.5 23898.9 23935.5 24087.4 24259.0 10417.4 10465.9 10615.0 10634.3 10793.2 9635.9 9643.6 9661.4 9874.2 9890.5 9360.7 9443.4 9460.4 9672.7 9719.9 2580.9 2598.4 2687.5 2736.1 2780.7 945.9 957.7 973.4 985.4 987.5 19857.4 20002.4 20267.5 20592.9 20882.2 1025.7 1032.4 1034.2 1039.2 1049.3 11131.1 11300.3 11405.5 11459.0 11495.7 478379.0 515341.0 515902.0 521386.0 526658.0 117351.0 123975.0 127217.4 127840.4 128070.0 1214.4 1259.7 1276.4 1277.5 1286.1 20836.3 21011.2 21049.5 21347.5 21541.7 58701.0 59965.0 60346.7 61152.7 61851.0 70575.0 70774.3 71546.3 71681.6 74910.6 14293.9 14732.3 14760.6 14836.3 14876.1 22879.3 23181.9 23210.0 23412.6 23513.6 18196.8 18366.6 18660.3 18688.7 19561.3 17269.7 17549.4 17743.0 17863.6 18487.0 19411.5 19791.4 19876.8 19991.4 20014.8 14816.4 15010.6 15147.9 15148.0 15259.6 19291.9 19388.0 19423.8 19477.4 19508.8 05:56:59 INFO - PID 12687 | 05:56:59 INFO - PID 12687 | [#3] mootools.html Cycles:180 Average:8881.11 Median:2648.05 stddev:6277.29 (237.1%) stddev-sans-first:6269.47 05:56:59 INFO - PID 12687 | Values: 1359.7 1393.4 1424.1 1431.8 1432.4 14361.6 14539.4 14816.9 15006.0 15008.3 14984.1 15203.8 15270.0 15281.0 15311.2 2678.2 2725.7 2726.1 2727.0 2727.3 2658.2 2709.7 2754.8 2760.9 2769.6 2646.2 2697.7 2699.8 2701.1 2712.3 2624.3 2625.5 2643.6 2647.3 2648.8 2567.9 2575.9 2577.8 2596.7 2600.8 14196.2 14433.9 14509.6 14569.5 14583.6 7288.7 7551.5 7555.2 7561.0 7575.1 5147.9 5195.1 5237.7 5362.6 5392.4 1800.0 1813.1 1818.7 1878.1 1880.1 23913.6 24251.0 24369.4 24392.9 24504.1 6263.2 6366.2 6378.0 6589.6 6601.7 16132.1 16204.7 16274.2 16287.1 16307.8 7550.7 7650.1 7733.8 7734.7 7739.5 5912.6 6058.8 6343.7 6933.7 7060.8 5049.8 5175.1 5227.5 5254.2 5301.9 1505.3 1535.3 1538.4 1558.8 1576.2 875.7 895.5 900.4 905.2 906.9 7319.6 7334.2 7351.6 7368.4 7383.7 718.6 724.1 724.4 727.4 727.6 4528.8 4574.4 5289.6 5297.5 5343.3 20025.6 20888.8 20964.9 20977.1 21065.7 19790.0 20008.4 20314.1 20352.8 20362.3 10796.8 11039.6 11131.6 11171.6 11199.8 7950.6 8183.5 8242.6 8472.6 8516.8 17133.8 17184.6 17468.6 17674.0 17801.9 17766.4 17840.6 17997.5 18005.5 18640.2 11488.3 11765.6 11904.4 11904.6 11907.6 13142.6 13340.6 13468.7 13479.2 13497.7 9727.0 9767.4 9966.2 9973.4 10102.5 10250.5 10278.3 10309.3 10476.6 10683.5 8541.4 8712.2 8842.3 9003.9 9107.1 6732.5 6946.1 7013.4 7016.1 7017.7 6974.8 6987.2 7008.6 7052.3 7092.8 05:56:59 INFO - PID 12687 | 05:56:59 INFO - PID 12687 | [#4] prototype.html Cycles:180 Average:5496.77 Median:6069.68 stddev:1535.02 (25.3%) stddev-sans-first:1492.64 05:56:59 INFO - PID 12687 | Values: 491.2 501.8 517.1 520.6 520.9 6135.0 6181.1 6197.8 6199.2 6206.7 5808.5 6004.2 6016.5 6058.0 6102.7 4938.4 4940.5 4951.4 4968.1 4984.8 4967.6 4975.7 4984.4 4999.4 5002.8 4810.4 4941.4 4960.4 4960.7 4967.3 4922.4 4926.0 4975.5 4976.5 4977.3 4396.2 4455.5 4469.8 4496.6 4518.6 6061.1 6065.1 6074.3 6086.4 6118.7 5682.2 5694.1 5733.3 5746.0 5767.9 6383.6 6471.2 6503.5 6528.9 6551.2 4798.4 4845.5 4850.6 4867.7 4876.7 6727.3 6799.1 6802.7 6874.2 6956.8 4880.7 4889.8 4967.4 4997.8 5009.6 5082.2 5094.7 5094.8 5130.3 5139.6 5654.0 5696.3 5706.9 5726.4 5761.5 6493.5 6550.4 6552.2 6571.9 6597.4 1611.8 1657.7 1710.6 1733.0 1760.2 1199.7 1212.0 1219.0 1225.8 1235.6 5724.3 5730.4 5762.3 5777.9 5779.0 6532.6 6556.7 6573.6 6616.9 6648.9 5666.6 5698.4 5761.9 5773.2 5808.2 3532.9 3559.7 3588.7 3603.5 3609.5 6499.8 6526.8 6540.7 6559.4 6563.8 6723.2 6777.1 6818.4 6896.0 6950.2 6461.5 6468.9 6514.6 6545.2 6603.5 6652.7 6662.7 6666.4 6688.7 6766.2 6612.3 6646.5 6652.6 6657.3 6721.5 6449.9 6450.2 6509.0 6582.5 6599.7 5375.3 5476.4 5490.9 5504.6 5517.4 6586.8 6660.7 6674.7 6731.6 6780.4 6358.9 6424.3 6461.1 6477.4 6479.0 6207.8 6337.9 6357.7 6360.1 6371.3 6083.2 6365.3 6417.6 6448.0 6479.4 6616.6 6617.6 6626.3 6648.6 6652.4 6220.9 6379.1 6383.9 6389.3 6425.3 05:56:59 INFO - PID 12687 | 05:56:59 INFO - PID 12687 | [#5] yui.html Cycles:180 Average:23487.11 Median:18330.77 stddev:33369.58 (182.0%) stddev-sans-first:33420.13 05:56:59 INFO - PID 12687 | Values: 908.5 921.3 931.1 936.4 944.3 17623.7 18267.5 18306.1 18355.4 18369.8 20788.6 22616.1 22813.4 22816.2 22866.2 1022.2 1043.4 1046.1 1051.1 1052.6 977.3 1057.2 1057.9 1059.0 1059.5 1103.2 1105.4 1111.9 1116.6 1116.8 1101.0 1103.8 1105.6 1116.3 1119.2 816.3 818.0 820.9 821.1 821.3 18612.4 18911.1 19018.0 19032.1 19090.2 19504.8 19872.4 19885.6 19995.7 20101.4 16139.2 16149.5 16259.0 16334.1 16824.7 3677.0 3703.0 3706.5 3706.6 3712.4 133071.0 134045.0 134088.0 136456.0 137062.3 17202.2 17365.7 17440.1 17448.5 17518.7 31654.4 31718.0 32348.8 32595.3 32790.0 8487.1 8494.0 8569.7 8572.1 8877.8 3623.2 3766.4 4183.1 4284.4 4289.2 5926.4 6116.6 6136.6 6149.2 6154.2 1071.6 1092.5 1119.2 1120.1 1121.3 638.3 655.8 661.0 663.2 675.2 11080.4 11363.3 11514.8 11879.7 12129.9 649.7 663.4 669.6 680.3 691.4 4901.7 4908.5 5050.7 5109.9 5150.6 111281.4 112253.4 112439.4 114421.0 115065.0 101251.0 102484.0 104359.0 105400.0 108394.0 87963.0 88900.6 89375.6 91177.0 92639.0 9439.4 9443.5 9514.7 9611.1 9762.0 40047.2 40273.4 41258.2 42623.8 42952.1 51315.7 51381.0 52054.0 53555.5 53785.0 14076.8 14330.2 14426.6 14544.6 14570.8 14951.5 16028.3 16170.6 16206.8 19182.2 16457.3 16514.5 16564.6 16585.3 16675.7 16741.7 16803.7 16825.7 16971.8 17032.2 16527.4 16577.7 16602.8 16741.7 16795.9 12278.9 12552.6 12573.6 12711.2 12761.9 13093.9 13129.1 13181.2 13488.4 13562.6 05:56:59 INFO - PID 12687 | -------- Summary: end -------- 05:56:59 INFO - PID 12687 | 05:57:00 INFO - TEST-INFO | 12687: exit 0 05:57:00 INFO - TEST-OK | dromaeo_css | took 1112025ms 05:57:00 INFO - TEST-START | kraken 05:57:00 INFO - Initialising browser for kraken test... 05:57:00 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:40814/getInfo.html -profile /tmp/tmpGM4jXk/profile 05:57:00 INFO - TEST-INFO | started process 13109 (/builds/slave/test/build/application/firefox/firefox http://localhost:40814/getInfo.html) 05:57:06 INFO - TEST-INFO | 13109: exit 0 05:57:06 INFO - Browser initialized. 05:57:06 INFO - Running cycle 1/1 for kraken test... 05:57:06 INFO - TEST-INFO | started process 13298 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpGM4jXk/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 05:57:07 INFO - PID 13298 | 05:57:07 INFO - PID 13298 | (/builds/slave/test/build/application/firefox/firefox:13347): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 05:57:07 INFO - PID 13298 | 05:57:07 INFO - PID 13298 | 05:57:07 INFO - PID 13298 | (/builds/slave/test/build/application/firefox/firefox:13407): Pango-WARNING **: error opening config file '/home/cltbld/.pangorc': Permission denied 05:57:07 INFO - PID 13298 | 05:57:07 INFO - PID 13298 | __metrics Screen width/height:1600/1200 05:57:07 INFO - PID 13298 | colorDepth:24 05:57:07 INFO - PID 13298 | Browser inner width/height: 1024/768 05:57:07 INFO - PID 13298 | __metrics 05:57:17 INFO - PID 13298 | RSS: Main: 174440448 05:57:17 INFO - PID 13298 | 05:57:20 INFO - PID 13298 | Cycle 1(1): loaded http://localhost:40814/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:40814/tests/kraken/driver.html?testName=audio-beat-detection) 05:57:21 INFO - PID 13298 | RSS: Main: 178294784 05:57:21 INFO - PID 13298 | 05:57:23 INFO - PID 13298 | Cycle 1(1): loaded http://localhost:40814/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:40814/tests/kraken/driver.html?testName=audio-dft) 05:57:24 INFO - PID 13298 | RSS: Main: 178978816 05:57:24 INFO - PID 13298 | 05:57:27 INFO - PID 13298 | Cycle 1(1): loaded http://localhost:40814/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:40814/tests/kraken/driver.html?testName=audio-fft) 05:57:28 INFO - PID 13298 | RSS: Main: 173785088 05:57:28 INFO - PID 13298 | 05:57:30 INFO - PID 13298 | Cycle 1(1): loaded http://localhost:40814/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:40814/tests/kraken/driver.html?testName=audio-oscillator) 05:57:30 INFO - PID 13298 | RSS: Main: 174194688 05:57:30 INFO - PID 13298 | 05:57:33 INFO - PID 13298 | Cycle 1(1): loaded http://localhost:40814/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:40814/tests/kraken/driver.html?testName=imaging-gaussian-blur) 05:57:33 INFO - PID 13298 | RSS: Main: 174538752 05:57:33 INFO - PID 13298 | 05:57:36 INFO - PID 13298 | Cycle 1(1): loaded http://localhost:40814/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:40814/tests/kraken/driver.html?testName=imaging-darkroom) 05:57:37 INFO - PID 13298 | RSS: Main: 175558656 05:57:37 INFO - PID 13298 | 05:57:41 INFO - PID 13298 | Cycle 1(1): loaded http://localhost:40814/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:40814/tests/kraken/driver.html?testName=imaging-desaturate) 05:57:41 INFO - PID 13298 | RSS: Main: 175558656 05:57:41 INFO - PID 13298 | 05:57:44 INFO - PID 13298 | Cycle 1(1): loaded http://localhost:40814/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:40814/tests/kraken/driver.html?testName=json-parse-financial) 05:57:45 INFO - PID 13298 | RSS: Main: 176427008 05:57:45 INFO - PID 13298 | 05:57:46 INFO - PID 13298 | Cycle 1(1): loaded http://localhost:40814/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:40814/tests/kraken/driver.html?testName=json-stringify-tinderbox) 05:57:47 INFO - PID 13298 | RSS: Main: 175751168 05:57:47 INFO - PID 13298 | 05:57:49 INFO - PID 13298 | Cycle 1(1): loaded http://localhost:40814/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:40814/tests/kraken/driver.html?testName=stanford-crypto-aes) 05:57:50 INFO - PID 13298 | RSS: Main: 176275456 05:57:50 INFO - PID 13298 | 05:57:52 INFO - PID 13298 | Cycle 1(1): loaded http://localhost:40814/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:40814/tests/kraken/driver.html?testName=stanford-crypto-ccm) 05:57:52 INFO - PID 13298 | RSS: Main: 176156672 05:57:52 INFO - PID 13298 | 05:57:55 INFO - PID 13298 | Cycle 1(1): loaded http://localhost:40814/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:40814/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 05:57:56 INFO - PID 13298 | RSS: Main: 177229824 05:57:56 INFO - PID 13298 | 05:57:59 INFO - PID 13298 | Cycle 1(1): loaded http://localhost:40814/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:40814/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 05:57:59 INFO - PID 13298 | RSS: Main: 176709632 05:57:59 INFO - PID 13298 | 05:58:01 INFO - PID 13298 | Cycle 1(1): loaded http://localhost:40814/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:40814/tests/kraken/driver.html?testName=ai-astar) 05:58:02 INFO - PID 13298 | RSS: Main: 177950720 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | __start_tp_report 05:58:02 INFO - PID 13298 | _x_x_mozilla_page_load 05:58:02 INFO - PID 13298 | _x_x_mozilla_page_load_details 05:58:02 INFO - PID 13298 | |i|pagename|runs| 05:58:02 INFO - PID 13298 | |0;ai-astar;100;108;100;108;107;110;111;99;109;106 05:58:02 INFO - PID 13298 | |1;audio-beat-detection;154;120;157;169;118;144;147;122;164;117 05:58:02 INFO - PID 13298 | |2;audio-dft;165;165;164;162;164;164;186;169;167;164 05:58:02 INFO - PID 13298 | |3;audio-fft;78;82;82;168;80;78;75;82;105;76 05:58:02 INFO - PID 13298 | |4;audio-oscillator;81;79;131;80;79;83;124;78;77;134 05:58:02 INFO - PID 13298 | |5;imaging-gaussian-blur;114;114;114;114;114;114;113;115;115;118 05:58:02 INFO - PID 13298 | |6;imaging-darkroom;153;151;150;151;158;149;150;153;151;150 05:58:02 INFO - PID 13298 | |7;imaging-desaturate;100;99;103;93;94;94;94;94;94;94 05:58:02 INFO - PID 13298 | |8;json-parse-financial;54;54;54;55;54;57;61;58;54;54 05:58:02 INFO - PID 13298 | |9;json-stringify-tinderbox;56;58;59;56;58;59;54;54;55;62 05:58:02 INFO - PID 13298 | |10;stanford-crypto-aes;86;76;78;79;79;75;76;75;75;80 05:58:02 INFO - PID 13298 | |11;stanford-crypto-ccm;135;120;122;136;121;122;125;121;123;165 05:58:02 INFO - PID 13298 | |12;stanford-crypto-pbkdf2;172;170;177;175;170;171;170;168;180;169 05:58:02 INFO - PID 13298 | |13;stanford-crypto-sha256-iterative;73;67;69;74;70;78;67;68;73;66 05:58:02 INFO - PID 13298 | __end_tp_report 05:58:02 INFO - PID 13298 | __start_cc_report 05:58:02 INFO - PID 13298 | _x_x_mozilla_cycle_collect,1000 05:58:02 INFO - PID 13298 | __end_cc_report 05:58:02 INFO - PID 13298 | __startTimestamp1503320282073__endTimestamp 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | ------- Summary: start ------- 05:58:02 INFO - PID 13298 | Number of tests: 14 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | [#0] ai-astar Cycles:10 Average:105.80 Median:108.50 stddev:4.47 (4.1%) stddev-sans-first:4.22 05:58:02 INFO - PID 13298 | Values: 100.0 108.0 100.0 108.0 107.0 110.0 111.0 99.0 109.0 106.0 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | [#1] audio-beat-detection Cycles:10 Average:141.20 Median:150.50 stddev:20.25 (13.5%) stddev-sans-first:20.94 05:58:02 INFO - PID 13298 | Values: 154.0 120.0 157.0 169.0 118.0 144.0 147.0 122.0 164.0 117.0 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | [#2] audio-dft Cycles:10 Average:167.00 Median:165.00 stddev:6.94 (4.2%) stddev-sans-first:7.33 05:58:02 INFO - PID 13298 | Values: 165.0 165.0 164.0 162.0 164.0 164.0 186.0 169.0 167.0 164.0 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | [#3] audio-fft Cycles:10 Average:90.60 Median:79.00 stddev:28.49 (36.1%) stddev-sans-first:29.85 05:58:02 INFO - PID 13298 | Values: 78.0 82.0 82.0 168.0 80.0 78.0 75.0 82.0 105.0 76.0 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | [#4] audio-oscillator Cycles:10 Average:94.60 Median:79.00 stddev:24.37 (30.9%) stddev-sans-first:25.35 05:58:02 INFO - PID 13298 | Values: 81.0 79.0 131.0 80.0 79.0 83.0 124.0 78.0 77.0 134.0 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | [#5] imaging-gaussian-blur Cycles:10 Average:114.50 Median:114.00 stddev:1.35 (1.2%) stddev-sans-first:1.42 05:58:02 INFO - PID 13298 | Values: 114.0 114.0 114.0 114.0 114.0 114.0 113.0 115.0 115.0 118.0 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | [#6] imaging-darkroom Cycles:10 Average:151.60 Median:151.00 stddev:2.59 (1.7%) stddev-sans-first:2.70 05:58:02 INFO - PID 13298 | Values: 153.0 151.0 150.0 151.0 158.0 149.0 150.0 153.0 151.0 150.0 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | [#7] imaging-desaturate Cycles:10 Average:95.90 Median:94.00 stddev:3.45 (3.7%) stddev-sans-first:3.32 05:58:02 INFO - PID 13298 | Values: 100.0 99.0 103.0 93.0 94.0 94.0 94.0 94.0 94.0 94.0 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | [#8] json-parse-financial Cycles:10 Average:55.50 Median:54.50 stddev:2.42 (4.4%) stddev-sans-first:2.50 05:58:02 INFO - PID 13298 | Values: 54.0 54.0 54.0 55.0 54.0 57.0 61.0 58.0 54.0 54.0 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | [#9] json-stringify-tinderbox Cycles:10 Average:57.10 Median:58.00 stddev:2.56 (4.4%) stddev-sans-first:2.68 05:58:02 INFO - PID 13298 | Values: 56.0 58.0 59.0 56.0 58.0 59.0 54.0 54.0 55.0 62.0 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | [#10] stanford-crypto-aes Cycles:10 Average:77.90 Median:78.50 stddev:3.41 (4.3%) stddev-sans-first:2.00 05:58:02 INFO - PID 13298 | Values: 86.0 76.0 78.0 79.0 79.0 75.0 76.0 75.0 75.0 80.0 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | [#11] stanford-crypto-ccm Cycles:10 Average:129.00 Median:124.00 stddev:13.90 (11.2%) stddev-sans-first:14.58 05:58:02 INFO - PID 13298 | Values: 135.0 120.0 122.0 136.0 121.0 122.0 125.0 121.0 123.0 165.0 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:172.20 Median:171.50 stddev:3.88 (2.3%) stddev-sans-first:4.12 05:58:02 INFO - PID 13298 | Values: 172.0 170.0 177.0 175.0 170.0 171.0 170.0 168.0 180.0 169.0 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:70.50 Median:71.50 stddev:3.87 (5.4%) stddev-sans-first:3.99 05:58:02 INFO - PID 13298 | Values: 73.0 67.0 69.0 74.0 70.0 78.0 67.0 68.0 73.0 66.0 05:58:02 INFO - PID 13298 | -------- Summary: end -------- 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | ###!!! [Parent][MessageChannel] Error: (msgtype=0x150079,name=PBrowser::Msg_Destroy) Closed channel: cannot send/recv 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | ###!!! [Child][MessageChannel] Error: (msgtype=0x150001,name=PBrowser::Msg_AsyncMessage) Closed channel: cannot send/recv 05:58:02 INFO - PID 13298 | 05:58:02 INFO - PID 13298 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 05:58:02 INFO - TEST-INFO | 13298: exit 0 05:58:02 INFO - TEST-OK | kraken | took 62453ms 05:58:02 INFO - SUITE-END | took 1174s 05:58:03 INFO - Completed test suite (00:19:34) 05:58:03 INFO - javascript benchmark 05:58:03 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8490.2864251174, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3175.2220705927066, 3185.347003864208, 3199.2481766784804, 3200.5359222912675, 3223.6937490938367, 6243.500519958404, 6262.874742505147, 6263.718132684029, 6289.993601023837, 6309.1482649842255, 6143.32423433422, 6232.750689972407, 6237.3450787667325, 6241.344658810816, 6243.125962365272, 5650.350209725872, 5689.8577535561635, 5709.942900570983, 5728.112142617901, 5788.971055144719, 5805.912911306313, 5806.506446951993, 5808.622439541437, 5823.941760582404, 5873.030949893284, 5633.746481408347, 5744.971275143618, 5785.103308987113, 5836.328822185439, 5868.325142608612, 5668.149777533403, 5684.346300175492, 5769.624974376652, 5783.739731712083, 5801.767929282823, 5631.746571404296, 5660.85847853807, 5732.484076433099, 5737.540996720252, 5744.798932037359, 6028.276606807167, 6138.84652883677, 6169.691515424211, 6213.782517611907, 6221.004639257697, 6721.6975236114, 6726.327367263283, 6759.831004224885, 6770.966145169292, 6778.152730908637, 6772.356626120511, 6835.179778426571, 6845.623490708009, 6847.863042739167, 6884.827879303008, 6211.503079753654, 6212.844678882973, 6270.278917924452, 6303.46420554258, 6321.715522801485, 6716.764913228014, 6785.796426107225, 6900.171979362509, 6906.136732908387, 6971.477139214579, 6434.292227854932, 6450.838729031718, 6522.576032557963, 6549.6070235786, 6573.737050517926, 6577.750227456768, 6670.933290667128, 6694.765683201162, 6707.53047286695, 6721.092652491949, 6592.538522303393, 6616.239132499824, 6683.164604424447, 6694.464442844561, 6697.095892054608, 6577.769778057745, 6624.072629831828, 6687.732490700318, 6688.398044176048, 6693.899591506131, 5349.0, 5350.304460420199, 5355.116405793078, 5408.7566059526625, 5471.863203419866, 4627.5603817637275, 4713.269443236304, 4716.764161791897, 4717.292406139107, 4808.687435316693, 5701.629394089454, 5771.509421699118, 5780.653160810365, 5825.126231065289, 5837.88324233513, 6583.242927063353, 6639.701213445406, 6651.833704157338, 6743.022261772016, 6796.558223715443, 5722.570807189478, 5739.913901291484, 5750.281214848144, 5776.960147173465, 5802.796902108406, 5879.5002424794375, 5908.497777688859, 5957.76168953237, 5965.0, 5975.282966044103, 6525.0, 6558.672066396661, 6566.080748695091, 6572.441342485942, 6624.56940298879, 6714.060031595678, 6767.796966091025, 6780.796576102724, 6827.829304267234, 6869.690863911036, 6419.390157934989, 6505.121808555785, 6533.379328963931, 6581.967090164519, 6614.735410583523, 6543.738250470118, 6550.868982620416, 6611.702473388613, 6613.941769316886, 6617.239017513048, 6701.1623547056615, 6706.362895524917, 6711.161104861892, 6714.764983225564, 6763.425108865605, 6516.674166291572, 6561.770338038145, 6566.212054553484, 6579.901301480578, 6593.241777195492, 6501.284858665448, 6567.671616419256, 6571.34286571339, 6585.209774827052, 6589.5387322888855, 6356.586821856565, 6412.61524308543, 6460.3862633049785, 6461.224653041665, 6464.321246269262, 6510.609363438209, 6564.770233041821, 6575.967120164369, 6584.604923704593, 6608.471322294301, 6357.554971151975, 6367.554271201157, 6389.456896163878, 6395.808125756234, 6397.0], "value": 6121.617427874184, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [741.5180132913606, 818.8444195602837, 825.8802473641322, 849.3035710717206, 1182.308349615475, 28693.282667933312, 30184.849075754617, 40248.39627405588, 41207.17585648285, 41311.79344103283, 41652.0, 41940.58059419405, 41975.58024419755, 41975.79012104935, 42099.368509472384, 7654.234576542357, 7683.884741728879, 7824.061112666488, 7825.295723384894, 7866.0, 7680.731174408897, 7794.8441031179345, 7795.376369890395, 7799.6880124795225, 7800.375969922393, 7795.9220407795765, 7823.921760782405, 7824.374050076009, 7829.960850195769, 7850.9214907850765, 7755.0, 7784.455088143832, 7798.298153166185, 7806.4925779824125, 7811.882821757678, 7710.421718371144, 7773.96113019437, 7777.650005749755, 7778.183290754502, 7780.688772449095, 37772.0, 37824.81087594572, 37929.62070379288, 37959.0, 38043.8097809512, 3502.176988407722, 3541.34485120251, 3550.396432606463, 3553.307105114504, 3555.6622120898473, 30637.234069148228, 30761.0, 30825.84587077073, 30908.072757817077, 30937.226569335722, 5016.523430274155, 5038.647294689373, 5077.822276220351, 5078.847634570969, 5092.465291144414, 189532.0, 189867.0, 190794.0, 190837.0, 191231.0, 47224.52775472201, 47313.76343118331, 47436.76281618639, 47440.0, 47488.86300116503, 48949.265761013616, 48997.26504102441, 49097.75451122793, 49122.75438622784, 49243.26135107976, 13859.0, 15719.68560628804, 15965.840341596668, 16158.75761863573, 16160.353585856668, 11571.42142892852, 12953.676158095934, 13073.673158171121, 13092.476300947856, 13108.279044652445, 13830.792538111937, 13850.099743516841, 13913.165210087427, 13985.79021314681, 14063.648408789863, 5779.624324418899, 5814.476697097197, 5863.824085277449, 5873.853153671193, 5875.853103672443, 1001.1190152665607, 1011.5650270383805, 1014.9594016239415, 1021.3514418344405, 1032.390889375272, 22848.086076557083, 22908.656370154462, 23013.19453819142, 23042.423939401313, 23223.883880580488, 1110.7667389848061, 1113.693734223079, 1121.3720316622555, 1126.6282126898104, 1138.9031932285848, 11814.822777658343, 12166.965807906427, 12203.221068877141, 12277.815832762515, 15762.842371576138, 251144.0, 252282.0, 252460.0, 252560.0, 253514.0, 52623.21065184025, 52936.0, 53032.73483632557, 53245.0, 54243.72878135663, 1453.8473460286518, 1456.7013762178728, 1462.546610550754, 1475.9852401475848, 1477.5124209011, 26549.469010620065, 27273.45453090967, 27463.588046179724, 27813.0, 27898.44203115967, 36366.27267454689, 36912.44631330478, 37097.0, 37156.814215928745, 37225.0, 208979.0, 210233.0, 211008.0, 211635.0, 212046.0, 33941.66058339385, 36098.0, 37745.24509509849, 37792.43311350387, 37844.0, 44901.77549112234, 45298.32052519281, 45474.31788523241, 45868.54131458643, 46139.30791038204, 33670.32659346848, 34040.65959340474, 34167.82916085404, 34287.82856085704, 34639.480407794406, 33143.502847456824, 33506.83246583751, 33583.32833343368, 33767.4934875982, 34516.48225276673, 35680.82159589185, 36967.0, 37024.44463333106, 37070.0, 37336.253274933806, 31970.20074498063, 32435.35129297448, 32527.67472325341, 32564.51153232656, 32881.835590821895, 23291.417714557272, 23997.400064998514, 24782.0, 25114.0, 25134.0], "value": 17404.444119367494, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [557.7601631298545, 559.6110703061371, 569.1803802524367, 574.6781802190774, 594.7383151413378, 22098.779012209874, 22908.65637015444, 22987.08051677933, 22998.770012299872, 23055.654165187534, 26434.735652643467, 26939.86530067352, 26987.730122698766, 27024.05415810447, 27055.053073142444, 6321.999999999988, 6436.645984470852, 6445.355464453564, 6449.35506449356, 6481.027845823117, 6144.8156555303185, 6253.906191407133, 6387.712552935129, 6420.06908998195, 6428.389303016206, 6399.296077431502, 6402.359764023584, 6405.167328247321, 6421.678916054202, 6426.228852537702, 6371.681415929208, 6380.649064301461, 6392.968035159794, 6408.423241908227, 6421.8073457796345, 5945.672987985659, 5964.671943043131, 5968.7910923117915, 5970.074638431007, 5984.162217289583, 29700.257493562618, 29868.0, 30495.542566861513, 30582.388352233054, 30601.693983060108, 1886.2549293029315, 1921.9231230750754, 1925.0663428237294, 1927.0557426860878, 1928.8553358498168, 19289.903550482297, 19898.502537436536, 19900.502487437785, 19924.402267931986, 19990.200391984305, 2185.836062295334, 2204.4599073227, 2242.7532971373134, 2245.8989345479495, 2332.125452955142, 138459.0, 146188.0, 146923.26538367345, 147019.0, 147047.52952470444, 14776.92611536957, 15089.622759431102, 15168.620784480476, 15236.923815380853, 15310.617234569225, 22899.542009159723, 23898.88050559736, 23935.52128957411, 24087.397815054414, 24259.0, 10417.374957502423, 10465.895341046493, 10615.0, 10634.255602107778, 10793.244472886823, 9635.903640963501, 9643.614255429704, 9661.372010819416, 9874.160696340892, 9890.456024918698, 9360.672376466928, 9443.433393996382, 9460.385074970105, 9672.661456849117, 9719.854202186973, 2580.8838602262945, 2598.4153565448, 2687.479401983408, 2736.097087960968, 2780.708025657317, 945.9148676619137, 957.7366224288237, 973.4402718436786, 985.3989066669326, 987.521052289639, 19857.404277871687, 20002.39992800218, 20267.493312667008, 20592.897035514725, 20882.164713411294, 1025.707673313117, 1032.4476405123373, 1034.1519953637944, 1039.1946241662772, 1049.3284298049255, 11131.109371650326, 11300.321980681021, 11405.543778248943, 11459.0, 11495.677997030449, 478379.0, 515341.0, 515902.0, 521386.0, 526658.0, 117351.0, 123975.0, 127217.36391317984, 127840.36079819727, 128070.0, 1214.3563911127117, 1259.6787819106253, 1276.368197742105, 1277.4698500122345, 1286.1318609938255, 20836.27073052436, 21011.159553618294, 21049.47376315543, 21347.46631334229, 21541.676874846577, 58701.0, 59965.0, 60346.698266508385, 61152.694236528536, 61851.0, 70575.0, 70774.29225707884, 71546.28453715604, 71681.6415917917, 74910.62544687242, 14293.928530357281, 14732.263386830402, 14760.63098422548, 14836.258187090387, 14876.107433554022, 22879.31362059141, 23181.88409057944, 23210.0, 23412.648810267518, 23513.64729529024, 18196.81803181951, 18366.632667346847, 18660.2535898568, 18688.719669205246, 19561.315353962542, 17269.740953885954, 17549.385771497935, 17743.0, 17863.553411164306, 18487.0, 19411.51471213231, 19791.406257811712, 19876.801231987494, 19991.40025799228, 20014.799852001877, 14816.40734370613, 15010.624734381729, 15147.924260378628, 15148.0, 15259.618509537351, 19291.903540482206, 19388.0, 19423.805761942764, 19477.415677529698, 19508.804911950698], "value": 12230.154491857933, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1359.6532884114552, 1393.400837639815, 1424.0814674534925, 1431.8424973252934, 1432.3983926750757, 14361.640958976031, 14539.400665926765, 14816.925915370408, 15006.0, 15008.324625391857, 14984.10095394277, 15203.771943420857, 15270.0, 15281.0, 15311.234438278098, 2678.2367025397716, 2725.6592925884265, 2726.086760935089, 2727.0319036741967, 2727.2500062482877, 2658.1626787561954, 2709.6612923384578, 2754.752072313491, 2760.903368382107, 2769.57071653894, 2646.1796842978642, 2697.716739742328, 2699.784017278613, 2701.149138021517, 2712.3083613678486, 2624.3176774038793, 2625.514279858223, 2643.629891815138, 2647.2587675450904, 2648.841069535834, 2567.9214729813525, 2575.9098431554994, 2577.7626739165307, 2596.688397392325, 2600.7919366450637, 14196.219207943559, 14433.927830360886, 14509.564713058626, 14569.490067847575, 14583.635409114751, 7288.6720097595735, 7551.546907185587, 7555.2067032961295, 7560.962195189044, 7575.09098908129, 5147.897042059175, 5195.142801437796, 5237.73811309433, 5362.597805164628, 5392.379876314196, 1799.9910000450045, 1813.1206364913007, 1818.7453756474104, 1878.0985127138913, 1880.0881572437493, 23913.64129538041, 24251.0, 24369.390765230833, 24392.87803560971, 24504.142355017488, 6263.154474146023, 6366.204224471941, 6378.0, 6589.604623722592, 6601.73593056282, 16132.112733799519, 16204.675906481805, 16274.186290685655, 16287.104209268367, 16307.83692163087, 7550.697972081055, 7650.081990161217, 7733.8453230935065, 7734.690612375554, 7739.458237923404, 5912.615679980788, 6058.848528786727, 6343.651099189589, 6933.68798404073, 7060.7881763547175, 5049.848504544796, 5175.120229560984, 5227.451117632594, 5254.185601231815, 5301.946980530222, 1505.2548988250885, 1535.332130523226, 1538.438469958457, 1558.789563408948, 1576.1646327446472, 875.6759998800485, 895.4582477600958, 900.3742399032609, 905.1898550797132, 906.9410488318238, 7319.560826350329, 7334.229905859915, 7351.558906465629, 7368.373688236453, 7383.704651813868, 718.6334969165658, 724.0587236592409, 724.4385601159144, 727.3635568877232, 727.6107282603782, 4528.7509186994375, 4574.405327307495, 5289.629725919226, 5297.523222909879, 5343.332083489564, 20025.599488010157, 20888.791112088988, 20964.89517552433, 20977.056032478577, 21065.684014739792, 19790.0, 20008.39974800758, 20314.085866136058, 20352.796472035385, 20362.28731994373, 10796.838047429295, 11039.558417663364, 11131.554737810397, 11171.553137874556, 11199.832002519968, 7950.562719050507, 8183.468074575134, 8242.587870606565, 8472.618732156945, 8516.829663406821, 17133.828661713724, 17184.570385740455, 17468.563285917953, 17674.0, 17801.910990444965, 17766.378176763752, 17840.643187136444, 17997.460076197734, 18005.459836204413, 18640.161192746087, 11488.310701357945, 11765.588204413147, 11904.404779761151, 11904.58333958342, 11907.583234586747, 13142.60572182836, 13340.599782006555, 13468.730625387241, 13479.19124852512, 13497.662558436117, 9727.0, 9767.365121267096, 9966.152877005536, 9973.401595904268, 10102.545385457819, 10250.487475626338, 10278.280520363802, 10309.278350515391, 10476.63331783384, 10683.465826708789, 8541.359398045048, 8712.21590056898, 8842.292616590787, 9003.864942026006, 9107.08929107084, 6732.495062870206, 6946.0622815919205, 7013.4038606719005, 7016.052832867702, 7017.7192912282935, 6974.755883544051, 6987.231404545598, 7008.614526201108, 7052.330028647476, 7092.751753688596], "value": 6377.910395635842, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [491.19029538704046, 501.8134843742237, 517.1260569637312, 520.6433592988806, 520.9114450543407, 6134.969325153379, 6181.083864002162, 6197.845053873655, 6199.163112979746, 6206.6586337751405, 5808.5023439920815, 6004.159417681517, 6016.548758843082, 6057.969710151443, 6102.694865256742, 4938.382702162221, 4940.530649588283, 4951.405831300249, 4968.130577149002, 4984.806685058581, 4967.602591792666, 4975.7263350515705, 4984.383198820612, 4999.350084489011, 5002.799888004475, 4810.374651295344, 4941.382327209099, 4960.429550601672, 4960.6527543072, 4967.329410529568, 4922.409310882699, 4925.975370123145, 4975.502449754996, 4976.527229913152, 4977.278294647292, 4396.186705459469, 4455.529675207206, 4469.7651174412795, 4496.64026877849, 4518.638508919312, 6061.121137435091, 6065.090236464522, 6074.271087469488, 6086.421789929949, 6118.724657390384, 5682.232898558683, 5694.117411801178, 5733.340665823442, 5745.983358736697, 5767.88464230713, 6383.585066970632, 6471.1587493626, 6503.512236582275, 6528.902066469007, 6551.213854337462, 4798.4001999750035, 4845.546336099156, 4850.5877000455, 4867.7322747249245, 4876.707397556158, 6727.293634168391, 6799.11611490508, 6802.693878775467, 6874.2094659113845, 6956.756513522002, 4880.731559764247, 4889.779959901813, 4967.403911530567, 4997.750112494434, 5009.599232061426, 5082.170418649283, 5094.700851282899, 5094.796208151706, 5130.281760553451, 5139.58883289336, 5653.971730141323, 5696.322728317684, 5706.9429305707245, 5726.398728133569, 5761.53907687384, 6493.480521558264, 6550.377714117151, 6552.180977377828, 6571.901421478682, 6597.439217666552, 1611.7508930578895, 1657.676753033171, 1710.598009467774, 1732.9913350433167, 1760.1815155952543, 1199.6580974422423, 1212.0243204220687, 1218.975620487603, 1225.8467691538558, 1235.5737270641614, 5724.341700704389, 5730.36965933747, 5762.30852297727, 5777.94222057774, 5778.971105144447, 6532.575382600211, 6556.672166391661, 6573.638449885207, 6616.900746488806, 6648.900266496006, 5666.6400063985175, 5698.430156984268, 5761.868108799771, 5773.162891380726, 5808.215890854765, 3532.947005794915, 3559.661832125944, 3588.7129029678085, 3603.4955106285142, 3609.4766258892314, 6499.805005849832, 6526.771562995273, 6540.672966351759, 6559.376859198369, 6563.8359041023405, 6723.193216814014, 6777.120473259245, 6818.386345228854, 6895.965520172467, 6950.235474097845, 6461.515386346043, 6468.870622587522, 6514.57655252407, 6545.247296560861, 6603.537752357289, 6652.667366631552, 6662.700178492077, 6666.366695163952, 6688.732450702112, 6766.1920303073675, 6612.305707900601, 6646.468282537482, 6652.567583107082, 6657.3009833966735, 6721.529492935448, 6449.935500644933, 6450.225972883284, 6508.967455162694, 6582.539222254588, 6599.703013364314, 5375.274337964481, 5476.3702174250475, 5490.945090549043, 5504.6421982571, 5517.448255174611, 6586.81437341264, 6660.733570657313, 6674.733010679518, 6731.610278351311, 6780.355866192704, 6358.904616430665, 6424.293327734039, 6461.127747753993, 6477.384648458389, 6479.028145778171, 6207.81376558704, 6337.936620633919, 6357.745690172342, 6360.109584658244, 6371.267304259884, 6083.209182806207, 6365.299817020032, 6417.582857114273, 6447.967760161357, 6479.416852483299, 6616.569922954993, 6617.569857959217, 6626.304238055128, 6648.634325112165, 6652.37659826416, 6220.906686399617, 6379.138816259746, 6383.904241436289, 6389.2971773105855, 6425.293217746138], "value": 5042.000621304245, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [908.4776253654146, 921.341241012676, 931.0968360690129, 936.4474959773733, 944.2540393089457, 17623.735643965334, 18267.451976440694, 18306.08469576521, 18355.449336519894, 18369.816301836978, 20788.584228315423, 22616.09535618573, 22813.4296642584, 22816.20143294985, 22866.199683011055, 1022.2435397805626, 1043.446973104256, 1046.1317106801337, 1051.1170616681986, 1052.5684469367561, 977.2670497127154, 1057.1542765787378, 1057.8730552333732, 1058.978820423595, 1059.5391004912888, 1103.1505740579748, 1105.4362275239646, 1111.9110471162328, 1116.6482557994245, 1116.8213085906257, 1100.9980917365199, 1103.7516558774212, 1105.618561596256, 1116.2521110855705, 1119.160629527854, 816.3346872299057, 817.9550124743137, 820.9220124088203, 821.0885916632533, 821.2813787935556, 18612.441626751082, 18911.14899829511, 19018.049097545205, 19032.143553540125, 19090.23639054436, 19504.804951950442, 19872.403827885188, 19885.60228795416, 19995.700064499044, 20101.396958091136, 16139.193040347936, 16149.515514534583, 16259.0, 16334.101624410652, 16824.663506729918, 3676.963230367689, 3703.0187000444903, 3706.5181526401393, 3706.592274849764, 3712.3874560697454, 133071.0, 134045.0, 134088.0, 136455.999999999, 137062.3146884269, 17202.22589983454, 17365.7395139073, 17440.12799360027, 17448.47654570365, 17518.737218941726, 31654.36691266162, 31718.0, 32348.83825580904, 32595.348093038006, 32790.0, 8487.10885357041, 8494.0, 8569.657213711382, 8572.057073721886, 8877.822443551222, 3623.1847834237615, 3766.37854753968, 4183.079722461053, 4284.378765079046, 4289.24938135825, 5926.377730338339, 6116.5718399711595, 6136.6011209271255, 6149.200603921461, 6154.1999540059505, 1071.6249312740633, 1092.4756117063853, 1119.2333251722434, 1120.1151090638305, 1121.327203677803, 638.2532437048665, 655.7868692674899, 660.96364699941, 663.2140913018089, 675.152683382352, 11080.390578518098, 11363.261388009752, 11514.76970460603, 11879.70300742471, 12129.87870121305, 649.7368565730886, 663.4360793325731, 669.6484345718537, 680.343468552839, 691.4261163234503, 4901.705897646081, 4908.460069392364, 5050.722210278396, 5109.948900510947, 5150.6137039721425, 111281.44359278152, 112253.43873280581, 112439.43780281047, 114421.0, 115065.0, 101251.0, 102484.0, 104359.0, 105400.0, 108394.0, 87963.0, 88900.5554972221, 89375.55312223527, 91177.0, 92639.0, 9439.433633981984, 9443.480608566595, 9514.666986655433, 9611.134997849947, 9762.02379762018, 40047.1990560193, 40273.395899062125, 41258.174836502505, 42623.78688106663, 42952.140957181306, 51315.743421282656, 51381.0, 52054.0, 53555.46444535505, 53785.0, 14076.788848167082, 14330.21183834899, 14426.639334016314, 14544.563663090124, 14570.781438278222, 14951.476698315506, 16028.278727457526, 16170.595735106717, 16206.756898646294, 19182.232710691416, 16457.259423326217, 16514.504564863073, 16564.585885352964, 16585.336586536403, 16675.66648667044, 16741.665166696843, 16803.66392672164, 16825.663486730442, 16971.830281697024, 17032.233549490054, 16527.421540246032, 16577.66844663076, 16602.75095873587, 16741.665166696843, 16795.91602041982, 12278.877211227773, 12552.623421297376, 12573.559925402567, 12711.237325760114, 12761.872381276069, 13093.934530327288, 13129.080964332405, 13181.209127452383, 13488.393022313823, 13562.59312220635], "value": 8938.551606484096, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1523.4, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [100.0, 108.0, 100.0, 108.0, 107.0, 110.0, 111.0, 99.0, 109.0, 106.0], "value": 105.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [154.0, 120.0, 157.0, 169.0, 118.0, 144.0, 147.0, 122.0, 164.0, 117.0], "value": 141.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 165.0, 164.0, 162.0, 164.0, 164.0, 186.0, 169.0, 167.0, 164.0], "value": 167.0, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 82.0, 82.0, 168.0, 80.0, 78.0, 75.0, 82.0, 105.0, 76.0], "value": 90.6, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 79.0, 131.0, 80.0, 79.0, 83.0, 124.0, 78.0, 77.0, 134.0], "value": 94.6, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 114.0, 114.0, 114.0, 114.0, 114.0, 113.0, 115.0, 115.0, 118.0], "value": 114.5, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [153.0, 151.0, 150.0, 151.0, 158.0, 149.0, 150.0, 153.0, 151.0, 150.0], "value": 151.6, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [100.0, 99.0, 103.0, 93.0, 94.0, 94.0, 94.0, 94.0, 94.0, 94.0], "value": 95.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 54.0, 54.0, 55.0, 54.0, 57.0, 61.0, 58.0, 54.0, 54.0], "value": 55.5, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [56.0, 58.0, 59.0, 56.0, 58.0, 59.0, 54.0, 54.0, 55.0, 62.0], "value": 57.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 76.0, 78.0, 79.0, 79.0, 75.0, 76.0, 75.0, 75.0, 80.0], "value": 77.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [135.0, 120.0, 122.0, 136.0, 121.0, 122.0, 125.0, 121.0, 123.0, 165.0], "value": 129.0, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [172.0, 170.0, 177.0, 175.0, 170.0, 171.0, 170.0, 168.0, 180.0, 169.0], "value": 172.2, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [73.0, 67.0, 69.0, 74.0, 70.0, 78.0, 67.0, 68.0, 73.0, 66.0], "value": 70.5, "unit": "score"}]}]} 05:58:03 INFO - Return code: 0 05:58:03 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 05:58:03 INFO - # TBPL SUCCESS # 05:58:03 INFO - Running post-action listener: _package_coverage_data 05:58:03 INFO - Running post-action listener: _resource_record_post_action 05:58:03 INFO - [mozharness: 2017-08-21 12:58:03.351466Z] Finished run-tests step (success) 05:58:03 INFO - Running post-run listener: _resource_record_post_run 05:58:03 INFO - Total resource usage - Wall time: 1193s; CPU: 13.0%; Read bytes: 12288; Write bytes: 443482112; Read time: 312; Write time: 398448 05:58:03 INFO - TinderboxPrint: CPU usage
13.2% 05:58:03 INFO - TinderboxPrint: I/O read bytes / time
12,288 / 312 05:58:03 INFO - TinderboxPrint: I/O write bytes / time
443,482,112 / 398,448 05:58:03 INFO - TinderboxPrint: CPU idle
8,256.2 (86.8%) 05:58:03 INFO - TinderboxPrint: CPU user
1,203.6 (12.7%) 05:58:03 INFO - TinderboxPrint: Swap in / out
0 / 0 05:58:03 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 4096; Write bytes: 115699712; Read time: 56; Write time: 142312 05:58:03 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 05:58:03 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 8192; Write bytes: 327094272; Read time: 256; Write time: 256128 05:58:04 INFO - Running post-run listener: _upload_blobber_files 05:58:04 INFO - Blob upload gear active. 05:58:04 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 05:58:04 INFO - Files from /builds/slave/test/build/blobber_upload_dir are to be uploaded with branch at the following location(s): https://blobupload.elasticbeanstalk.com 05:58:04 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 05:58:04 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 05:58:04 INFO - (blobuploader) - INFO - Open directory for files ... 05:58:04 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 05:58:04 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:58:04 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:58:05 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 05:58:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:58:05 INFO - (blobuploader) - INFO - Done attempting. 05:58:05 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 05:58:05 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:58:05 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:58:05 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 05:58:05 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:58:05 INFO - (blobuploader) - INFO - Done attempting. 05:58:05 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 05:58:05 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:58:05 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:58:06 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 05:58:06 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:58:06 INFO - (blobuploader) - INFO - Done attempting. 05:58:06 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 05:58:06 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 05:58:06 INFO - (blobuploader) - INFO - Uploading, attempt #1. 05:58:13 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 05:58:13 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 05:58:13 INFO - (blobuploader) - INFO - Done attempting. 05:58:13 INFO - (blobuploader) - INFO - Iteration through files over. 05:58:13 INFO - Return code: 0 05:58:13 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 05:58:13 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 05:58:13 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2b2d65de3840bec4155895d620c2294408de152c3e834f3acf185cd12bd78c2dc7e4a918e219356bf05a4a9b2452af402a9e515adbcfcf555751098ed2151bf8", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dd8219ffcdd25fb0019f9986ca074e80f6d8cbaecfbffef24fdeee3a81eab9b8fdfde7bc84e3c20d9ad0a0a28970c130167a613130bb2e3cfdcb7be43ea7218d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c8db7d555a53368a017f80309fba4dbd80b0c771f762e6f29385348252b3101840e91c337eb01b4ddb497f3a68b147c56eeae21ff28816dda17fa72d38fa1476", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d07081452808f043f63ecaf5671c7e583c5cd30ab38ce43a2a123870062f9e8f7701280463c4e2b5703c34dec127856c9f792ec42340357612469d4a853e43f8"} 05:58:13 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 05:58:13 INFO - Writing to file /builds/slave/test/properties/blobber_files 05:58:13 INFO - Contents: 05:58:13 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2b2d65de3840bec4155895d620c2294408de152c3e834f3acf185cd12bd78c2dc7e4a918e219356bf05a4a9b2452af402a9e515adbcfcf555751098ed2151bf8", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dd8219ffcdd25fb0019f9986ca074e80f6d8cbaecfbffef24fdeee3a81eab9b8fdfde7bc84e3c20d9ad0a0a28970c130167a613130bb2e3cfdcb7be43ea7218d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c8db7d555a53368a017f80309fba4dbd80b0c771f762e6f29385348252b3101840e91c337eb01b4ddb497f3a68b147c56eeae21ff28816dda17fa72d38fa1476", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d07081452808f043f63ecaf5671c7e583c5cd30ab38ce43a2a123870062f9e8f7701280463c4e2b5703c34dec127856c9f792ec42340357612469d4a853e43f8"} 05:58:13 INFO - Running post-run listener: copy_logs_to_upload_dir 05:58:13 INFO - Copying logs to upload dir... 05:58:13 INFO - mkdir: /builds/slave/test/build/upload/logs 05:58:13 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1254.536351 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 54 secs) (at 2017-08-21 05:58:12.882990) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-08-21 05:58:12.887481) ========= bash -c 'for file in `ls -1`; do cat $file; done' in dir /builds/slave/test/properties (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'for file in `ls -1`; do cat $file; done'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test/properties SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2b2d65de3840bec4155895d620c2294408de152c3e834f3acf185cd12bd78c2dc7e4a918e219356bf05a4a9b2452af402a9e515adbcfcf555751098ed2151bf8", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dd8219ffcdd25fb0019f9986ca074e80f6d8cbaecfbffef24fdeee3a81eab9b8fdfde7bc84e3c20d9ad0a0a28970c130167a613130bb2e3cfdcb7be43ea7218d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c8db7d555a53368a017f80309fba4dbd80b0c771f762e6f29385348252b3101840e91c337eb01b4ddb497f3a68b147c56eeae21ff28816dda17fa72d38fa1476", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d07081452808f043f63ecaf5671c7e583c5cd30ab38ce43a2a123870062f9e8f7701280463c4e2b5703c34dec127856c9f792ec42340357612469d4a853e43f8"} build_url:https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011312 build_url: 'https://queue.taskcluster.net/v1/task/GY_CFQtjQZGJCDtqe6SoTw/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2b2d65de3840bec4155895d620c2294408de152c3e834f3acf185cd12bd78c2dc7e4a918e219356bf05a4a9b2452af402a9e515adbcfcf555751098ed2151bf8", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/dd8219ffcdd25fb0019f9986ca074e80f6d8cbaecfbffef24fdeee3a81eab9b8fdfde7bc84e3c20d9ad0a0a28970c130167a613130bb2e3cfdcb7be43ea7218d", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/c8db7d555a53368a017f80309fba4dbd80b0c771f762e6f29385348252b3101840e91c337eb01b4ddb497f3a68b147c56eeae21ff28816dda17fa72d38fa1476", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d07081452808f043f63ecaf5671c7e583c5cd30ab38ce43a2a123870062f9e8f7701280463c4e2b5703c34dec127856c9f792ec42340357612469d4a853e43f8"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-08-21 05:58:12.918029) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-08-21 05:58:12.922353) ========= rm -f oauth.txt in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['rm', '-f', 'oauth.txt'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=c6927cf182745ad25b1d38b9000001fe-1503319036.627080-591302778 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004563 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-08-21 05:58:13.004060) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-08-21 05:58:13.007457) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-08-21 05:58:13.007750) ========= ========= Total master_lag: 0.19 =========