builder: mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s slave: talos-linux64-ix-059 starttime: 1499989560.54 results: success (0) revision: 1afceff864d54d89d49b99bc7d7a369af63a6eca ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-07-13 16:46:00.541733) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-07-13 16:46:00.542104) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-07-13 16:46:00.542378) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-07-13 16:46:00.597166) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-13 16:46:00.597428) ========= 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=3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-07-13 16:46:02-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 228M=0s 2017-07-13 16:46:02 (228 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.095627 ========= master_lag: 0.05 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-13 16:46:00.743100) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-07-13 16:46:00.743404) ========= 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=3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.021086 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-07-13 16:46:00.798378) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-13 16:46:00.801722) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 1afceff864d54d89d49b99bc7d7a369af63a6eca --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 1afceff864d54d89d49b99bc7d7a369af63a6eca --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=3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-07-13 16:46:02,746 truncating revision to first 12 chars 2017-07-13 16:46:02,747 Setting DEBUG logging. 2017-07-13 16:46:02,747 attempt 1/10 2017-07-13 16:46:02,747 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/1afceff864d5?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-07-13 16:46:03,164 unpacking tar archive at: mozilla-central-1afceff864d5/testing/mozharness/ program finished with exit code 0 elapsedTime=0.717999 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-07-13 16:46:01.536942) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-07-13 16:46:01.537219) ========= script_repo_revision: 1afceff864d54d89d49b99bc7d7a369af63a6eca ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-07-13 16:46:01.537583) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-07-13 16:46:01.537862) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-07-13 16:46:01.560389) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 53 secs) (at 2017-07-13 16:46:01.563669) ========= /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=3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 16:46:03 INFO - MultiFileLogger online at 20170713 16:46:03 in /builds/slave/test 16:46:03 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 16:46:03 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 16:46:03 INFO - {'append_to_log': False, 16:46:03 INFO - 'base_work_dir': '/builds/slave/test', 16:46:03 INFO - 'blob_upload_branch': 'Firefox', 16:46:03 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 16:46:03 INFO - 'branch': 'Firefox', 16:46:03 INFO - 'buildbot_json_path': 'buildprops.json', 16:46:03 INFO - 'code_coverage': False, 16:46:03 INFO - 'config_files': ('talos/linux_config.py',), 16:46:03 INFO - 'default_actions': ('clobber', 16:46:03 INFO - 'read-buildbot-config', 16:46:03 INFO - 'download-and-extract', 16:46:03 INFO - 'populate-webroot', 16:46:03 INFO - 'create-virtualenv', 16:46:03 INFO - 'install', 16:46:03 INFO - 'setup-mitmproxy', 16:46:03 INFO - 'run-tests'), 16:46:03 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:46:03 INFO - 'disable_ccov_upload': False, 16:46:03 INFO - 'download_minidump_stackwalk': True, 16:46:03 INFO - 'download_symbols': 'ondemand', 16:46:03 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:46:03 INFO - 'tooltool.py': '/tools/tooltool.py', 16:46:03 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:46:03 INFO - '/tools/misc-python/virtualenv.py')}, 16:46:03 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:46:03 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:46:03 INFO - 'gecko_profile': False, 16:46:03 INFO - 'gecko_profile_interval': 0, 16:46:03 INFO - 'installer_path': 'installer.exe', 16:46:03 INFO - 'log_level': 'info', 16:46:03 INFO - 'log_name': 'talos', 16:46:03 INFO - 'log_to_console': True, 16:46:03 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 16:46:03 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 16:46:03 INFO - 'opt_config_files': (), 16:46:03 INFO - 'pip_index': False, 16:46:03 INFO - 'suite': 'dromaeojs-e10s', 16:46:03 INFO - 'system_bits': '32', 16:46:03 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:46:03 INFO - 'title': 'talos-linux64-ix-059', 16:46:03 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:46:03 INFO - 'use_talos_json': True, 16:46:03 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 16:46:03 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:46:03 INFO - 'work_dir': 'build'} 16:46:03 INFO - [mozharness: 2017-07-13 23:46:03.611935Z] Running clobber step. 16:46:03 INFO - Running pre-action listener: _resource_record_pre_action 16:46:03 INFO - Running main action method: clobber 16:46:03 INFO - rmtree: /builds/slave/test/build 16:46:03 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 16:46:04 INFO - Running post-action listener: _resource_record_post_action 16:46:04 INFO - [mozharness: 2017-07-13 23:46:04.654146Z] Finished clobber step (success) 16:46:04 INFO - [mozharness: 2017-07-13 23:46:04.654249Z] Running read-buildbot-config step. 16:46:04 INFO - Running pre-action listener: _resource_record_pre_action 16:46:04 INFO - Running main action method: read_buildbot_config 16:46:04 INFO - Using buildbot properties: 16:46:04 INFO - { 16:46:04 INFO - "project": "", 16:46:04 INFO - "product": "firefox", 16:46:04 INFO - "who": "kwierso@gmail.com", 16:46:04 INFO - "installer_path": "public/build/target.tar.bz2", 16:46:04 INFO - "builddir": "mozilla-central_ubuntu64_hw_stylo_test-dromaeojs-e10s", 16:46:04 INFO - "repository": "https://hg.mozilla.org/mozilla-central/", 16:46:04 INFO - "buildername": "Ubuntu HW 12.04 x64 stylo mozilla-central talos dromaeojs-e10s", 16:46:04 INFO - "stage_platform": "linux64-stylo", 16:46:04 INFO - "basedir": "/builds/slave/test", 16:46:04 INFO - "buildnumber": 26, 16:46:04 INFO - "platform": "ubuntu64_hw_stylo", 16:46:04 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 16:46:04 INFO - "slavebuilddir": "test", 16:46:04 INFO - "taskId": "R42XEgPlQp-o_p6vv7C9sg", 16:46:04 INFO - "branch": "mozilla-central", 16:46:04 INFO - "script_repo_revision": "production", 16:46:04 INFO - "revision": "1afceff864d54d89d49b99bc7d7a369af63a6eca", 16:46:04 INFO - "slavename": "talos-linux64-ix-059", 16:46:04 INFO - "repo_path": "mozilla-central" 16:46:04 INFO - } 16:46:04 INFO - Finding installer, test and symbols from parent task. 16:46:04 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/R42XEgPlQp-o_p6vv7C9sg'}, attempt #1 16:46:05 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/R42XEgPlQp-o_p6vv7C9sg'}, attempt #1 16:46:05 INFO - Task dependencies: diqf5GLoTzCvB2x2cU6-GQ 16:46:05 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ'}, attempt #1 16:46:06 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.tar.bz2 16:46:06 INFO - Set test_url: https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/test_packages.json 16:46:06 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.crashreporter-symbols.zip 16:46:06 INFO - Running post-action listener: _resource_record_post_action 16:46:06 INFO - [mozharness: 2017-07-13 23:46:06.396989Z] Finished read-buildbot-config step (success) 16:46:06 INFO - [mozharness: 2017-07-13 23:46:06.397210Z] Running download-and-extract step. 16:46:06 INFO - Running pre-action listener: _resource_record_pre_action 16:46:06 INFO - Running main action method: download_and_extract 16:46:06 INFO - mkdir: /builds/slave/test/build/tests 16:46: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')]} 16:46:06 INFO - trying https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.test_packages.json 16:46:06 INFO - Downloading https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 16:46:06 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 16:46:06 INFO - Downloaded 989 bytes. 16:46:06 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 16:46:06 INFO - Using the following test package requirements: 16:46:06 INFO - {u'awsy': [u'target.common.tests.zip', u'target.awsy.tests.zip'], 16:46:06 INFO - u'common': [u'target.common.tests.zip'], 16:46:06 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 16:46:06 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 16:46:06 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 16:46:06 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 16:46:06 INFO - u'mozbase': [u'target.common.tests.zip'], 16:46:06 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 16:46:06 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 16:46:06 INFO - u'web-platform': [u'target.common.tests.zip', 16:46:06 INFO - u'target.web-platform.tests.tar.gz'], 16:46:06 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 16:46:06 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 16:46:06 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.common.tests.zip 16:46:06 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 16:46:06 INFO - Fetch https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.common.tests.zip into memory 16:46:10 INFO - Content-Length response header: 67408806 16:46:10 INFO - Bytes received: 67408806 16:46:20 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 16:46:20 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.common.tests.zip 16:46:20 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.common.tests.zip'}, attempt #1 16:46:20 INFO - Fetch https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.common.tests.zip into memory 16:46:22 INFO - Content-Length response header: 67408806 16:46:22 INFO - Bytes received: 67408806 16:46:34 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.talos.tests.zip 16:46:34 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.talos.tests.zip'}, attempt #1 16:46:34 INFO - Fetch https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.talos.tests.zip into memory 16:46:35 INFO - Content-Length response header: 14494499 16:46:35 INFO - Bytes received: 14494499 16:46:36 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')]} 16:46:36 INFO - trying https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.tar.bz2 16:46:36 INFO - Downloading https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 16:46:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 16:46:38 INFO - Downloaded 62305950 bytes. 16:46:38 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.tar.bz2 16:46:38 INFO - mkdir: /builds/slave/test/properties 16:46:38 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 16:46:38 INFO - Writing to file /builds/slave/test/properties/build_url 16:46:38 INFO - Contents: 16:46:38 INFO - build_url:https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.tar.bz2 16:46:38 INFO - Running post-action listener: _resource_record_post_action 16:46:38 INFO - Running post-action listener: set_extra_try_arguments 16:46:38 INFO - [mozharness: 2017-07-13 23:46:38.301115Z] Finished download-and-extract step (success) 16:46:38 INFO - [mozharness: 2017-07-13 23:46:38.301346Z] Running populate-webroot step. 16:46:38 INFO - Running pre-action listener: _resource_record_pre_action 16:46:38 INFO - Running main action method: populate_webroot 16:46:38 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 16:46:38 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 16:46:38 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 16:46:38 INFO - '--tppagecycles', 16:46:38 INFO - '7'], 16:46:38 INFO - 'tests': ['tsvgm']}}, 16:46:38 INFO - 'suites': {'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 16:46:38 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 16:46:38 INFO - 'tests': ['dromaeo_css', 'kraken']}, 16:46:38 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 16:46:38 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 16:46:38 INFO - 'talos_options': ['--disable-e10s'], 16:46:38 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:46:38 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 16:46:38 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:46:38 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 16:46:38 INFO - 'talos_options': ['--disable-e10s'], 16:46:38 INFO - 'tests': ['damp', 'tps']}, 16:46:38 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 16:46:38 INFO - 'tests': ['damp', 'tps']}, 16:46:38 INFO - 'g3': {'talos_options': ['--disable-e10s'], 16:46:38 INFO - 'tests': ['dromaeo_dom']}, 16:46:38 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:46:38 INFO - 'g4': {'talos_options': ['--disable-e10s'], 16:46:38 INFO - 'tests': ['basic_compositor_video', 'glvideo']}, 16:46:38 INFO - 'g4-e10s': {'tests': ['basic_compositor_video', 'glvideo']}, 16:46:38 INFO - 'g5-e10s': {'pagesets_name': 'tp5n.zip', 16:46:38 INFO - 'tests': ['ts_paint_webext', 'tp5o_webext']}, 16:46:38 INFO - 'other': {'talos_options': ['--disable-e10s'], 16:46:38 INFO - 'tests': ['a11yr', 16:46:38 INFO - 'ts_paint', 16:46:38 INFO - 'tpaint', 16:46:38 INFO - 'sessionrestore', 16:46:38 INFO - 'sessionrestore_no_auto_restore', 16:46:38 INFO - 'tabpaint']}, 16:46:38 INFO - 'other-e10s': {'tests': ['a11yr', 16:46:38 INFO - 'ts_paint', 16:46:38 INFO - 'tpaint', 16:46:38 INFO - 'sessionrestore', 16:46:38 INFO - 'sessionrestore_many_windows', 16:46:38 INFO - 'sessionrestore_no_auto_restore', 16:46:38 INFO - 'tabpaint']}, 16:46:38 INFO - 'other-e10s_l64': {'tests': ['a11yr', 16:46:38 INFO - 'ts_paint', 16:46:38 INFO - 'tpaint', 16:46:38 INFO - 'sessionrestore', 16:46:38 INFO - 'sessionrestore_many_windows', 16:46:38 INFO - 'sessionrestore_no_auto_restore', 16:46:38 INFO - 'tabpaint']}, 16:46:38 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 16:46:38 INFO - 'ts_paint', 16:46:38 INFO - 'tpaint', 16:46:38 INFO - 'sessionrestore', 16:46:38 INFO - 'sessionrestore_many_windows', 16:46:38 INFO - 'sessionrestore_no_auto_restore', 16:46:38 INFO - 'tabpaint']}, 16:46:38 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 16:46:38 INFO - 'tests': ['a11yr', 16:46:38 INFO - 'ts_paint', 16:46:38 INFO - 'tpaint', 16:46:38 INFO - 'sessionrestore', 16:46:38 INFO - 'sessionrestore_no_auto_restore', 16:46:38 INFO - 'tabpaint']}, 16:46:38 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 16:46:38 INFO - 'tests': ['a11yr', 16:46:38 INFO - 'ts_paint', 16:46:38 INFO - 'tpaint', 16:46:38 INFO - 'sessionrestore', 16:46:38 INFO - 'sessionrestore_no_auto_restore', 16:46:38 INFO - 'tabpaint']}, 16:46:38 INFO - 'perf-reftest': {'tests': ['bloom_basic']}, 16:46:38 INFO - 'perf-reftest-e10s': {'tests': ['bloom_basic']}, 16:46:38 INFO - 'perf-reftest-singletons-e10s': {'tests': ['bloom_basic_singleton']}, 16:46:38 INFO - 'quantum-pageload-e10s': {'mitmproxy_recording_set': 'mitmproxy-recording-set-win10.zip', 16:46:38 INFO - 'talos_options': ['--mitmproxy', 16:46:38 INFO - 'mitmproxy-recording-google.mp mitmproxy-recording-youtube.mp mitmproxy-recording-amazon.mp mitmproxy-recording-facebook.mp', 16:46:38 INFO - '--firstNonBlankPaint'], 16:46:38 INFO - 'tests': ['quantum_pageload_google', 16:46:38 INFO - 'quantum_pageload_youtube', 16:46:38 INFO - 'quantum_pageload_amazon', 16:46:38 INFO - 'quantum_pageload_facebook']}, 16:46:38 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 16:46:38 INFO - 'tests': ['tsvgx', 16:46:38 INFO - 'tsvgr_opacity', 16:46:38 INFO - 'tart', 16:46:38 INFO - 'tscrollx', 16:46:38 INFO - 'cart', 16:46:38 INFO - 'tsvg_static']}, 16:46:38 INFO - 'svgr-e10s': {'tests': ['tsvgx', 16:46:38 INFO - 'tsvgr_opacity', 16:46:38 INFO - 'tart', 16:46:38 INFO - 'tscrollx', 16:46:38 INFO - 'cart', 16:46:38 INFO - 'tsvg_static']}, 16:46:38 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 16:46:38 INFO - 'talos_options': ['--disable-e10s'], 16:46:38 INFO - 'tests': ['tp5o']}, 16:46:38 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 16:46:38 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 16:46:38 INFO - 'talos_options': ['--disable-e10s', 16:46:38 INFO - '--xperf_path', 16:46:38 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:46:38 INFO - 'tests': ['tp5n']}, 16:46:38 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 16:46:38 INFO - 'talos_options': ['--xperf_path', 16:46:38 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:46:38 INFO - 'tests': ['tp5n']}}, 16:46:38 INFO - 'talos.zip': {'path': '', 16:46:38 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 16:46:38 INFO - Running post-action listener: _resource_record_post_action 16:46:38 INFO - [mozharness: 2017-07-13 23:46:38.324649Z] Finished populate-webroot step (success) 16:46:38 INFO - [mozharness: 2017-07-13 23:46:38.324740Z] Running create-virtualenv step. 16:46:38 INFO - Running pre-action listener: _resource_record_pre_action 16:46:38 INFO - Running main action method: create_virtualenv 16:46:38 INFO - Creating virtualenv /builds/slave/test/build/venv 16:46:38 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 16:46:38 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 16:46:38 INFO - Using partial env: {'VIRTUALENV_NO_DOWNLOAD': '1'} 16:46:38 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:46:38 INFO - Using real prefix '/usr' 16:46:38 INFO - New python executable in /builds/slave/test/build/venv/bin/python 16:46:38 INFO - Installing distribute.............................................................................................................................................................................................done. 16:46:40 INFO - Installing pip.................done. 16:46:40 INFO - Return code: 0 16:46:40 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 16:46:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 16:46:41 INFO - Reading from file tmpfile_stdout 16:46:41 INFO - Output received: 16:46:41 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) 16:46:41 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 16:46:41 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')]} 16:46:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:46:41 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')]} 16:46:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:46:41 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 0xaaf1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc7ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe1efa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe222a0>, '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 0xe232b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe1d4d0>, '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': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', '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 16:46:41 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 16:46:41 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 16:46:41 INFO - Using env: {'DISPLAY': ':0', 16:46:41 INFO - 'HOME': '/home/cltbld', 16:46:41 INFO - 'LANG': 'en_US.UTF-8', 16:46:41 INFO - 'LANGUAGE': 'en_US:en', 16:46:41 INFO - 'LOGNAME': 'cltbld', 16:46:41 INFO - 'MAIL': '/var/mail/cltbld', 16:46:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:46:41 INFO - 'MOZ_NO_REMOTE': '1', 16:46:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:46:41 INFO - 'NO_EM_RESTART': '1', 16:46:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:46:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:46:41 INFO - 'PWD': '/builds/slave/test', 16:46:41 INFO - 'SHELL': '/bin/bash', 16:46:41 INFO - 'SHLVL': '1', 16:46:41 INFO - 'TERM': 'linux', 16:46:41 INFO - 'TMOUT': '86400', 16:46:41 INFO - 'USER': 'cltbld', 16:46:41 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', 16:46:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:46:41 INFO - '_': '/tools/buildbot/bin/python'} 16:46:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:46:41 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 16:46:41 INFO - Cleaning up... 16:46:41 INFO - Return code: 0 16:46:41 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 16:46:41 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')]} 16:46:41 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:46:41 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')]} 16:46:41 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:46:41 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 0xaaf1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc7ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe1efa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe222a0>, '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 0xe232b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe1d4d0>, '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': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', '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 16:46:41 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 16:46:41 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 16:46:41 INFO - Using env: {'DISPLAY': ':0', 16:46:41 INFO - 'HOME': '/home/cltbld', 16:46:41 INFO - 'LANG': 'en_US.UTF-8', 16:46:41 INFO - 'LANGUAGE': 'en_US:en', 16:46:41 INFO - 'LOGNAME': 'cltbld', 16:46:41 INFO - 'MAIL': '/var/mail/cltbld', 16:46:41 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:46:41 INFO - 'MOZ_NO_REMOTE': '1', 16:46:41 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:46:41 INFO - 'NO_EM_RESTART': '1', 16:46:41 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:46:41 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:46:41 INFO - 'PWD': '/builds/slave/test', 16:46:41 INFO - 'SHELL': '/bin/bash', 16:46:41 INFO - 'SHLVL': '1', 16:46:41 INFO - 'TERM': 'linux', 16:46:41 INFO - 'TMOUT': '86400', 16:46:41 INFO - 'USER': 'cltbld', 16:46:41 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', 16:46:41 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:46:41 INFO - '_': '/tools/buildbot/bin/python'} 16:46:41 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:46:41 INFO - Downloading/unpacking psutil>=3.1.1 16:46:41 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 16:46:41 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 16:46:41 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 16:46:41 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 16:46:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 16:46:42 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:46:42 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:46:42 INFO - Installing collected packages: psutil 16:46:42 INFO - Running setup.py install for psutil 16:46:42 INFO - building 'psutil._psutil_linux' extension 16:46:42 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 16:46:42 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 16:46:43 INFO - building 'psutil._psutil_posix' extension 16:46:43 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 16:46:43 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 16:46:43 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:46:43 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:46:43 INFO - Successfully installed psutil 16:46:43 INFO - Cleaning up... 16:46:43 INFO - Return code: 0 16:46:43 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 16:46:43 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')]} 16:46:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:46:43 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')]} 16:46:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:46:43 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 0xaaf1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc7ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe1efa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe222a0>, '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 0xe232b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe1d4d0>, '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': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', '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 16:46:43 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 16:46:43 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 16:46:43 INFO - Using env: {'DISPLAY': ':0', 16:46:43 INFO - 'HOME': '/home/cltbld', 16:46:43 INFO - 'LANG': 'en_US.UTF-8', 16:46:43 INFO - 'LANGUAGE': 'en_US:en', 16:46:43 INFO - 'LOGNAME': 'cltbld', 16:46:43 INFO - 'MAIL': '/var/mail/cltbld', 16:46:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:46:43 INFO - 'MOZ_NO_REMOTE': '1', 16:46:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:46:43 INFO - 'NO_EM_RESTART': '1', 16:46:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:46:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:46:43 INFO - 'PWD': '/builds/slave/test', 16:46:43 INFO - 'SHELL': '/bin/bash', 16:46:43 INFO - 'SHLVL': '1', 16:46:43 INFO - 'TERM': 'linux', 16:46:43 INFO - 'TMOUT': '86400', 16:46:43 INFO - 'USER': 'cltbld', 16:46:43 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', 16:46:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:46:43 INFO - '_': '/tools/buildbot/bin/python'} 16:46:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:46:43 INFO - Downloading/unpacking mozsystemmonitor==0.3 16:46:43 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 16:46:43 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 16:46:43 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 16:46:43 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 16:46:44 INFO - Downloading mozsystemmonitor-0.3.tar.gz 16:46:44 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:46:44 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 16:46:44 INFO - Installing collected packages: mozsystemmonitor 16:46:44 INFO - Running setup.py install for mozsystemmonitor 16:46:44 INFO - Successfully installed mozsystemmonitor 16:46:44 INFO - Cleaning up... 16:46:44 INFO - Return code: 0 16:46:44 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 16:46:44 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')]} 16:46:44 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:46:44 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')]} 16:46:44 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:46:44 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 0xaaf1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc7ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe1efa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe222a0>, '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 0xe232b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe1d4d0>, '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': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', '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 16:46:44 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 16:46:44 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 16:46:44 INFO - Using env: {'DISPLAY': ':0', 16:46:44 INFO - 'HOME': '/home/cltbld', 16:46:44 INFO - 'LANG': 'en_US.UTF-8', 16:46:44 INFO - 'LANGUAGE': 'en_US:en', 16:46:44 INFO - 'LOGNAME': 'cltbld', 16:46:44 INFO - 'MAIL': '/var/mail/cltbld', 16:46:44 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:46:44 INFO - 'MOZ_NO_REMOTE': '1', 16:46:44 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:46:44 INFO - 'NO_EM_RESTART': '1', 16:46:44 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:46:44 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:46:44 INFO - 'PWD': '/builds/slave/test', 16:46:44 INFO - 'SHELL': '/bin/bash', 16:46:44 INFO - 'SHLVL': '1', 16:46:44 INFO - 'TERM': 'linux', 16:46:44 INFO - 'TMOUT': '86400', 16:46:44 INFO - 'USER': 'cltbld', 16:46:44 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', 16:46:44 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:46:44 INFO - '_': '/tools/buildbot/bin/python'} 16:46:44 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:46:44 INFO - Downloading/unpacking jsonschema==2.5.1 16:46:44 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 16:46:44 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 16:46:44 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 16:46:44 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 16:46:46 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 16:46:46 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 16:46:46 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 16:46:46 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 16:46:46 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 16:46:46 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 16:46:46 INFO - Downloading functools32-3.2.3-2.tar.gz 16:46:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 16:46:46 INFO - warning: no files found matching '*.txt' 16:46:46 INFO - no previously-included directories found matching 'build' 16:46:46 INFO - no previously-included directories found matching 'dist' 16:46:46 INFO - no previously-included directories found matching '.git*' 16:46:46 INFO - Installing collected packages: jsonschema, functools32 16:46:46 INFO - Running setup.py install for functools32 16:46:46 INFO - warning: no files found matching '*.txt' 16:46:46 INFO - no previously-included directories found matching 'build' 16:46:46 INFO - no previously-included directories found matching 'dist' 16:46:46 INFO - no previously-included directories found matching '.git*' 16:46:46 INFO - Successfully installed jsonschema functools32 16:46:46 INFO - Cleaning up... 16:46:46 INFO - Return code: 0 16:46:46 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 16:46:46 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')]} 16:46:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:46:46 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')]} 16:46:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:46:46 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 0xaaf1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc7ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe1efa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe222a0>, '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 0xe232b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe1d4d0>, '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': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', '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 16:46:46 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 16:46:46 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 16:46:46 INFO - Using env: {'DISPLAY': ':0', 16:46:46 INFO - 'HOME': '/home/cltbld', 16:46:46 INFO - 'LANG': 'en_US.UTF-8', 16:46:46 INFO - 'LANGUAGE': 'en_US:en', 16:46:46 INFO - 'LOGNAME': 'cltbld', 16:46:46 INFO - 'MAIL': '/var/mail/cltbld', 16:46:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:46:46 INFO - 'MOZ_NO_REMOTE': '1', 16:46:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:46:46 INFO - 'NO_EM_RESTART': '1', 16:46:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:46:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:46:46 INFO - 'PWD': '/builds/slave/test', 16:46:46 INFO - 'SHELL': '/bin/bash', 16:46:46 INFO - 'SHLVL': '1', 16:46:46 INFO - 'TERM': 'linux', 16:46:46 INFO - 'TMOUT': '86400', 16:46:46 INFO - 'USER': 'cltbld', 16:46:46 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', 16:46:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:46:46 INFO - '_': '/tools/buildbot/bin/python'} 16:46:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:46:46 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 16:46:46 INFO - Cleaning up... 16:46:46 INFO - Return code: 0 16:46:46 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 16:46:46 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')]} 16:46:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:46:46 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')]} 16:46:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:46:46 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 0xaaf1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc7ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe1efa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe222a0>, '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 0xe232b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe1d4d0>, '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': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', '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 16:46:46 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 16:46:46 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 16:46:46 INFO - Using env: {'DISPLAY': ':0', 16:46:46 INFO - 'HOME': '/home/cltbld', 16:46:46 INFO - 'LANG': 'en_US.UTF-8', 16:46:46 INFO - 'LANGUAGE': 'en_US:en', 16:46:46 INFO - 'LOGNAME': 'cltbld', 16:46:46 INFO - 'MAIL': '/var/mail/cltbld', 16:46:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:46:46 INFO - 'MOZ_NO_REMOTE': '1', 16:46:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:46:46 INFO - 'NO_EM_RESTART': '1', 16:46:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:46:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:46:46 INFO - 'PWD': '/builds/slave/test', 16:46:46 INFO - 'SHELL': '/bin/bash', 16:46:46 INFO - 'SHLVL': '1', 16:46:46 INFO - 'TERM': 'linux', 16:46:46 INFO - 'TMOUT': '86400', 16:46:46 INFO - 'USER': 'cltbld', 16:46:46 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', 16:46:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:46:46 INFO - '_': '/tools/buildbot/bin/python'} 16:46:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:46:46 INFO - Downloading/unpacking blobuploader==1.2.4 16:46:46 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 16:46:46 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 16:46:46 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 16:46:46 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 16:46:48 INFO - Downloading blobuploader-1.2.4.tar.gz 16:46:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:46:48 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:46:48 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 16:46:48 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 16:46:48 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 16:46:48 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 16:46:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:46:48 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:46:48 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 16:46:48 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 16:46:48 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 16:46:48 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 16:46:48 INFO - Downloading docopt-0.6.1.tar.gz 16:46:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:46:48 INFO - Installing collected packages: blobuploader, requests, docopt 16:46:48 INFO - Running setup.py install for blobuploader 16:46:48 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:46:48 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:46:48 INFO - Running setup.py install for requests 16:46:49 INFO - Running setup.py install for docopt 16:46:49 INFO - Successfully installed blobuploader requests docopt 16:46:49 INFO - Cleaning up... 16:46:49 INFO - Return code: 0 16:46:49 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:46:49 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')]} 16:46:49 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:46:49 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')]} 16:46:49 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:46:49 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 0xaaf1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc7ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe1efa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe222a0>, '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 0xe232b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe1d4d0>, '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': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', '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 16:46:49 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 16:46:49 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 16:46:49 INFO - Using env: {'DISPLAY': ':0', 16:46:49 INFO - 'HOME': '/home/cltbld', 16:46:49 INFO - 'LANG': 'en_US.UTF-8', 16:46:49 INFO - 'LANGUAGE': 'en_US:en', 16:46:49 INFO - 'LOGNAME': 'cltbld', 16:46:49 INFO - 'MAIL': '/var/mail/cltbld', 16:46:49 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:46:49 INFO - 'MOZ_NO_REMOTE': '1', 16:46:49 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:46:49 INFO - 'NO_EM_RESTART': '1', 16:46:49 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:46:49 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:46:49 INFO - 'PWD': '/builds/slave/test', 16:46:49 INFO - 'SHELL': '/bin/bash', 16:46:49 INFO - 'SHLVL': '1', 16:46:49 INFO - 'TERM': 'linux', 16:46:49 INFO - 'TMOUT': '86400', 16:46:49 INFO - 'USER': 'cltbld', 16:46:49 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', 16:46:49 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:46:49 INFO - '_': '/tools/buildbot/bin/python'} 16:46:49 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:46:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:46:49 INFO - Running setup.py (path:/tmp/pip-S2874_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:46:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:46:49 INFO - Running setup.py (path:/tmp/pip-XvW7m2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:46:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:46:49 INFO - Running setup.py (path:/tmp/pip-XrxoyC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:46:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:46:49 INFO - Running setup.py (path:/tmp/pip-KKpTB_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:46:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:46:49 INFO - Running setup.py (path:/tmp/pip-m8ie9m-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:46:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:46:49 INFO - Running setup.py (path:/tmp/pip-tOjqWe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:46:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:46:49 INFO - Running setup.py (path:/tmp/pip-gNbz7O-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:46:49 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:46:49 INFO - Running setup.py (path:/tmp/pip-bU9ecA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:46:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:46:50 INFO - Running setup.py (path:/tmp/pip-Es6ytj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:46:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:46:50 INFO - Running setup.py (path:/tmp/pip-lBjnNc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:46:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:46:50 INFO - Running setup.py (path:/tmp/pip-M2wxG7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:46:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:46:50 INFO - Running setup.py (path:/tmp/pip-EL1HHh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:46:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:46:50 INFO - Running setup.py (path:/tmp/pip-rOTU3w-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:46:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:46:50 INFO - Running setup.py (path:/tmp/pip-33YQ2M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:46:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:46:50 INFO - Running setup.py (path:/tmp/pip-f5vYpT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:46:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:46:50 INFO - Running setup.py (path:/tmp/pip-EgmSkb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:46:50 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:46:50 INFO - Running setup.py (path:/tmp/pip-KP2ecq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:46:50 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:46:50 INFO - Running setup.py install for manifestparser 16:46:50 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:46:50 INFO - Running setup.py install for mozcrash 16:46:50 INFO - Running setup.py install for mozdebug 16:46:50 INFO - Running setup.py install for mozdevice 16:46:51 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:46:51 INFO - Running setup.py install for mozfile 16:46:51 INFO - Running setup.py install for mozhttpd 16:46:51 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:46:51 INFO - Running setup.py install for mozinfo 16:46:51 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:46:51 INFO - Running setup.py install for mozInstall 16:46:51 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:46:51 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:46:51 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:46:51 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:46:51 INFO - Running setup.py install for mozleak 16:46:51 INFO - Running setup.py install for mozlog 16:46:51 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:46:51 INFO - Running setup.py install for moznetwork 16:46:51 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:46:51 INFO - Running setup.py install for mozprocess 16:46:51 INFO - Running setup.py install for mozprofile 16:46:51 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:46:51 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:46:51 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:46:52 INFO - Running setup.py install for mozrunner 16:46:52 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:46:52 INFO - Running setup.py install for mozscreenshot 16:46:52 INFO - Running setup.py install for moztest 16:46:52 INFO - Running setup.py install for mozversion 16:46:52 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:46:52 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:46:52 INFO - Cleaning up... 16:46:52 INFO - Return code: 0 16:46:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:46: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')]} 16:46:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:46: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')]} 16:46:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:46:52 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 0xaaf1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc7ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe1efa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe222a0>, '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 0xe232b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe1d4d0>, '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': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', '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 16:46:52 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 16:46:52 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 16:46:52 INFO - Using env: {'DISPLAY': ':0', 16:46:52 INFO - 'HOME': '/home/cltbld', 16:46:52 INFO - 'LANG': 'en_US.UTF-8', 16:46:52 INFO - 'LANGUAGE': 'en_US:en', 16:46:52 INFO - 'LOGNAME': 'cltbld', 16:46:52 INFO - 'MAIL': '/var/mail/cltbld', 16:46:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:46:52 INFO - 'MOZ_NO_REMOTE': '1', 16:46:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:46:52 INFO - 'NO_EM_RESTART': '1', 16:46:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:46:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:46:52 INFO - 'PWD': '/builds/slave/test', 16:46:52 INFO - 'SHELL': '/bin/bash', 16:46:52 INFO - 'SHLVL': '1', 16:46:52 INFO - 'TERM': 'linux', 16:46:52 INFO - 'TMOUT': '86400', 16:46:52 INFO - 'USER': 'cltbld', 16:46:52 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', 16:46:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:46:52 INFO - '_': '/tools/buildbot/bin/python'} 16:46:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:46:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:46:52 INFO - Running setup.py (path:/tmp/pip-8Sasz_-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:46:52 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)) 16:46:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:46:52 INFO - Running setup.py (path:/tmp/pip-p2reyI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:46:52 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)) 16:46:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:46:52 INFO - Running setup.py (path:/tmp/pip-MN0DEo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:46:52 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)) 16:46:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:46:52 INFO - Running setup.py (path:/tmp/pip-9jhxsu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:46:52 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)) 16:46:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:46:52 INFO - Running setup.py (path:/tmp/pip-Yji7Qu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:46:53 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)) 16:46:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:46:53 INFO - Running setup.py (path:/tmp/pip-qyJewk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:46:53 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)) 16:46:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:46:53 INFO - Running setup.py (path:/tmp/pip-fqdT9L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:46:53 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)) 16:46:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:46:53 INFO - Running setup.py (path:/tmp/pip-exMgP2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:46:53 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)) 16:46:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:46:53 INFO - Running setup.py (path:/tmp/pip-GrLTn9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:46:53 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)) 16:46:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:46:53 INFO - Running setup.py (path:/tmp/pip-kfu17M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:46:53 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)) 16:46:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:46:53 INFO - Running setup.py (path:/tmp/pip-EzDLlx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:46:53 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)) 16:46:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:46:53 INFO - Running setup.py (path:/tmp/pip-qKXHd0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:46:53 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)) 16:46:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:46:53 INFO - Running setup.py (path:/tmp/pip-C_35w1-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:46:53 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)) 16:46:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:46:53 INFO - Running setup.py (path:/tmp/pip-H8qtNN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:46:53 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)) 16:46:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:46:53 INFO - Running setup.py (path:/tmp/pip-LX_46F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:46:53 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)) 16:46:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:46:53 INFO - Running setup.py (path:/tmp/pip-YoyPW9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:46:53 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)) 16:46:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:46:53 INFO - Running setup.py (path:/tmp/pip-EfdgG3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:46:53 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)) 16:46:53 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)) 16:46:53 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)) 16:46:53 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)) 16:46:53 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)) 16:46:53 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)) 16:46:53 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)) 16:46:53 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.5->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:46:53 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 16:46:53 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 16:46:53 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 16:46:53 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 16:46:54 INFO - Downloading blessings-1.6.tar.gz 16:46:54 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:46:55 INFO - Installing collected packages: blessings 16:46:55 INFO - Running setup.py install for blessings 16:46:55 INFO - Successfully installed blessings 16:46:55 INFO - Cleaning up... 16:46:55 INFO - Return code: 0 16:46:55 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:46:55 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:46:55 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:46:55 INFO - Reading from file tmpfile_stdout 16:46:55 INFO - Current package versions: 16:46:55 INFO - argparse == 1.2.1 16:46:55 INFO - blessings == 1.6 16:46:55 INFO - blobuploader == 1.2.4 16:46:55 INFO - docopt == 0.6.1 16:46:55 INFO - functools32 == 3.2.3-2 16:46:55 INFO - jsonschema == 2.5.1 16:46:55 INFO - manifestparser == 1.1 16:46:55 INFO - mozInstall == 1.13 16:46:55 INFO - mozcrash == 1.0 16:46:55 INFO - mozdebug == 0.1 16:46:55 INFO - mozdevice == 0.51 16:46:55 INFO - mozfile == 1.2 16:46:55 INFO - mozhttpd == 0.7 16:46:55 INFO - mozinfo == 0.10 16:46:55 INFO - mozleak == 0.1 16:46:55 INFO - mozlog == 3.5 16:46:55 INFO - moznetwork == 0.27 16:46:55 INFO - mozprocess == 0.25 16:46:55 INFO - mozprofile == 0.28 16:46:55 INFO - mozrunner == 6.13 16:46:55 INFO - mozscreenshot == 0.1 16:46:55 INFO - mozsystemmonitor == 0.3 16:46:55 INFO - moztest == 0.8 16:46:55 INFO - mozversion == 1.4 16:46:55 INFO - psutil == 3.1.1 16:46:55 INFO - requests == 1.2.3 16:46:55 INFO - wsgiref == 0.1.2 16:46:55 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:46:55 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')]} 16:46:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:46:55 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')]} 16:46:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:46:55 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 0xaaf1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc7ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe1efa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe222a0>, '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 0xe232b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe1d4d0>, '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': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', '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 16:46:55 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 16:46:55 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 16:46:55 INFO - Using env: {'DISPLAY': ':0', 16:46:55 INFO - 'HOME': '/home/cltbld', 16:46:55 INFO - 'LANG': 'en_US.UTF-8', 16:46:55 INFO - 'LANGUAGE': 'en_US:en', 16:46:55 INFO - 'LOGNAME': 'cltbld', 16:46:55 INFO - 'MAIL': '/var/mail/cltbld', 16:46:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:46:55 INFO - 'MOZ_NO_REMOTE': '1', 16:46:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:46:55 INFO - 'NO_EM_RESTART': '1', 16:46:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:46:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:46:55 INFO - 'PWD': '/builds/slave/test', 16:46:55 INFO - 'SHELL': '/bin/bash', 16:46:55 INFO - 'SHLVL': '1', 16:46:55 INFO - 'TERM': 'linux', 16:46:55 INFO - 'TMOUT': '86400', 16:46:55 INFO - 'USER': 'cltbld', 16:46:55 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', 16:46:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:46:55 INFO - '_': '/tools/buildbot/bin/python'} 16:46:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:46:55 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)) 16:46:55 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)) 16:46:55 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)) 16:46:55 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)) 16:46:55 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)) 16:46:55 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)) 16:46:55 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)) 16:46:55 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)) 16:46:55 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)) 16:46:55 INFO - Downloading/unpacking marionette-driver>=1.4.0 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 16:46:55 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 16:46:55 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 16:46:55 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 16:46:55 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 16:46:56 INFO - Downloading marionette_driver-1.4.0.tar.gz 16:46:56 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/marionette-driver/setup.py) egg_info for package marionette-driver 16:46:56 INFO - Downloading/unpacking simplejson>=2.1.1 (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 11)) 16:46: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 16:46: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 16:46: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 16:46: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 16:46:57 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/simplejson/setup.py) egg_info for package simplejson 16:46:57 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)) 16:46:57 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)) 16:46:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner>=6.9 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from marionette-driver>=1.4.0->-r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 16:46:57 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice>=0.37 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozrunner>=6.9->marionette-driver>=1.4.0->-r /builds/slave/test/build/tests/talos/requirements.txt (line 10)) 16:46:57 INFO - Installing collected packages: marionette-driver, simplejson 16:46:57 INFO - Running setup.py install for marionette-driver 16:46:57 INFO - Running setup.py install for simplejson 16:46:57 INFO - building 'simplejson._speedups' extension 16:46:57 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 16:46:58 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 16:46:58 INFO - Successfully installed marionette-driver simplejson 16:46:58 INFO - Cleaning up... 16:46:58 INFO - Return code: 0 16:46:58 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 16:46: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')]} 16:46:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:46: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')]} 16:46:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:46: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xaaf1f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xc7ba80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xe1efa0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xe222a0>, '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 0xe232b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe1d4d0>, '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': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', '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 16:46: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', 'jsonschema'] in /builds/slave/test/build 16:46: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 jsonschema 16:46:58 INFO - Using env: {'DISPLAY': ':0', 16:46:58 INFO - 'HOME': '/home/cltbld', 16:46:58 INFO - 'LANG': 'en_US.UTF-8', 16:46:58 INFO - 'LANGUAGE': 'en_US:en', 16:46:58 INFO - 'LOGNAME': 'cltbld', 16:46:58 INFO - 'MAIL': '/var/mail/cltbld', 16:46:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:46:58 INFO - 'MOZ_NO_REMOTE': '1', 16:46:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:46:58 INFO - 'NO_EM_RESTART': '1', 16:46:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:46:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:46:58 INFO - 'PWD': '/builds/slave/test', 16:46:58 INFO - 'SHELL': '/bin/bash', 16:46:58 INFO - 'SHLVL': '1', 16:46:58 INFO - 'TERM': 'linux', 16:46:58 INFO - 'TMOUT': '86400', 16:46:58 INFO - 'USER': 'cltbld', 16:46:58 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', 16:46:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:46:58 INFO - '_': '/tools/buildbot/bin/python'} 16:46:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:46:58 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 16:46:58 INFO - Cleaning up... 16:46:58 INFO - Return code: 0 16:46:58 INFO - Running post-action listener: _resource_record_post_action 16:46:58 INFO - Running post-action listener: _start_resource_monitoring 16:46:58 INFO - Starting resource monitoring. 16:46:58 INFO - [mozharness: 2017-07-13 23:46:58.563838Z] Finished create-virtualenv step (success) 16:46:58 INFO - [mozharness: 2017-07-13 23:46:58.564351Z] Running install step. 16:46:58 INFO - Running pre-action listener: _resource_record_pre_action 16:46:58 INFO - Running main action method: install 16:46:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:46:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:46:58 INFO - Reading from file tmpfile_stdout 16:46:58 INFO - Detecting whether we're running mozinstall >=1.0... 16:46:58 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:46:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:46:58 INFO - Reading from file tmpfile_stdout 16:46:58 INFO - Output received: 16:46:58 INFO - Usage: mozinstall [options] installer 16:46:58 INFO - Options: 16:46:58 INFO - -h, --help show this help message and exit 16:46:58 INFO - -d DEST, --destination=DEST 16:46:58 INFO - Directory to install application into. [default: 16:46:58 INFO - "/builds/slave/test"] 16:46:58 INFO - --app=APP Application being installed. [default: firefox] 16:46:58 INFO - mkdir: /builds/slave/test/build/application 16:46:58 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'] 16:46:58 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 16:47:16 INFO - Reading from file tmpfile_stdout 16:47:16 INFO - Output received: 16:47:16 INFO - /builds/slave/test/build/application/firefox/firefox 16:47:16 INFO - Running post-action listener: _resource_record_post_action 16:47:16 INFO - [mozharness: 2017-07-13 23:47:16.973988Z] Finished install step (success) 16:47:16 INFO - [mozharness: 2017-07-13 23:47:16.974213Z] Running setup-mitmproxy step. 16:47:16 INFO - Running pre-action listener: _resource_record_pre_action 16:47:16 INFO - Running main action method: setup_mitmproxy 16:47:16 INFO - Skipping: mitmproxy is not required 16:47:16 INFO - Running post-action listener: _resource_record_post_action 16:47:16 INFO - [mozharness: 2017-07-13 23:47:16.975341Z] Finished setup-mitmproxy step (success) 16:47:16 INFO - [mozharness: 2017-07-13 23:47:16.975581Z] Running run-tests step. 16:47:16 INFO - Running pre-action listener: _resource_record_pre_action 16:47:16 INFO - Running pre-action listener: _set_gcov_prefix 16:47:16 INFO - Running main action method: run_tests 16:47:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:47:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:47:16 INFO - Python 2.7.3 16:47:16 INFO - Return code: 0 16:47:16 INFO - grabbing minidump binary from tooltool 16:47:16 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')]} 16:47:16 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 0xe222a0>, '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 0xe232b0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xe1d4d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:47:16 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 16:47:16 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 16:47:16 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 16:47:17 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:47:17 INFO - Return code: 0 16:47:17 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 16:47:17 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:47:17 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:47:17 INFO - ENV: RUST_BACKTRACE is now 1 16:47:17 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 16:47:17 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:47:17 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/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-059', '--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 16:47:17 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/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-059 --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 16:47:17 INFO - Using env: {'DISPLAY': ':0', 16:47:17 INFO - 'HOME': '/home/cltbld', 16:47:17 INFO - 'LANG': 'en_US.UTF-8', 16:47:17 INFO - 'LANGUAGE': 'en_US:en', 16:47:17 INFO - 'LOGNAME': 'cltbld', 16:47:17 INFO - 'MAIL': '/var/mail/cltbld', 16:47:17 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:47:17 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 16:47:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:47:17 INFO - 'MOZ_NO_REMOTE': '1', 16:47:17 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:47:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:47:17 INFO - 'NO_EM_RESTART': '1', 16:47:17 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:47:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:47:17 INFO - 'PWD': '/builds/slave/test', 16:47:17 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:47:17 INFO - 'RUST_BACKTRACE': '1', 16:47:17 INFO - 'SCRIPTSPATH': '/builds/slave/test/scripts', 16:47:17 INFO - 'SHELL': '/bin/bash', 16:47:17 INFO - 'SHLVL': '1', 16:47:17 INFO - 'TERM': 'linux', 16:47:17 INFO - 'TMOUT': '86400', 16:47:17 INFO - 'USER': 'cltbld', 16:47:17 INFO - 'XDG_SESSION_COOKIE': '3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279', 16:47:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:47:17 INFO - '_': '/tools/buildbot/bin/python'} 16:47:17 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/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-059', '--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 16:47:17 INFO - mozversion application_buildid: 20170713225135 16:47:17 INFO - mozversion application_changeset: 1afceff864d54d89d49b99bc7d7a369af63a6eca 16:47:17 INFO - mozversion application_display_name: Nightly 16:47:17 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:47:17 INFO - mozversion application_name: Firefox 16:47:17 INFO - mozversion application_remotingname: firefox 16:47:17 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 16:47:17 INFO - mozversion application_vendor: Mozilla 16:47:17 INFO - mozversion application_version: 56.0a1 16:47:17 INFO - mozversion platform_buildid: 20170713225135 16:47:17 INFO - mozversion platform_changeset: 1afceff864d54d89d49b99bc7d7a369af63a6eca 16:47:17 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 16:47:17 INFO - mozversion platform_version: 56.0a1 16:47:17 INFO - using testdate: 1499989637 16:47:17 INFO - actual date: 1499989637 16:47:17 INFO - starting webserver on 'localhost:56729' 16:47:17 INFO - SUITE-START | Running 2 tests 16:47:17 INFO - TEST-START | dromaeo_css 16:47:17 INFO - Initialising browser for dromaeo_css test... 16:47:17 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:56729/getInfo.html -profile /tmp/tmpxXQvN_/profile 16:47:17 INFO - TEST-INFO | started process 21184 (/builds/slave/test/build/application/firefox/firefox http://localhost:56729/getInfo.html) 16:47:22 INFO - TEST-INFO | 21184: exit 0 16:47:23 INFO - Browser initialized. 16:47:23 INFO - Running cycle 1/1 for dromaeo_css test... 16:47:23 INFO - TEST-INFO | started process 21410 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpxXQvN_/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 16:47:34 INFO - PID 21410 | RSS: Main: 171200512 16:47:34 INFO - PID 21410 | 16:50:32 INFO - PID 21410 | Cycle 1(1): loaded http://localhost:56729/tests/dromaeo/cssquery-dojo.html (next: http://localhost:56729/tests/dromaeo/cssquery-ext.html) 16:50:34 INFO - PID 21410 | RSS: Main: 179838976 16:50:34 INFO - PID 21410 | 16:53:36 INFO - PID 21410 | Cycle 1(1): loaded http://localhost:56729/tests/dromaeo/cssquery-ext.html (next: http://localhost:56729/tests/dromaeo/cssquery-jquery.html) 16:53:37 INFO - PID 21410 | RSS: Main: 177750016 16:53:37 INFO - PID 21410 | 16:56:38 INFO - PID 21410 | Cycle 1(1): loaded http://localhost:56729/tests/dromaeo/cssquery-jquery.html (next: http://localhost:56729/tests/dromaeo/cssquery-mootools.html) 16:56:39 INFO - PID 21410 | RSS: Main: 180047872 16:56:39 INFO - PID 21410 | 16:59:41 INFO - PID 21410 | Cycle 1(1): loaded http://localhost:56729/tests/dromaeo/cssquery-mootools.html (next: http://localhost:56729/tests/dromaeo/cssquery-prototype.html) 16:59:41 INFO - PID 21410 | RSS: Main: 179142656 16:59:41 INFO - PID 21410 | 17:02:44 INFO - PID 21410 | Cycle 1(1): loaded http://localhost:56729/tests/dromaeo/cssquery-prototype.html (next: http://localhost:56729/tests/dromaeo/cssquery-yui.html) 17:02:45 INFO - PID 21410 | RSS: Main: 178180096 17:02:45 INFO - PID 21410 | 17:05:47 INFO - PID 21410 | Cycle 1(1): loaded http://localhost:56729/tests/dromaeo/cssquery-yui.html (next: http://localhost:56729/tests/dromaeo/cssquery-dojo.html) 17:05:47 INFO - PID 21410 | RSS: Main: 181903360 17:05:47 INFO - PID 21410 | 17:05:47 INFO - PID 21410 | __start_tp_report 17:05:47 INFO - PID 21410 | _x_x_mozilla_page_load 17:05:47 INFO - PID 21410 | _x_x_mozilla_page_load_details 17:05:47 INFO - PID 21410 | |i|pagename|runs| 17:05:47 INFO - PID 21410 | |0;dojo.html;3059.3269480714234;3140.371925614877;3174.5555622212887;3185.569948057013;3193.8403079846003;5892.646441213525;5958.553108516857;5987.970060149699;6012.188354572131;6067.24159480065;6057.061155520902;6070.2412198475195;6144;6170.938290617092;6227.9688601557045;5592.6085174037835;5646.265985421889;5658.264425624663;5685.317761868581;5707.400722924095;5608.298962629671;5617.325920889499;5627.7186140693;5663.405342439047;5682.715864206793;5444.3194600674915;5511.944880551183;5516.9448305517035;5613.775448982035;5632.633878797865;5461.290032295776;5483.314585676791;5488.807891723811;5490.3411590609385;5495.010898038351;5270.947290527084;5294.814681486129;5337.866553336159;5449.700266485342;5452.345718513764;5835.183074369592;5845;5847.766089356421;5852.619579727304;5857.560682948796;6315.621062736204;6327.367263273682;6327.778527751552;6365.663210725753;6400.615963042186;6393.904091438632;6420;6435.324290949477;6444.420002199778;6447.806565803034;6001.219841420631;6010.609310394811;6045.0327947528185;6097.542684298651;6127.969360153171;6606.7026983785845;6617.636030018347;6622.8344291393105;6730.259671436138;6746.460283177334;6191.318954914956;6293.244810622755;6389.552731308764;6420.357964203542;6427.839304017343;6480.935190648128;6503.609783412916;6509.2839787623325;6524.314946930599;6526.28210896801;5487.067198576252;6424.775132870327;6449.548531602836;6492.220933488012;6504.219493660791;6429.067785171124;6489.772857949949;6489.902651460232;6532.216134063943;6587.835304117435;5290.603204759658;5299.33758280215;5357.357117145967;5380.757865896044;5380.892382152335;4487.282034874404;4545.590896819236;4563.247064234364;4587.79354929029;4612.907741845144;5633.352164501053;5662.207290979266;5668.234788303609;5678.14827775837;5684.573656975744;5455.454454554592;6476.222853257545;6533;6639.070530125786;6649.933500665028;5624.21261023457;5672.12082127271;5746.281714785652;5748.48263656273;5750.7987220447085;5737.942620573825;5760.279965004374;5871.383504731942;5874.383189765099;5880.294364676266;6157.538184636171;6198.473129784019;6217.222847144107;6339.175907132043;6451.806445806539;6426.678666066771;6446.065320528403;6450.870982580416;6454.967725161344;6472;6204.844878878064;6243.96878015607;6270.372962703876;6290.119383286252;6299.622022678654;6285.277193122849;6324.17785687876;6335.334789847184;6336.556441049082;6340.556161068681;6380.553361264667;6431.967840160769;6546.279909210079;6569.671516424064;6632.568883022588;6324.051392291193;6325.367463253638;6385;6421.71102300407;6441.677916104082;6336.398042185985;6347.301796802441;6405.103285539935;6429.517786165963;6435.51733619971;6097.7865774697675;6134.386561344008;6199.194104766351;6217.285012223652;6245.0632405139595;6130.6628135452975;6316.778912738032;6327.3988971047675;6350;6392.904106438315;5958.970205148947;6053.515718742578;6059.878802423838;6064.090386441892;6078.72645730952 17:05:47 INFO - PID 21410 | |1;ext.html;769.4229328003997;820.3724151024463;863.1023735315273;881.1276835932425;894.7092195036611;42126.78936605316;42406.787966060205;42731;42756;42921.78539107308;39854.20291594166;40279.39580906289;40335;40366.59633403665;40470.59529404705;6937.410320122783;7055.682494287744;7055.964720176392;7067.045948796924;7072.611006394646;7002.824929376781;7049.189343225517;7106.751263705772;7111.431085513173;7125.5724656520515;7033.402160816337;7041.57750534967;7062.329078737537;7073.257307982665;7085.2206257311655;7007.404370628503;7033.085698859141;7040.6127662978515;7044.330788575077;7047.083879095685;6375;6415.967920160416;6438.742450301982;6447.806565803034;6448.774292899726;34473.482897756556;34558.48162277568;34640.13399665003;34658.65341346579;34675;3360.630330663625;3419.760616756828;3500.982495087508;3577;3585.354636165489;32416.675833241603;32550.83724581362;32804.179895502566;32811;32893;4717.386739723848;4875.634327425457;4882.633802464794;4951.43058548268;4994.675346102528;183647;186488.06755966268;186708;189369;189458.05270973558;48651.75674121678;49335.75332123388;49757.25364119541;49872.50127498679;49896.50103498991;51988.74005629947;52283.47716522862;52362;52431.47568524342;52436.47563524316;15294.694106117815;15357.462488813062;15412.537623871302;15462.458813941457;15496.92251538735;12345.567905123457;12367.567135150226;12390.194637348544;12391.566295179626;12411.75176496465;14352.712945741026;14445.133292002514;14559.272036398137;14573.562793116223;14602.561923142322;5727.2268243787385;5863.413658634103;5885.47030767233;5906.291245050621;5940.435658612425;959.4962644611635;975.3759989617349;995.576879826071;1006.642641862143;1015.5683834370363;22850.771492285196;22999.88500057489;23023.769762302498;23145.88427057854;23294.65058024131;1073.0771536478621;1073.726199819041;1105.8949399807007;1106.4523061084815;1109.7780443911088;11815.940920295343;12190.2076365036;12192.268463892018;12271.263724176579;12357;230143;231194;232189;232641;233404;54048.45951540513;54094.64763380868;54447.72776136173;54597.454025459236;54622.453775461734;1430.1133297355498;1449.832884527944;1481.2519677562761;1482.2736858939043;1482.5996980815119;21919.123235071056;22046.007929642885;22638.434039149153;23043.76956230416;23135.421614459774;37992.62007380001;38092;38237.808810955765;38260.23479530338;38264.23471530498;189914;190582;190583;191385;191543;31018;31626.36747265088;32021.35957280888;32107.19732006625;35019.47470787991;42762.358564622176;45441.09117817691;45622.54377456183;46058.539414605424;46073.53926460827;29402.264943376587;30671.2332191697;32123.196920077185;32383.676163238066;32510;31171.688283116877;31876.681233188297;32128;32190.83904580462;32433.675663243066;35230;35540.822295888356;35694.464583030756;35721.82139089288;35842.4623630651;29212.561811572417;30533;31168.53247201339;31644;31763.84118079395;23063.308100757004;23131.421714457272;23215.767842322035;23291.417714557272;23364.6495302574 17:05:47 INFO - PID 21410 | |2;jquery.html;557.670974125266;560.1681502968095;567.2229046206696;574.6753084507253;599.8110595162524;21800.672989905146;22626.20808271711;22757.089716411345;22876.19933302335;22884.771152288453;25053.749462505413;26078.21765347038;27213;27443.862780686068;27550.484723340207;6746.1230040094715;6938.06336144619;6941.132358455193;6944.72221111155;6954.235034146265;6781.186257649089;6808.931910680904;6813.625250611214;6823.078884350623;6842.076319696852;4106.568810274908;4508.887277818065;6577.736890524373;6611.537509284476;6771.830704232384;6747.898781518281;6789.966050169767;6795.116634837489;6801.93198068018;6816.079829223041;6311.93688063118;6313.210848643919;6315.905261421082;6316.557840951135;6338.207724034496;26664.73335266661;30019.549706754417;30135.849320753474;30293;30369.026013309285;1961.205711686769;1972.5364539333245;1979.2182088075274;1980.8910509921948;1990.4824745566111;19368;19677.80322196774;19755.506112347164;19814.405567832844;19819.108140133583;2242.383344580237;2306.342692332677;2313.097891822174;2323.7560056194025;2401.579723548372;133791;137042;137314;137314.62685373117;137926;14372.49696260626;15092.773608395883;15284.312205950759;15304.234788260543;15346.386144554315;23996.64005039926;24034;24035.158769442987;24127;24210.75789242085;10291.794164116676;10539.894601054044;10577.894221057844;10590.788184236271;10748.193885458466;9775.755606109904;9841.065098815601;9842.409455432697;9892.036173857536;9927.851082233772;9260.444373337621;9309;9318.161365477004;9340.71977840666;9363.625454981724;2678.9460015582254;2735.7401046900513;2829.915102546927;2833.6032955386263;2905.7239562241552;948.2745699539857;956.6173530587821;978.706388083572;990.4750482244422;1010.1262408017012;20134;20439.79560204379;20440.488987775425;20480.9519048097;20863;1050.795094956476;1066.7333166708322;1073.4686330266568;1083.3932997521413;1092.8306112552566;11175.161862860317;11263.098952083814;11306.547738090549;11518.712032199095;11634.418279086012;434243;454630.86979988916;463288;465609;483936;110404;112923;112943.4352828247;113419;113575.4321228405;1211.8545774507115;1248.556762349371;1268.2200446725383;1270.5489551209373;1295.4041141075022;17194.82805171982;17855.28578856883;17899.552511187325;18536.25854965786;18828.24687012559;54060.72969635126;54504.727476362365;56104;56238.718806405705;57068.429315706315;71229.6438517804;71413.64293178501;72091;72125.27874721185;72999.63500182464;14826.481073162387;14864.182469964257;14925.92537037308;15099.24503774829;15182.164980925712;23746.88126559356;23755.762442376046;23873.522529548965;23985.160519381738;24049.398765031016;17718.645627087644;17919.193636286658;18077.36729214471;18394.63210735751;18811.153498092892;15295.464658736892;16265.59336016609;16532.917335413727;16765;17397.82602173962;19145.425637230906;19393.806061939766;19526.31657891967;19538.60922781508;19660.803391965896;14129.516400777771;14854.85145148578;14875.47935822241;14954.85045149578;14960.476383326532;19033.428997130108;19130.80869191346;19190.13644385978;19246.71129933024;19323.4202973911 17:05:47 INFO - PID 21410 | |3;mootools.html;1350.372076984202;1399.538152409705;1406.1633328169735;1415.8654927781856;1416.3980308368948;13085;13161.144525605829;13772;13783.724325513484;13783.862161378383;13568.118072325293;13766.65583360414;13771.173729576232;13782.931085344559;13815.585532434017;2632.3155979445337;2693.474772419379;2701.3651791828906;2705.269577214161;2708.201080681194;2551.9744802552013;2616.9084082057134;2620.816542842002;2625.684917809856;2628.342914271432;2478.677771889652;2520;2535.404180017694;2536.2898388451263;2538.7842033427182;2518.4711210645787;2544.8091393145496;2550.0437335999;2553.782928451084;2556.0542599238215;2476.195236548111;2498.575242208811;2501.1996161228412;2511.4349271413785;2523.8738063096957;12828.294443805587;13049.347532623426;13129.474821007243;13130.34348282582;13131.0808243423;7477.663505142282;7764.3788496920115;7776.988991431078;7779.572123533203;7814.609269536557;5110.795568177268;5129.692218466904;5174.896502069938;5175.353080864892;5196.948030519684;1825.2425243523921;1880.2103116691023;1883.2467013194832;1904.6192259675406;1932.391296741522;19698.40904772859;20260.290889818785;20384.286549970828;20571.5885682287;20573.588528229502;5683.318001839723;6336.493080553545;6492.837679058061;6590.80227593173;6596.175478065242;14648;14659.267036648125;14661.266936653125;14689.779653304995;14732;7166.570005799565;7415.740449084256;7427.702891884264;7429.405647548183;7462.925370746331;6856.24581296057;6865;6892.241853396223;6908.0674108995645;6959.756408525677;4895.951040489621;4910.2880082388565;4972.925406118911;5015.749212539358;5091.770870310845;1438.216172186161;1448.2758620689656;1452.9055611385227;1457.4461704552202;1476.3577843638052;882.8896387951506;891.1044400377579;898.1198425543005;917.8347897378402;927.2813569483704;7155.3202445767565;7754.263344982331;7855.960720196363;7857.685692572233;7949.483283586548;677.4478799778165;970.1850445625568;970.9757256068655;996.3523709588825;1040.7190058684114;4694.50707675696;4817.78319975595;4907;5058.342415485963;5146.356705411824;17442.65114697699;18099.366522171662;18111.36610218636;18119.45641630753;18129.637407251783;17380.826191738175;17602.823971760117;17619.383321583682;17623.383181588582;17637.382691605733;9693.951530242444;10367.688969330931;10645.308054976556;10664.41345725977;10785.298955567863;7668.116623559831;7714;7789.922100778919;7795.610219488889;8202.548859812767;15323.387064517294;15543.37826486973;16225.837741622905;16230.594235144215;16478;15578.29897654631;16377.099259540839;16431.753523697393;16451.25969331359;16506.25721842544;10946.45267736594;11124.888751112709;11150.275232109887;11161.218714689894;11200.215984881306;12297.200681956003;12594.937025314815;12629.873701263237;12649;12800.61598152057;9611.567479463301;9945.701628951143;9975.551100200364;10352.792944141225;10400.635977740743;9588.90411095908;9949.005099489994;9963.202943764336;10078.798424031625;10296.897031029594;8936.41913275635;9167.358284919992;9186.862197066916;9201.953990230273;9206.033366496422;6602.3397660233595;6899.241083480913;6915.896261556181;6928.515003949675;6989.405900498515;6748.831279217862;6937.895931561132;6968.79093627192;7006.124234470692;7086.433085353263 17:05:47 INFO - PID 21410 | |4;prototype.html;487.140197551322;500.53200257759;517;526.2238198656979;534.8208350202682;6077.544184186182;6082.300535438426;6117.67528339231;6173.722182501787;6217.378262173786;5879.764809407629;5973.432523910222;5983.0726237433155;6004.459598636122;6099.1766111574925;4821.397325334333;4845.466998630165;4958.925616115761;4962.776675049631;4985.703717033561;4889.217725163974;4939.654224204307;4943.579795717368;4949.851504454854;4982.277569752384;4893.535114164149;4905.852824415256;4921.901561968776;4922.458529561745;4928.654994150411;4727;4879.902401951941;4892.828750993698;4898.338724272213;4901.730404827733;4369.366441865912;4384.89037774055;4401.713888597231;4443.155800397914;4452.154090722753;5955.374685657986;5957.195778569924;5969.761209551612;5994.28068631767;6005.819825405201;5543.417941116165;5545.972270138664;5546.334439867242;5609.317204838573;5623.49388555028;6377.330380310047;6436.710348034349;6461.8061458156335;6494.480441564663;6498.317676643979;4779.235322348442;4807.495213002654;4836.637252206098;4869.074875773627;4886.682365646222;6716.529842910998;6795.830104247384;6832.726690932357;6843.756870740173;6888.724451021953;4988.850334489971;4992.227759145524;5011.373578302712;5018.372703412074;5021.573166280907;4976.377952755905;4993.975030124826;5032.597392208614;5032.84901452957;5040.798368065236;5505.476979687003;5553.305836770403;5570.554355651539;5587.55299576041;5605.215269862222;6419.133416988647;6425.421712045938;6433.806985790434;6445.452136568444;6515.674216289167;1717.2873257597957;1747.554373634715;1754.5350482122249;1759.9120043997748;1765.9470215893543;1126.695792136135;1205.8191271309374;1213.096243298748;1218.780619488483;1221.419825582841;5521;5538.944610553924;5583.883223355345;5621.7751289948765;5747.971260143672;6505.381179362706;6519.7392104315295;6567.981962795774;6583.769568065095;6596.538242323088;5630.8029218977135;5632.7746890123935;5686.516646085046;5733.397993210653;5741.540676745851;3462.4806279058344;3466.3933811582874;3466.532018177564;3490.3072010075093;3529.135361836315;6311.873762524724;6405.647689377036;6456.935430645727;6469.385408386196;6518.185226846645;6782.287859774751;6789.592624442549;6794.660266986631;6796.320367963164;6826.419754320938;6334.904976425358;6343.429091381706;6397.200349956255;6415.647139407378;6416.615003099736;6567.704453299709;6620.635865027277;6626.701798419179;6642.5018123641885;6695.397414232742;6369.426751592379;6456.870862582816;6486.805395838132;6493.870122597427;6551.887853269659;6263.404976527223;6264.906026409516;6360.681965901594;6403;6418.261899881387;4881.414230292387;4900.534449227318;4905.852824415273;4925.556699897026;4933.876653083702;6523;6574.980877963923;6578.750037492861;6613.735450581923;6642.405822602637;6351.174347334817;6358.713857876499;6401.391867772554;6414.583052101599;6436.967815160894;6300.7479700811455;6422;6455.806325810233;6456.160699109086;6488.610683359014;6294.937050629435;6301.8258700748165;6311.337309582611;6363.395477429822;6365.172527571386;5892.911606325994;6346.714397852015;6385.106085148176;6426.807195784134;6457.3865482779065;6132.896078705876;6192.783252586138;6221.346758590464;6263.27972283175;6274.717637706223 17:05:47 INFO - PID 21410 | |5;yui.html;901.3285102598564;912.7854954085789;926.2034650200826;926.6664000959657;933.9626414943402;15537.067775933452;15747.370105195778;15793.84206157938;15829.445969391074;18072.457826265218;19669.40991770249;20201.797982020213;20702.171913123457;21035.263765768203;21068.367948961517;1024.2522958240488;1043.4886905416329;1049.9002594753485;1051.1328154272717;1051.437480947693;1064.1752641702665;1064.4624464645383;1065.5205157679075;1066.1470823341335;1067.8558394616705;1011.7217765114578;1059.3590877519105;1112.3881864974232;1132.4677401621225;1133.824257240129;1099.780043991201;1099.8020356335855;1100.4332768624165;1101.6750058732694;1103.0293341859192;795.3200013988014;795.4630624328555;796.625585974591;797.0833541427347;797.5095316380442;18293.176807043714;19068.5232869178;19337.80662193374;19338.129784159606;19472.70790938137;19513.512162195915;19822.405327840188;20028.799712002838;20039.79960200394;20105.698414523795;15036.323365448581;15201.923990380088;15348;15511.3019914103;15525.146116963562;3487.302539492112;3489.755717099804;3509.6139424663265;3522.559680039995;3522.9471557926395;109840;110016.4499177507;110825.44587277093;114332.42833785778;116221.83778162194;15325.31036103378;15567.377304907903;15680.215989200495;15734.134622595868;15819.920900395424;25754.48491030169;27396.45207095887;27487.86256068707;27540.036098736848;27795.166145015683;8337.458065225741;8462.407631465738;8491.74524764258;8501.787455313666;8502.617382217815;4060.1067765091634;4074.592540745961;4078.184363127327;4145.3781932710335;4175.62419382257;5074.619403544749;5161.225816127611;5168.9224661630105;5169.25045868347;5171.224316352502;892.4912799704107;934.2525979216599;935.6491315756591;991.1426615977272;1011.5397494140149;630.1839118341759;640.6636515829134;654.6824789976857;675.5710124071251;682.2972338491362;11496.535135161914;11857.881421185677;11972.760544789055;12220.75558488843;12467.5012999479;645.7287939065603;651.6285717141184;671.5903298987614;680.0479328939425;681;5174.275601415805;5407.675539467645;5434.755436005389;5574.470425309589;5616.550675945915;100472.49763751135;103475.48262258641;104032;104304;106064.46967765111;91470.54264728633;92144.53927730318;93897;95565.52217239009;95942.52028739812;73618.26381736221;76019;79339;79857.20142798613;79863.20136798674;10541.631042913461;10580;10621.734456638645;10716.517756701123;10886.61896833607;33916.49125263074;34957.82521087378;34982.30035399227;35030.29939401147;36727;45780.77109614431;46372;46517.3022404671;47082;48875.26687099625;15157.469488567847;15210.695786084438;15455.922720386327;15516.22418879074;15674.373025078869;16610.66778664444;16623.25195366187;16708.08105554206;16767;16877.578060548094;14949.77575336349;15489.30298136609;15575.844241557892;15784.763228551352;15813.367465301259;14150.716985660434;14190.787138192729;14318.785218221943;14475.493357732428;14495.637609059437;13576.38906249241;13639.045266831226;13747.656308591964;13785.793213102012;13923;11251.831222531504;12008.219465734699;12835;12893.806592900926;13332.066755327034;13977.650558735706;14120.788188177392;14127.505537306144;14425.711485770436;14936.925315373788 17:05:47 INFO - PID 21410 | __end_tp_report 17:05:47 INFO - PID 21410 | __start_cc_report 17:05:47 INFO - PID 21410 | _x_x_mozilla_cycle_collect,362 17:05:47 INFO - PID 21410 | __end_cc_report 17:05:47 INFO - PID 21410 | __startTimestamp1499990747480__endTimestamp 17:05:47 INFO - PID 21410 | 17:05:47 INFO - PID 21410 | ------- Summary: start ------- 17:05:47 INFO - PID 21410 | Number of tests: 6 17:05:47 INFO - PID 21410 | 17:05:47 INFO - PID 21410 | [#0] dojo.html Cycles:165 Average:5954.48 Median:6144.00 stddev:679.01 (11.1%) stddev-sans-first:641.99 17:05:47 INFO - PID 21410 | Values: 3059.3 3140.4 3174.6 3185.6 3193.8 5892.6 5958.6 5988.0 6012.2 6067.2 6057.1 6070.2 6144.0 6170.9 6228.0 5592.6 5646.3 5658.3 5685.3 5707.4 5608.3 5617.3 5627.7 5663.4 5682.7 5444.3 5511.9 5516.9 5613.8 5632.6 5461.3 5483.3 5488.8 5490.3 5495.0 5270.9 5294.8 5337.9 5449.7 5452.3 5835.2 5845.0 5847.8 5852.6 5857.6 6315.6 6327.4 6327.8 6365.7 6400.6 6393.9 6420.0 6435.3 6444.4 6447.8 6001.2 6010.6 6045.0 6097.5 6128.0 6606.7 6617.6 6622.8 6730.3 6746.5 6191.3 6293.2 6389.6 6420.4 6427.8 6480.9 6503.6 6509.3 6524.3 6526.3 5487.1 6424.8 6449.5 6492.2 6504.2 6429.1 6489.8 6489.9 6532.2 6587.8 5290.6 5299.3 5357.4 5380.8 5380.9 4487.3 4545.6 4563.2 4587.8 4612.9 5633.4 5662.2 5668.2 5678.1 5684.6 5455.5 6476.2 6533.0 6639.1 6649.9 5624.2 5672.1 5746.3 5748.5 5750.8 5737.9 5760.3 5871.4 5874.4 5880.3 6157.5 6198.5 6217.2 6339.2 6451.8 6426.7 6446.1 6450.9 6455.0 6472.0 6204.8 6244.0 6270.4 6290.1 6299.6 6285.3 6324.2 6335.3 6336.6 6340.6 6380.6 6432.0 6546.3 6569.7 6632.6 6324.1 6325.4 6385.0 6421.7 6441.7 6336.4 6347.3 6405.1 6429.5 6435.5 6097.8 6134.4 6199.2 6217.3 6245.1 6130.7 6316.8 6327.4 6350.0 6392.9 5959.0 6053.5 6059.9 6064.1 6078.7 17:05:47 INFO - PID 21410 | 17:05:47 INFO - PID 21410 | [#1] ext.html Cycles:180 Average:37174.68 Median:34649.39 stddev:53044.92 (153.1%) stddev-sans-first:53123.29 17:05:47 INFO - PID 21410 | Values: 769.4 820.4 863.1 881.1 894.7 42126.8 42406.8 42731.0 42756.0 42921.8 39854.2 40279.4 40335.0 40366.6 40470.6 6937.4 7055.7 7056.0 7067.0 7072.6 7002.8 7049.2 7106.8 7111.4 7125.6 7033.4 7041.6 7062.3 7073.3 7085.2 7007.4 7033.1 7040.6 7044.3 7047.1 6375.0 6416.0 6438.7 6447.8 6448.8 34473.5 34558.5 34640.1 34658.7 34675.0 3360.6 3419.8 3501.0 3577.0 3585.4 32416.7 32550.8 32804.2 32811.0 32893.0 4717.4 4875.6 4882.6 4951.4 4994.7 183647.0 186488.1 186708.0 189369.0 189458.1 48651.8 49335.8 49757.3 49872.5 49896.5 51988.7 52283.5 52362.0 52431.5 52436.5 15294.7 15357.5 15412.5 15462.5 15496.9 12345.6 12367.6 12390.2 12391.6 12411.8 14352.7 14445.1 14559.3 14573.6 14602.6 5727.2 5863.4 5885.5 5906.3 5940.4 959.5 975.4 995.6 1006.6 1015.6 22850.8 22999.9 23023.8 23145.9 23294.7 1073.1 1073.7 1105.9 1106.5 1109.8 11815.9 12190.2 12192.3 12271.3 12357.0 230143.0 231194.0 232189.0 232641.0 233404.0 54048.5 54094.6 54447.7 54597.5 54622.5 1430.1 1449.8 1481.3 1482.3 1482.6 21919.1 22046.0 22638.4 23043.8 23135.4 37992.6 38092.0 38237.8 38260.2 38264.2 189914.0 190582.0 190583.0 191385.0 191543.0 31018.0 31626.4 32021.4 32107.2 35019.5 42762.4 45441.1 45622.5 46058.5 46073.5 29402.3 30671.2 32123.2 32383.7 32510.0 31171.7 31876.7 32128.0 32190.8 32433.7 35230.0 35540.8 35694.5 35721.8 35842.5 29212.6 30533.0 31168.5 31644.0 31763.8 23063.3 23131.4 23215.8 23291.4 23364.6 17:05:47 INFO - PID 21410 | 17:05:47 INFO - PID 21410 | [#2] jquery.html Cycles:180 Average:34024.55 Median:22880.49 stddev:77891.80 (340.4%) stddev-sans-first:78069.77 17:05:47 INFO - PID 21410 | Values: 557.7 560.2 567.2 574.7 599.8 21800.7 22626.2 22757.1 22876.2 22884.8 25053.7 26078.2 27213.0 27443.9 27550.5 6746.1 6938.1 6941.1 6944.7 6954.2 6781.2 6808.9 6813.6 6823.1 6842.1 4106.6 4508.9 6577.7 6611.5 6771.8 6747.9 6790.0 6795.1 6801.9 6816.1 6311.9 6313.2 6315.9 6316.6 6338.2 26664.7 30019.5 30135.8 30293.0 30369.0 1961.2 1972.5 1979.2 1980.9 1990.5 19368.0 19677.8 19755.5 19814.4 19819.1 2242.4 2306.3 2313.1 2323.8 2401.6 133791.0 137042.0 137314.0 137314.6 137926.0 14372.5 15092.8 15284.3 15304.2 15346.4 23996.6 24034.0 24035.2 24127.0 24210.8 10291.8 10539.9 10577.9 10590.8 10748.2 9775.8 9841.1 9842.4 9892.0 9927.9 9260.4 9309.0 9318.2 9340.7 9363.6 2678.9 2735.7 2829.9 2833.6 2905.7 948.3 956.6 978.7 990.5 1010.1 20134.0 20439.8 20440.5 20481.0 20863.0 1050.8 1066.7 1073.5 1083.4 1092.8 11175.2 11263.1 11306.5 11518.7 11634.4 434243.0 454630.9 463288.0 465609.0 483936.0 110404.0 112923.0 112943.4 113419.0 113575.4 1211.9 1248.6 1268.2 1270.5 1295.4 17194.8 17855.3 17899.6 18536.3 18828.2 54060.7 54504.7 56104.0 56238.7 57068.4 71229.6 71413.6 72091.0 72125.3 72999.6 14826.5 14864.2 14925.9 15099.2 15182.2 23746.9 23755.8 23873.5 23985.2 24049.4 17718.6 17919.2 18077.4 18394.6 18811.2 15295.5 16265.6 16532.9 16765.0 17397.8 19145.4 19393.8 19526.3 19538.6 19660.8 14129.5 14854.9 14875.5 14954.9 14960.5 19033.4 19130.8 19190.1 19246.7 19323.4 17:05:47 INFO - PID 21410 | 17:05:47 INFO - PID 21410 | [#3] mootools.html Cycles:180 Average:8294.07 Median:2547.43 stddev:5434.11 (213.3%) stddev-sans-first:5424.31 17:05:47 INFO - PID 21410 | Values: 1350.4 1399.5 1406.2 1415.9 1416.4 13085.0 13161.1 13772.0 13783.7 13783.9 13568.1 13766.7 13771.2 13782.9 13815.6 2632.3 2693.5 2701.4 2705.3 2708.2 2552.0 2616.9 2620.8 2625.7 2628.3 2478.7 2520.0 2535.4 2536.3 2538.8 2518.5 2544.8 2550.0 2553.8 2556.1 2476.2 2498.6 2501.2 2511.4 2523.9 12828.3 13049.3 13129.5 13130.3 13131.1 7477.7 7764.4 7777.0 7779.6 7814.6 5110.8 5129.7 5174.9 5175.4 5196.9 1825.2 1880.2 1883.2 1904.6 1932.4 19698.4 20260.3 20384.3 20571.6 20573.6 5683.3 6336.5 6492.8 6590.8 6596.2 14648.0 14659.3 14661.3 14689.8 14732.0 7166.6 7415.7 7427.7 7429.4 7462.9 6856.2 6865.0 6892.2 6908.1 6959.8 4896.0 4910.3 4972.9 5015.7 5091.8 1438.2 1448.3 1452.9 1457.4 1476.4 882.9 891.1 898.1 917.8 927.3 7155.3 7754.3 7856.0 7857.7 7949.5 677.4 970.2 971.0 996.4 1040.7 4694.5 4817.8 4907.0 5058.3 5146.4 17442.7 18099.4 18111.4 18119.5 18129.6 17380.8 17602.8 17619.4 17623.4 17637.4 9694.0 10367.7 10645.3 10664.4 10785.3 7668.1 7714.0 7789.9 7795.6 8202.5 15323.4 15543.4 16225.8 16230.6 16478.0 15578.3 16377.1 16431.8 16451.3 16506.3 10946.5 11124.9 11150.3 11161.2 11200.2 12297.2 12594.9 12629.9 12649.0 12800.6 9611.6 9945.7 9975.6 10352.8 10400.6 9588.9 9949.0 9963.2 10078.8 10296.9 8936.4 9167.4 9186.9 9202.0 9206.0 6602.3 6899.2 6915.9 6928.5 6989.4 6748.8 6937.9 6968.8 7006.1 7086.4 17:05:47 INFO - PID 21410 | 17:05:47 INFO - PID 21410 | [#4] prototype.html Cycles:180 Average:5412.55 Median:5978.25 stddev:1510.96 (25.3%) stddev-sans-first:1469.27 17:05:47 INFO - PID 21410 | Values: 487.1 500.5 517.0 526.2 534.8 6077.5 6082.3 6117.7 6173.7 6217.4 5879.8 5973.4 5983.1 6004.5 6099.2 4821.4 4845.5 4958.9 4962.8 4985.7 4889.2 4939.7 4943.6 4949.9 4982.3 4893.5 4905.9 4921.9 4922.5 4928.7 4727.0 4879.9 4892.8 4898.3 4901.7 4369.4 4384.9 4401.7 4443.2 4452.2 5955.4 5957.2 5969.8 5994.3 6005.8 5543.4 5546.0 5546.3 5609.3 5623.5 6377.3 6436.7 6461.8 6494.5 6498.3 4779.2 4807.5 4836.6 4869.1 4886.7 6716.5 6795.8 6832.7 6843.8 6888.7 4988.9 4992.2 5011.4 5018.4 5021.6 4976.4 4994.0 5032.6 5032.8 5040.8 5505.5 5553.3 5570.6 5587.6 5605.2 6419.1 6425.4 6433.8 6445.5 6515.7 1717.3 1747.6 1754.5 1759.9 1765.9 1126.7 1205.8 1213.1 1218.8 1221.4 5521.0 5538.9 5583.9 5621.8 5748.0 6505.4 6519.7 6568.0 6583.8 6596.5 5630.8 5632.8 5686.5 5733.4 5741.5 3462.5 3466.4 3466.5 3490.3 3529.1 6311.9 6405.6 6456.9 6469.4 6518.2 6782.3 6789.6 6794.7 6796.3 6826.4 6334.9 6343.4 6397.2 6415.6 6416.6 6567.7 6620.6 6626.7 6642.5 6695.4 6369.4 6456.9 6486.8 6493.9 6551.9 6263.4 6264.9 6360.7 6403.0 6418.3 4881.4 4900.5 4905.9 4925.6 4933.9 6523.0 6575.0 6578.8 6613.7 6642.4 6351.2 6358.7 6401.4 6414.6 6437.0 6300.7 6422.0 6455.8 6456.2 6488.6 6294.9 6301.8 6311.3 6363.4 6365.2 5892.9 6346.7 6385.1 6426.8 6457.4 6132.9 6192.8 6221.3 6263.3 6274.7 17:05:47 INFO - PID 21410 | 17:05:47 INFO - PID 21410 | [#5] yui.html Cycles:180 Average:21208.40 Median:18182.82 stddev:28974.46 (159.4%) stddev-sans-first:29015.62 17:05:47 INFO - PID 21410 | Values: 901.3 912.8 926.2 926.7 934.0 15537.1 15747.4 15793.8 15829.4 18072.5 19669.4 20201.8 20702.2 21035.3 21068.4 1024.3 1043.5 1049.9 1051.1 1051.4 1064.2 1064.5 1065.5 1066.1 1067.9 1011.7 1059.4 1112.4 1132.5 1133.8 1099.8 1099.8 1100.4 1101.7 1103.0 795.3 795.5 796.6 797.1 797.5 18293.2 19068.5 19337.8 19338.1 19472.7 19513.5 19822.4 20028.8 20039.8 20105.7 15036.3 15201.9 15348.0 15511.3 15525.1 3487.3 3489.8 3509.6 3522.6 3522.9 109840.0 110016.4 110825.4 114332.4 116221.8 15325.3 15567.4 15680.2 15734.1 15819.9 25754.5 27396.5 27487.9 27540.0 27795.2 8337.5 8462.4 8491.7 8501.8 8502.6 4060.1 4074.6 4078.2 4145.4 4175.6 5074.6 5161.2 5168.9 5169.3 5171.2 892.5 934.3 935.6 991.1 1011.5 630.2 640.7 654.7 675.6 682.3 11496.5 11857.9 11972.8 12220.8 12467.5 645.7 651.6 671.6 680.0 681.0 5174.3 5407.7 5434.8 5574.5 5616.6 100472.5 103475.5 104032.0 104304.0 106064.5 91470.5 92144.5 93897.0 95565.5 95942.5 73618.3 76019.0 79339.0 79857.2 79863.2 10541.6 10580.0 10621.7 10716.5 10886.6 33916.5 34957.8 34982.3 35030.3 36727.0 45780.8 46372.0 46517.3 47082.0 48875.3 15157.5 15210.7 15455.9 15516.2 15674.4 16610.7 16623.3 16708.1 16767.0 16877.6 14949.8 15489.3 15575.8 15784.8 15813.4 14150.7 14190.8 14318.8 14475.5 14495.6 13576.4 13639.0 13747.7 13785.8 13923.0 11251.8 12008.2 12835.0 12893.8 13332.1 13977.7 14120.8 14127.5 14425.7 14936.9 17:05:47 INFO - PID 21410 | -------- Summary: end -------- 17:05:47 INFO - PID 21410 | 17:05:48 INFO - TEST-INFO | 21410: exit 0 17:05:48 INFO - TEST-OK | dromaeo_css | took 1110755ms 17:05:48 INFO - TEST-START | kraken 17:05:48 INFO - Initialising browser for kraken test... 17:05:48 INFO - Application command: /builds/slave/test/build/application/firefox/firefox http://localhost:56729/getInfo.html -profile /tmp/tmp8b25fX/profile 17:05:48 INFO - TEST-INFO | started process 21827 (/builds/slave/test/build/application/firefox/firefox http://localhost:56729/getInfo.html) 17:05:53 INFO - TEST-INFO | 21827: exit 0 17:05:53 INFO - Browser initialized. 17:05:53 INFO - Running cycle 1/1 for kraken test... 17:05:53 INFO - TEST-INFO | started process 22049 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp8b25fX/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpnoisy -tpcycles 1 -tppagecycles 1) 17:06:05 INFO - PID 22049 | RSS: Main: 171323392 17:06:05 INFO - PID 22049 | 17:06:07 INFO - PID 22049 | Cycle 1(1): loaded http://localhost:56729/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:56729/tests/kraken/driver.html?testName=audio-beat-detection) 17:06:08 INFO - PID 22049 | RSS: Main: 177926144 17:06:08 INFO - PID 22049 | 17:06:11 INFO - PID 22049 | Cycle 1(1): loaded http://localhost:56729/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:56729/tests/kraken/driver.html?testName=audio-dft) 17:06:12 INFO - PID 22049 | RSS: Main: 178728960 17:06:12 INFO - PID 22049 | 17:06:14 INFO - PID 22049 | Cycle 1(1): loaded http://localhost:56729/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:56729/tests/kraken/driver.html?testName=audio-fft) 17:06:15 INFO - PID 22049 | RSS: Main: 171724800 17:06:15 INFO - PID 22049 | 17:06:17 INFO - PID 22049 | Cycle 1(1): loaded http://localhost:56729/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:56729/tests/kraken/driver.html?testName=audio-oscillator) 17:06:18 INFO - PID 22049 | RSS: Main: 172978176 17:06:18 INFO - PID 22049 | 17:06:20 INFO - PID 22049 | Cycle 1(1): loaded http://localhost:56729/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:56729/tests/kraken/driver.html?testName=imaging-gaussian-blur) 17:06:21 INFO - PID 22049 | RSS: Main: 173035520 17:06:21 INFO - PID 22049 | 17:06:24 INFO - PID 22049 | Cycle 1(1): loaded http://localhost:56729/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:56729/tests/kraken/driver.html?testName=imaging-darkroom) 17:06:24 INFO - PID 22049 | RSS: Main: 176615424 17:06:24 INFO - PID 22049 | 17:06:28 INFO - PID 22049 | Cycle 1(1): loaded http://localhost:56729/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:56729/tests/kraken/driver.html?testName=imaging-desaturate) 17:06:28 INFO - PID 22049 | RSS: Main: 177778688 17:06:28 INFO - PID 22049 | 17:06:31 INFO - PID 22049 | Cycle 1(1): loaded http://localhost:56729/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:56729/tests/kraken/driver.html?testName=json-parse-financial) 17:06:32 INFO - PID 22049 | RSS: Main: 176689152 17:06:32 INFO - PID 22049 | 17:06:33 INFO - PID 22049 | Cycle 1(1): loaded http://localhost:56729/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:56729/tests/kraken/driver.html?testName=json-stringify-tinderbox) 17:06:34 INFO - PID 22049 | RSS: Main: 176357376 17:06:34 INFO - PID 22049 | 17:06:36 INFO - PID 22049 | Cycle 1(1): loaded http://localhost:56729/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:56729/tests/kraken/driver.html?testName=stanford-crypto-aes) 17:06:36 INFO - PID 22049 | RSS: Main: 176373760 17:06:36 INFO - PID 22049 | 17:06:38 INFO - PID 22049 | Cycle 1(1): loaded http://localhost:56729/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:56729/tests/kraken/driver.html?testName=stanford-crypto-ccm) 17:06:39 INFO - PID 22049 | RSS: Main: 176381952 17:06:39 INFO - PID 22049 | 17:06:42 INFO - PID 22049 | Cycle 1(1): loaded http://localhost:56729/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:56729/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 17:06:42 INFO - PID 22049 | RSS: Main: 175919104 17:06:42 INFO - PID 22049 | 17:06:46 INFO - PID 22049 | Cycle 1(1): loaded http://localhost:56729/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:56729/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 17:06:46 INFO - PID 22049 | RSS: Main: 176504832 17:06:46 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | Cycle 1(1): loaded http://localhost:56729/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:56729/tests/kraken/driver.html?testName=ai-astar) 17:06:48 INFO - PID 22049 | RSS: Main: 177950720 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | __start_tp_report 17:06:48 INFO - PID 22049 | _x_x_mozilla_page_load 17:06:48 INFO - PID 22049 | _x_x_mozilla_page_load_details 17:06:48 INFO - PID 22049 | |i|pagename|runs| 17:06:48 INFO - PID 22049 | |0;ai-astar;100;109;108;111;111;106;111;110;108;110 17:06:48 INFO - PID 22049 | |1;audio-beat-detection;155;126;149;178;123;152;150;123;167;122 17:06:48 INFO - PID 22049 | |2;audio-dft;163;164;162;162;162;168;163;171;168;165 17:06:48 INFO - PID 22049 | |3;audio-fft;74;75;82;175;75;75;76;76;95;75 17:06:48 INFO - PID 22049 | |4;audio-oscillator;83;83;143;81;81;81;134;82;83;127 17:06:48 INFO - PID 22049 | |5;imaging-gaussian-blur;114;113;114;117;114;114;113;114;115;114 17:06:48 INFO - PID 22049 | |6;imaging-darkroom;149;149;149;150;150;151;149;151;151;150 17:06:48 INFO - PID 22049 | |7;imaging-desaturate;94;94;95;94;95;94;94;95;95;94 17:06:48 INFO - PID 22049 | |8;json-parse-financial;57;56;57;57;63;56;55;59;59;55 17:06:48 INFO - PID 22049 | |9;json-stringify-tinderbox;54;55;54;54;54;54;54;54;55;54 17:06:48 INFO - PID 22049 | |10;stanford-crypto-aes;79;76;79;78;77;85;77;85;78;78 17:06:48 INFO - PID 22049 | |11;stanford-crypto-ccm;145;126;130;136;125;129;122;129;127;147 17:06:48 INFO - PID 22049 | |12;stanford-crypto-pbkdf2;180;188;196;196;204;192;199;191;184;191 17:06:48 INFO - PID 22049 | |13;stanford-crypto-sha256-iterative;69;69;74;72;72;69;71;71;73;75 17:06:48 INFO - PID 22049 | __end_tp_report 17:06:48 INFO - PID 22049 | __start_cc_report 17:06:48 INFO - PID 22049 | _x_x_mozilla_cycle_collect,965 17:06:48 INFO - PID 22049 | __end_cc_report 17:06:48 INFO - PID 22049 | __startTimestamp1499990808638__endTimestamp 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | ------- Summary: start ------- 17:06:48 INFO - PID 22049 | Number of tests: 14 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | [#0] ai-astar Cycles:10 Average:108.40 Median:110.00 stddev:3.37 (3.1%) stddev-sans-first:1.73 17:06:48 INFO - PID 22049 | Values: 100.0 109.0 108.0 111.0 111.0 106.0 111.0 110.0 108.0 110.0 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | [#1] audio-beat-detection Cycles:10 Average:144.50 Median:151.00 stddev:20.05 (13.3%) stddev-sans-first:20.90 17:06:48 INFO - PID 22049 | Values: 155.0 126.0 149.0 178.0 123.0 152.0 150.0 123.0 167.0 122.0 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | [#2] audio-dft Cycles:10 Average:164.80 Median:164.50 stddev:3.16 (1.9%) stddev-sans-first:3.28 17:06:48 INFO - PID 22049 | Values: 163.0 164.0 162.0 162.0 162.0 168.0 163.0 171.0 168.0 165.0 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | [#3] audio-fft Cycles:10 Average:87.80 Median:75.50 stddev:31.29 (41.4%) stddev-sans-first:32.79 17:06:48 INFO - PID 22049 | Values: 74.0 75.0 82.0 175.0 75.0 75.0 76.0 76.0 95.0 75.0 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | [#4] audio-oscillator Cycles:10 Average:97.80 Median:81.50 stddev:25.73 (31.6%) stddev-sans-first:26.73 17:06:48 INFO - PID 22049 | Values: 83.0 83.0 143.0 81.0 81.0 81.0 134.0 82.0 83.0 127.0 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | [#5] imaging-gaussian-blur Cycles:10 Average:114.20 Median:114.00 stddev:1.14 (1.0%) stddev-sans-first:1.20 17:06:48 INFO - PID 22049 | Values: 114.0 113.0 114.0 117.0 114.0 114.0 113.0 114.0 115.0 114.0 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | [#6] imaging-darkroom Cycles:10 Average:149.90 Median:150.00 stddev:0.88 (0.6%) stddev-sans-first:0.87 17:06:48 INFO - PID 22049 | Values: 149.0 149.0 149.0 150.0 150.0 151.0 149.0 151.0 151.0 150.0 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | [#7] imaging-desaturate Cycles:10 Average:94.40 Median:94.50 stddev:0.52 (0.5%) stddev-sans-first:0.53 17:06:48 INFO - PID 22049 | Values: 94.0 94.0 95.0 94.0 95.0 94.0 94.0 95.0 95.0 94.0 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | [#8] json-parse-financial Cycles:10 Average:57.40 Median:57.00 stddev:2.41 (4.2%) stddev-sans-first:2.55 17:06:48 INFO - PID 22049 | Values: 57.0 56.0 57.0 57.0 63.0 56.0 55.0 59.0 59.0 55.0 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | [#9] json-stringify-tinderbox Cycles:10 Average:54.20 Median:54.00 stddev:0.42 (0.8%) stddev-sans-first:0.44 17:06:48 INFO - PID 22049 | Values: 54.0 55.0 54.0 54.0 54.0 54.0 54.0 54.0 55.0 54.0 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | [#10] stanford-crypto-aes Cycles:10 Average:79.20 Median:78.50 stddev:3.19 (4.1%) stddev-sans-first:3.38 17:06:48 INFO - PID 22049 | Values: 79.0 76.0 79.0 78.0 77.0 85.0 77.0 85.0 78.0 78.0 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | [#11] stanford-crypto-ccm Cycles:10 Average:131.60 Median:129.50 stddev:8.44 (6.5%) stddev-sans-first:7.42 17:06:48 INFO - PID 22049 | Values: 145.0 126.0 130.0 136.0 125.0 129.0 122.0 129.0 127.0 147.0 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:192.10 Median:194.00 stddev:7.08 (3.6%) stddev-sans-first:6.00 17:06:48 INFO - PID 22049 | Values: 180.0 188.0 196.0 196.0 204.0 192.0 199.0 191.0 184.0 191.0 17:06:48 INFO - PID 22049 | 17:06:48 INFO - PID 22049 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:71.50 Median:72.00 stddev:2.12 (2.9%) stddev-sans-first:2.05 17:06:48 INFO - PID 22049 | Values: 69.0 69.0 74.0 72.0 72.0 69.0 71.0 71.0 73.0 75.0 17:06:48 INFO - PID 22049 | -------- Summary: end -------- 17:06:48 INFO - PID 22049 | 17:06:49 INFO - PID 22049 | *** UTM:SVC TimerManager:registerTimer called after profile-before-change notification. Ignoring timer registration for id: telemetry_modules_ping 17:06:49 INFO - TEST-INFO | 22049: exit 0 17:06:49 INFO - TEST-OK | kraken | took 61259ms 17:06:49 INFO - SUITE-END | took 1172s 17:06:49 INFO - Completed test suite (00:19:32) 17:06:49 INFO - javascript benchmark 17:06:49 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 8235.75676553988, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3059.3269480714234, 3140.371925614877, 3174.5555622212887, 3185.569948057013, 3193.8403079846003, 5892.646441213525, 5958.553108516857, 5987.970060149699, 6012.188354572131, 6067.24159480065, 6057.061155520902, 6070.2412198475195, 6144.0, 6170.938290617092, 6227.9688601557045, 5592.6085174037835, 5646.265985421889, 5658.264425624663, 5685.317761868581, 5707.400722924095, 5608.298962629671, 5617.325920889499, 5627.7186140693, 5663.405342439047, 5682.715864206793, 5444.3194600674915, 5511.944880551183, 5516.9448305517035, 5613.775448982035, 5632.633878797865, 5461.290032295776, 5483.314585676791, 5488.807891723811, 5490.3411590609385, 5495.010898038351, 5270.947290527084, 5294.814681486129, 5337.866553336159, 5449.700266485342, 5452.345718513764, 5835.183074369592, 5845.0, 5847.766089356421, 5852.619579727304, 5857.560682948796, 6315.621062736204, 6327.367263273682, 6327.778527751552, 6365.663210725753, 6400.615963042186, 6393.904091438632, 6420.0, 6435.324290949477, 6444.420002199778, 6447.806565803034, 6001.219841420631, 6010.609310394811, 6045.0327947528185, 6097.542684298651, 6127.969360153171, 6606.7026983785845, 6617.636030018347, 6622.8344291393105, 6730.259671436138, 6746.460283177334, 6191.318954914956, 6293.244810622755, 6389.552731308764, 6420.357964203542, 6427.839304017343, 6480.935190648128, 6503.609783412916, 6509.2839787623325, 6524.314946930599, 6526.28210896801, 5487.067198576252, 6424.775132870327, 6449.548531602836, 6492.220933488012, 6504.219493660791, 6429.067785171124, 6489.772857949949, 6489.902651460232, 6532.216134063943, 6587.835304117435, 5290.603204759658, 5299.33758280215, 5357.357117145967, 5380.757865896044, 5380.892382152335, 4487.282034874404, 4545.590896819236, 4563.247064234364, 4587.79354929029, 4612.907741845144, 5633.352164501053, 5662.207290979266, 5668.234788303609, 5678.14827775837, 5684.573656975744, 5455.454454554592, 6476.222853257545, 6533.0, 6639.070530125786, 6649.933500665028, 5624.21261023457, 5672.12082127271, 5746.281714785652, 5748.48263656273, 5750.7987220447085, 5737.942620573825, 5760.279965004374, 5871.383504731942, 5874.383189765099, 5880.294364676266, 6157.538184636171, 6198.473129784019, 6217.222847144107, 6339.175907132043, 6451.806445806539, 6426.678666066771, 6446.065320528403, 6450.870982580416, 6454.967725161344, 6472.0, 6204.844878878064, 6243.96878015607, 6270.372962703876, 6290.119383286252, 6299.622022678654, 6285.277193122849, 6324.17785687876, 6335.334789847184, 6336.556441049082, 6340.556161068681, 6380.553361264667, 6431.967840160769, 6546.279909210079, 6569.671516424064, 6632.568883022588, 6324.051392291193, 6325.367463253638, 6385.0, 6421.71102300407, 6441.677916104082, 6336.398042185985, 6347.301796802441, 6405.103285539935, 6429.517786165963, 6435.51733619971, 6097.7865774697675, 6134.386561344008, 6199.194104766351, 6217.285012223652, 6245.0632405139595, 6130.6628135452975, 6316.778912738032, 6327.3988971047675, 6350.0, 6392.904106438315, 5958.970205148947, 6053.515718742578, 6059.878802423838, 6064.090386441892, 6078.72645730952], "value": 5906.74404394506, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [769.4229328003997, 820.3724151024463, 863.1023735315273, 881.1276835932425, 894.7092195036611, 42126.78936605316, 42406.787966060205, 42731.0, 42756.0, 42921.78539107308, 39854.20291594166, 40279.39580906289, 40335.0, 40366.59633403665, 40470.59529404705, 6937.410320122783, 7055.682494287744, 7055.964720176392, 7067.045948796924, 7072.611006394646, 7002.824929376781, 7049.189343225517, 7106.751263705772, 7111.431085513173, 7125.5724656520515, 7033.402160816337, 7041.57750534967, 7062.329078737537, 7073.257307982665, 7085.2206257311655, 7007.404370628503, 7033.085698859141, 7040.6127662978515, 7044.330788575077, 7047.083879095685, 6375.0, 6415.967920160416, 6438.742450301982, 6447.806565803034, 6448.774292899726, 34473.482897756556, 34558.48162277568, 34640.13399665003, 34658.65341346579, 34675.0, 3360.630330663625, 3419.760616756828, 3500.982495087508, 3577.0, 3585.354636165489, 32416.675833241603, 32550.83724581362, 32804.179895502566, 32811.0, 32893.0, 4717.386739723848, 4875.634327425457, 4882.633802464794, 4951.43058548268, 4994.675346102528, 183647.0, 186488.06755966268, 186708.0, 189369.0, 189458.05270973558, 48651.75674121678, 49335.75332123388, 49757.25364119541, 49872.50127498679, 49896.50103498991, 51988.74005629947, 52283.47716522862, 52362.0, 52431.47568524342, 52436.47563524316, 15294.694106117815, 15357.462488813062, 15412.537623871302, 15462.458813941457, 15496.92251538735, 12345.567905123457, 12367.567135150226, 12390.194637348544, 12391.566295179626, 12411.75176496465, 14352.712945741026, 14445.133292002514, 14559.272036398137, 14573.562793116223, 14602.561923142322, 5727.2268243787385, 5863.413658634103, 5885.47030767233, 5906.291245050621, 5940.435658612425, 959.4962644611635, 975.3759989617349, 995.576879826071, 1006.642641862143, 1015.5683834370363, 22850.771492285196, 22999.88500057489, 23023.769762302498, 23145.88427057854, 23294.65058024131, 1073.0771536478621, 1073.726199819041, 1105.8949399807007, 1106.4523061084815, 1109.7780443911088, 11815.940920295343, 12190.2076365036, 12192.268463892018, 12271.263724176579, 12357.0, 230143.0, 231194.0, 232189.0, 232641.0, 233404.0, 54048.45951540513, 54094.64763380868, 54447.72776136173, 54597.454025459236, 54622.453775461734, 1430.1133297355498, 1449.832884527944, 1481.2519677562761, 1482.2736858939043, 1482.5996980815119, 21919.123235071056, 22046.007929642885, 22638.434039149153, 23043.76956230416, 23135.421614459774, 37992.62007380001, 38092.0, 38237.808810955765, 38260.23479530338, 38264.23471530498, 189914.0, 190582.0, 190583.0, 191385.0, 191543.0, 31018.0, 31626.36747265088, 32021.35957280888, 32107.19732006625, 35019.47470787991, 42762.358564622176, 45441.09117817691, 45622.54377456183, 46058.539414605424, 46073.53926460827, 29402.264943376587, 30671.2332191697, 32123.196920077185, 32383.676163238066, 32510.0, 31171.688283116877, 31876.681233188297, 32128.0, 32190.83904580462, 32433.675663243066, 35230.0, 35540.822295888356, 35694.464583030756, 35721.82139089288, 35842.4623630651, 29212.561811572417, 30533.0, 31168.53247201339, 31644.0, 31763.84118079395, 23063.308100757004, 23131.421714457272, 23215.767842322035, 23291.417714557272, 23364.6495302574], "value": 16770.254023275702, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [557.670974125266, 560.1681502968095, 567.2229046206696, 574.6753084507253, 599.8110595162524, 21800.672989905146, 22626.20808271711, 22757.089716411345, 22876.19933302335, 22884.771152288453, 25053.749462505413, 26078.21765347038, 27213.0, 27443.862780686068, 27550.484723340207, 6746.1230040094715, 6938.06336144619, 6941.132358455193, 6944.72221111155, 6954.235034146265, 6781.186257649089, 6808.931910680904, 6813.625250611214, 6823.078884350623, 6842.076319696852, 4106.568810274908, 4508.887277818065, 6577.736890524373, 6611.537509284476, 6771.830704232384, 6747.898781518281, 6789.966050169767, 6795.116634837489, 6801.93198068018, 6816.079829223041, 6311.93688063118, 6313.210848643919, 6315.905261421082, 6316.557840951135, 6338.207724034496, 26664.73335266661, 30019.549706754417, 30135.849320753474, 30293.0, 30369.026013309285, 1961.205711686769, 1972.5364539333245, 1979.2182088075274, 1980.8910509921948, 1990.4824745566111, 19368.0, 19677.80322196774, 19755.506112347164, 19814.405567832844, 19819.108140133583, 2242.383344580237, 2306.342692332677, 2313.097891822174, 2323.7560056194025, 2401.579723548372, 133791.0, 137042.0, 137314.0, 137314.62685373117, 137926.0, 14372.49696260626, 15092.773608395883, 15284.312205950759, 15304.234788260543, 15346.386144554315, 23996.64005039926, 24034.0, 24035.158769442987, 24127.0, 24210.75789242085, 10291.794164116676, 10539.894601054044, 10577.894221057844, 10590.788184236271, 10748.193885458466, 9775.755606109904, 9841.065098815601, 9842.409455432697, 9892.036173857536, 9927.851082233772, 9260.444373337621, 9309.0, 9318.161365477004, 9340.71977840666, 9363.625454981724, 2678.9460015582254, 2735.7401046900513, 2829.915102546927, 2833.6032955386263, 2905.7239562241552, 948.2745699539857, 956.6173530587821, 978.706388083572, 990.4750482244422, 1010.1262408017012, 20134.0, 20439.79560204379, 20440.488987775425, 20480.9519048097, 20863.0, 1050.795094956476, 1066.7333166708322, 1073.4686330266568, 1083.3932997521413, 1092.8306112552566, 11175.161862860317, 11263.098952083814, 11306.547738090549, 11518.712032199095, 11634.418279086012, 434243.0, 454630.86979988916, 463288.0, 465609.0, 483936.0, 110404.0, 112923.0, 112943.4352828247, 113419.0, 113575.4321228405, 1211.8545774507115, 1248.556762349371, 1268.2200446725383, 1270.5489551209373, 1295.4041141075022, 17194.82805171982, 17855.28578856883, 17899.552511187325, 18536.25854965786, 18828.24687012559, 54060.72969635126, 54504.727476362365, 56104.0, 56238.718806405705, 57068.429315706315, 71229.6438517804, 71413.64293178501, 72091.0, 72125.27874721185, 72999.63500182464, 14826.481073162387, 14864.182469964257, 14925.92537037308, 15099.24503774829, 15182.164980925712, 23746.88126559356, 23755.762442376046, 23873.522529548965, 23985.160519381738, 24049.398765031016, 17718.645627087644, 17919.193636286658, 18077.36729214471, 18394.63210735751, 18811.153498092892, 15295.464658736892, 16265.59336016609, 16532.917335413727, 16765.0, 17397.82602173962, 19145.425637230906, 19393.806061939766, 19526.31657891967, 19538.60922781508, 19660.803391965896, 14129.516400777771, 14854.85145148578, 14875.47935822241, 14954.85045149578, 14960.476383326532, 19033.428997130108, 19130.80869191346, 19190.13644385978, 19246.71129933024, 19323.4202973911], "value": 12105.28692250428, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1350.372076984202, 1399.538152409705, 1406.1633328169735, 1415.8654927781856, 1416.3980308368948, 13085.0, 13161.144525605829, 13772.0, 13783.724325513484, 13783.862161378383, 13568.118072325293, 13766.65583360414, 13771.173729576232, 13782.931085344559, 13815.585532434017, 2632.3155979445337, 2693.474772419379, 2701.3651791828906, 2705.269577214161, 2708.201080681194, 2551.9744802552013, 2616.9084082057134, 2620.816542842002, 2625.684917809856, 2628.342914271432, 2478.677771889652, 2520.0, 2535.404180017694, 2536.2898388451263, 2538.7842033427182, 2518.4711210645787, 2544.8091393145496, 2550.0437335999, 2553.782928451084, 2556.0542599238215, 2476.195236548111, 2498.575242208811, 2501.1996161228412, 2511.4349271413785, 2523.8738063096957, 12828.294443805587, 13049.347532623426, 13129.474821007243, 13130.34348282582, 13131.0808243423, 7477.663505142282, 7764.3788496920115, 7776.988991431078, 7779.572123533203, 7814.609269536557, 5110.795568177268, 5129.692218466904, 5174.896502069938, 5175.353080864892, 5196.948030519684, 1825.2425243523921, 1880.2103116691023, 1883.2467013194832, 1904.6192259675406, 1932.391296741522, 19698.40904772859, 20260.290889818785, 20384.286549970828, 20571.5885682287, 20573.588528229502, 5683.318001839723, 6336.493080553545, 6492.837679058061, 6590.80227593173, 6596.175478065242, 14648.0, 14659.267036648125, 14661.266936653125, 14689.779653304995, 14732.0, 7166.570005799565, 7415.740449084256, 7427.702891884264, 7429.405647548183, 7462.925370746331, 6856.24581296057, 6865.0, 6892.241853396223, 6908.0674108995645, 6959.756408525677, 4895.951040489621, 4910.2880082388565, 4972.925406118911, 5015.749212539358, 5091.770870310845, 1438.216172186161, 1448.2758620689656, 1452.9055611385227, 1457.4461704552202, 1476.3577843638052, 882.8896387951506, 891.1044400377579, 898.1198425543005, 917.8347897378402, 927.2813569483704, 7155.3202445767565, 7754.263344982331, 7855.960720196363, 7857.685692572233, 7949.483283586548, 677.4478799778165, 970.1850445625568, 970.9757256068655, 996.3523709588825, 1040.7190058684114, 4694.50707675696, 4817.78319975595, 4907.0, 5058.342415485963, 5146.356705411824, 17442.65114697699, 18099.366522171662, 18111.36610218636, 18119.45641630753, 18129.637407251783, 17380.826191738175, 17602.823971760117, 17619.383321583682, 17623.383181588582, 17637.382691605733, 9693.951530242444, 10367.688969330931, 10645.308054976556, 10664.41345725977, 10785.298955567863, 7668.116623559831, 7714.0, 7789.922100778919, 7795.610219488889, 8202.548859812767, 15323.387064517294, 15543.37826486973, 16225.837741622905, 16230.594235144215, 16478.0, 15578.29897654631, 16377.099259540839, 16431.753523697393, 16451.25969331359, 16506.25721842544, 10946.45267736594, 11124.888751112709, 11150.275232109887, 11161.218714689894, 11200.215984881306, 12297.200681956003, 12594.937025314815, 12629.873701263237, 12649.0, 12800.61598152057, 9611.567479463301, 9945.701628951143, 9975.551100200364, 10352.792944141225, 10400.635977740743, 9588.90411095908, 9949.005099489994, 9963.202943764336, 10078.798424031625, 10296.897031029594, 8936.41913275635, 9167.358284919992, 9186.862197066916, 9201.953990230273, 9206.033366496422, 6602.3397660233595, 6899.241083480913, 6915.896261556181, 6928.515003949675, 6989.405900498515, 6748.831279217862, 6937.895931561132, 6968.79093627192, 7006.124234470692, 7086.433085353263], "value": 6157.803091574692, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [487.140197551322, 500.53200257759, 517.0, 526.2238198656979, 534.8208350202682, 6077.544184186182, 6082.300535438426, 6117.67528339231, 6173.722182501787, 6217.378262173786, 5879.764809407629, 5973.432523910222, 5983.0726237433155, 6004.459598636122, 6099.1766111574925, 4821.397325334333, 4845.466998630165, 4958.925616115761, 4962.776675049631, 4985.703717033561, 4889.217725163974, 4939.654224204307, 4943.579795717368, 4949.851504454854, 4982.277569752384, 4893.535114164149, 4905.852824415256, 4921.901561968776, 4922.458529561745, 4928.654994150411, 4727.0, 4879.902401951941, 4892.828750993698, 4898.338724272213, 4901.730404827733, 4369.366441865912, 4384.89037774055, 4401.713888597231, 4443.155800397914, 4452.154090722753, 5955.374685657986, 5957.195778569924, 5969.761209551612, 5994.28068631767, 6005.819825405201, 5543.417941116165, 5545.972270138664, 5546.334439867242, 5609.317204838573, 5623.49388555028, 6377.330380310047, 6436.710348034349, 6461.8061458156335, 6494.480441564663, 6498.317676643979, 4779.235322348442, 4807.495213002654, 4836.637252206098, 4869.074875773627, 4886.682365646222, 6716.529842910998, 6795.830104247384, 6832.726690932357, 6843.756870740173, 6888.724451021953, 4988.850334489971, 4992.227759145524, 5011.373578302712, 5018.372703412074, 5021.573166280907, 4976.377952755905, 4993.975030124826, 5032.597392208614, 5032.84901452957, 5040.798368065236, 5505.476979687003, 5553.305836770403, 5570.554355651539, 5587.55299576041, 5605.215269862222, 6419.133416988647, 6425.421712045938, 6433.806985790434, 6445.452136568444, 6515.674216289167, 1717.2873257597957, 1747.554373634715, 1754.5350482122249, 1759.9120043997748, 1765.9470215893543, 1126.695792136135, 1205.8191271309374, 1213.096243298748, 1218.780619488483, 1221.419825582841, 5521.0, 5538.944610553924, 5583.883223355345, 5621.7751289948765, 5747.971260143672, 6505.381179362706, 6519.7392104315295, 6567.981962795774, 6583.769568065095, 6596.538242323088, 5630.8029218977135, 5632.7746890123935, 5686.516646085046, 5733.397993210653, 5741.540676745851, 3462.4806279058344, 3466.3933811582874, 3466.532018177564, 3490.3072010075093, 3529.135361836315, 6311.873762524724, 6405.647689377036, 6456.935430645727, 6469.385408386196, 6518.185226846645, 6782.287859774751, 6789.592624442549, 6794.660266986631, 6796.320367963164, 6826.419754320938, 6334.904976425358, 6343.429091381706, 6397.200349956255, 6415.647139407378, 6416.615003099736, 6567.704453299709, 6620.635865027277, 6626.701798419179, 6642.5018123641885, 6695.397414232742, 6369.426751592379, 6456.870862582816, 6486.805395838132, 6493.870122597427, 6551.887853269659, 6263.404976527223, 6264.906026409516, 6360.681965901594, 6403.0, 6418.261899881387, 4881.414230292387, 4900.534449227318, 4905.852824415273, 4925.556699897026, 4933.876653083702, 6523.0, 6574.980877963923, 6578.750037492861, 6613.735450581923, 6642.405822602637, 6351.174347334817, 6358.713857876499, 6401.391867772554, 6414.583052101599, 6436.967815160894, 6300.7479700811455, 6422.0, 6455.806325810233, 6456.160699109086, 6488.610683359014, 6294.937050629435, 6301.8258700748165, 6311.337309582611, 6363.395477429822, 6365.172527571386, 5892.911606325994, 6346.714397852015, 6385.106085148176, 6426.807195784134, 6457.3865482779065, 6132.896078705876, 6192.783252586138, 6221.346758590464, 6263.27972283175, 6274.717637706223], "value": 4970.232160303852, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [901.3285102598564, 912.7854954085789, 926.2034650200826, 926.6664000959657, 933.9626414943402, 15537.067775933452, 15747.370105195778, 15793.84206157938, 15829.445969391074, 18072.457826265218, 19669.40991770249, 20201.797982020213, 20702.171913123457, 21035.263765768203, 21068.367948961517, 1024.2522958240488, 1043.4886905416329, 1049.9002594753485, 1051.1328154272717, 1051.437480947693, 1064.1752641702665, 1064.4624464645383, 1065.5205157679075, 1066.1470823341335, 1067.8558394616705, 1011.7217765114578, 1059.3590877519105, 1112.3881864974232, 1132.4677401621225, 1133.824257240129, 1099.780043991201, 1099.8020356335855, 1100.4332768624165, 1101.6750058732694, 1103.0293341859192, 795.3200013988014, 795.4630624328555, 796.625585974591, 797.0833541427347, 797.5095316380442, 18293.176807043714, 19068.5232869178, 19337.80662193374, 19338.129784159606, 19472.70790938137, 19513.512162195915, 19822.405327840188, 20028.799712002838, 20039.79960200394, 20105.698414523795, 15036.323365448581, 15201.923990380088, 15348.0, 15511.3019914103, 15525.146116963562, 3487.302539492112, 3489.755717099804, 3509.6139424663265, 3522.559680039995, 3522.9471557926395, 109840.0, 110016.4499177507, 110825.44587277093, 114332.42833785778, 116221.83778162194, 15325.31036103378, 15567.377304907903, 15680.215989200495, 15734.134622595868, 15819.920900395424, 25754.48491030169, 27396.45207095887, 27487.86256068707, 27540.036098736848, 27795.166145015683, 8337.458065225741, 8462.407631465738, 8491.74524764258, 8501.787455313666, 8502.617382217815, 4060.1067765091634, 4074.592540745961, 4078.184363127327, 4145.3781932710335, 4175.62419382257, 5074.619403544749, 5161.225816127611, 5168.9224661630105, 5169.25045868347, 5171.224316352502, 892.4912799704107, 934.2525979216599, 935.6491315756591, 991.1426615977272, 1011.5397494140149, 630.1839118341759, 640.6636515829134, 654.6824789976857, 675.5710124071251, 682.2972338491362, 11496.535135161914, 11857.881421185677, 11972.760544789055, 12220.75558488843, 12467.5012999479, 645.7287939065603, 651.6285717141184, 671.5903298987614, 680.0479328939425, 681.0, 5174.275601415805, 5407.675539467645, 5434.755436005389, 5574.470425309589, 5616.550675945915, 100472.49763751135, 103475.48262258641, 104032.0, 104304.0, 106064.46967765111, 91470.54264728633, 92144.53927730318, 93897.0, 95565.52217239009, 95942.52028739812, 73618.26381736221, 76019.0, 79339.0, 79857.20142798613, 79863.20136798674, 10541.631042913461, 10580.0, 10621.734456638645, 10716.517756701123, 10886.61896833607, 33916.49125263074, 34957.82521087378, 34982.30035399227, 35030.29939401147, 36727.0, 45780.77109614431, 46372.0, 46517.3022404671, 47082.0, 48875.26687099625, 15157.469488567847, 15210.695786084438, 15455.922720386327, 15516.22418879074, 15674.373025078869, 16610.66778664444, 16623.25195366187, 16708.08105554206, 16767.0, 16877.578060548094, 14949.77575336349, 15489.30298136609, 15575.844241557892, 15784.763228551352, 15813.367465301259, 14150.716985660434, 14190.787138192729, 14318.785218221943, 14475.493357732428, 14495.637609059437, 13576.38906249241, 13639.045266831226, 13747.656308591964, 13785.793213102012, 13923.0, 11251.831222531504, 12008.219465734699, 12835.0, 12893.806592900926, 13332.066755327034, 13977.650558735706, 14120.788188177392, 14127.505537306144, 14425.711485770436, 14936.925315373788], "value": 8502.13183580126, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1547.8, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [100.0, 109.0, 108.0, 111.0, 111.0, 106.0, 111.0, 110.0, 108.0, 110.0], "value": 108.4, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [155.0, 126.0, 149.0, 178.0, 123.0, 152.0, 150.0, 123.0, 167.0, 122.0], "value": 144.5, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 164.0, 162.0, 162.0, 162.0, 168.0, 163.0, 171.0, 168.0, 165.0], "value": 164.8, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 75.0, 82.0, 175.0, 75.0, 75.0, 76.0, 76.0, 95.0, 75.0], "value": 87.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 83.0, 143.0, 81.0, 81.0, 81.0, 134.0, 82.0, 83.0, 127.0], "value": 97.8, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [114.0, 113.0, 114.0, 117.0, 114.0, 114.0, 113.0, 114.0, 115.0, 114.0], "value": 114.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 149.0, 149.0, 150.0, 150.0, 151.0, 149.0, 151.0, 151.0, 150.0], "value": 149.9, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [94.0, 94.0, 95.0, 94.0, 95.0, 94.0, 94.0, 95.0, 95.0, 94.0], "value": 94.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [57.0, 56.0, 57.0, 57.0, 63.0, 56.0, 55.0, 59.0, 59.0, 55.0], "value": 57.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [54.0, 55.0, 54.0, 54.0, 54.0, 54.0, 54.0, 54.0, 55.0, 54.0], "value": 54.2, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [79.0, 76.0, 79.0, 78.0, 77.0, 85.0, 77.0, 85.0, 78.0, 78.0], "value": 79.2, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 126.0, 130.0, 136.0, 125.0, 129.0, 122.0, 129.0, 127.0, 147.0], "value": 131.6, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [180.0, 188.0, 196.0, 196.0, 204.0, 192.0, 199.0, 191.0, 184.0, 191.0], "value": 192.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [69.0, 69.0, 74.0, 72.0, 72.0, 69.0, 71.0, 71.0, 73.0, 75.0], "value": 71.5, "unit": "score"}]}]} 17:06:49 INFO - Return code: 0 17:06:49 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 17:06:49 INFO - # TBPL SUCCESS # 17:06:49 INFO - Running post-action listener: _package_coverage_data 17:06:49 INFO - Running post-action listener: _resource_record_post_action 17:06:49 INFO - [mozharness: 2017-07-14 00:06:49.913521Z] Finished run-tests step (success) 17:06:49 INFO - Running post-run listener: _resource_record_post_run 17:06:49 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 4096; Write bytes: 441458688; Read time: 8; Write time: 273884 17:06:49 INFO - TinderboxPrint: CPU usage
13.1% 17:06:49 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 17:06:49 INFO - TinderboxPrint: I/O write bytes / time
441,458,688 / 273,884 17:06:49 INFO - TinderboxPrint: CPU idle
8,252.5 (86.9%) 17:06:49 INFO - TinderboxPrint: CPU user
1,199.5 (12.6%) 17:06:49 INFO - TinderboxPrint: Swap in / out
0 / 0 17:06:49 INFO - install - Wall time: 18s; CPU: 13.0%; Read bytes: 0; Write bytes: 106958848; Read time: 0; Write time: 64040 17:06:49 INFO - setup-mitmproxy - Wall time: 0s; CPU: Can't collect data; Read bytes: 0; Write bytes: 0; Read time: 0; Write time: 0 17:06:50 INFO - run-tests - Wall time: 1173s; CPU: 13.0%; Read bytes: 0; Write bytes: 332460032; Read time: 0; Write time: 209372 17:06:50 INFO - Running post-run listener: _upload_blobber_files 17:06:50 INFO - Blob upload gear active. 17:06:50 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 17:06:50 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 17:06:50 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'] 17:06:50 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 17:06:50 INFO - (blobuploader) - INFO - Open directory for files ... 17:06:50 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 17:06:50 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:06:50 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:06:51 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 17:06:51 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:06:51 INFO - (blobuploader) - INFO - Done attempting. 17:06:51 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 17:06:51 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:06:51 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:06:54 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 17:06:54 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:06:54 INFO - (blobuploader) - INFO - Done attempting. 17:06:54 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 17:06:54 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:06:54 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:06:55 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 17:06:55 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:06:55 INFO - (blobuploader) - INFO - Done attempting. 17:06:55 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 17:06:55 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 17:06:55 INFO - (blobuploader) - INFO - Uploading, attempt #1. 17:06:56 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 17:06:56 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 17:06:56 INFO - (blobuploader) - INFO - Done attempting. 17:06:56 INFO - (blobuploader) - INFO - Iteration through files over. 17:06:56 INFO - Return code: 0 17:06:56 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 17:06:56 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 17:06:56 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2a4a994b0af3e88a5997ab22ad3588a8b7165ba05b0f24bbbb5cd33e319549b42b8300110c68c520cb5f8fefcf4216eb3ddf59f93d22618da57b37f3e7dc124d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b1502dc224817800323b99c16ec187c9e61bb141e58e517ca6f2a83bab0d90c4ae03796294296bb1eecbc7b844e97f3c8d46c3b6e935b0cba5364bbba20099a8", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/766cf3a28e0ea49131e6a12e262810305e2a98768f68dd94c42f4692b7b537afaabef347409c2dd3f23710c6df1c90b5e72db172a2ef96c7a5870bf8bdafe31e", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/db2c0e4d422dc870199d9b02880c478f929d437c89f10fd39b0e0a64a8b54f26a2980e42eb769361d9b0d2c8ed36b0472da3010533e368c121597764376977bc"} 17:06:56 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 17:06:56 INFO - Writing to file /builds/slave/test/properties/blobber_files 17:06:56 INFO - Contents: 17:06:56 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2a4a994b0af3e88a5997ab22ad3588a8b7165ba05b0f24bbbb5cd33e319549b42b8300110c68c520cb5f8fefcf4216eb3ddf59f93d22618da57b37f3e7dc124d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b1502dc224817800323b99c16ec187c9e61bb141e58e517ca6f2a83bab0d90c4ae03796294296bb1eecbc7b844e97f3c8d46c3b6e935b0cba5364bbba20099a8", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/766cf3a28e0ea49131e6a12e262810305e2a98768f68dd94c42f4692b7b537afaabef347409c2dd3f23710c6df1c90b5e72db172a2ef96c7a5870bf8bdafe31e", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/db2c0e4d422dc870199d9b02880c478f929d437c89f10fd39b0e0a64a8b54f26a2980e42eb769361d9b0d2c8ed36b0472da3010533e368c121597764376977bc"} 17:06:56 INFO - Running post-run listener: copy_logs_to_upload_dir 17:06:56 INFO - Copying logs to upload dir... 17:06:56 INFO - mkdir: /builds/slave/test/build/upload/logs 17:06:56 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1252.970986 ========= master_lag: 0.04 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 53 secs) (at 2017-07-13 17:06:54.574077) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-07-13 17:06:54.579091) ========= 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=3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279 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/2a4a994b0af3e88a5997ab22ad3588a8b7165ba05b0f24bbbb5cd33e319549b42b8300110c68c520cb5f8fefcf4216eb3ddf59f93d22618da57b37f3e7dc124d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b1502dc224817800323b99c16ec187c9e61bb141e58e517ca6f2a83bab0d90c4ae03796294296bb1eecbc7b844e97f3c8d46c3b6e935b0cba5364bbba20099a8", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/766cf3a28e0ea49131e6a12e262810305e2a98768f68dd94c42f4692b7b537afaabef347409c2dd3f23710c6df1c90b5e72db172a2ef96c7a5870bf8bdafe31e", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/db2c0e4d422dc870199d9b02880c478f929d437c89f10fd39b0e0a64a8b54f26a2980e42eb769361d9b0d2c8ed36b0472da3010533e368c121597764376977bc"} build_url:https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011320 build_url: 'https://queue.taskcluster.net/v1/task/diqf5GLoTzCvB2x2cU6-GQ/artifacts/public/build/target.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/2a4a994b0af3e88a5997ab22ad3588a8b7165ba05b0f24bbbb5cd33e319549b42b8300110c68c520cb5f8fefcf4216eb3ddf59f93d22618da57b37f3e7dc124d", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b1502dc224817800323b99c16ec187c9e61bb141e58e517ca6f2a83bab0d90c4ae03796294296bb1eecbc7b844e97f3c8d46c3b6e935b0cba5364bbba20099a8", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/766cf3a28e0ea49131e6a12e262810305e2a98768f68dd94c42f4692b7b537afaabef347409c2dd3f23710c6df1c90b5e72db172a2ef96c7a5870bf8bdafe31e", "perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/db2c0e4d422dc870199d9b02880c478f929d437c89f10fd39b0e0a64a8b54f26a2980e42eb769361d9b0d2c8ed36b0472da3010533e368c121597764376977bc"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-07-13 17:06:54.611789) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-07-13 17:06:54.612171) ========= 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=3a3620fb28aea1604ab609ef000001d2-1499988293.941553-1771029279 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004508 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-07-13 17:06:54.694408) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-07-13 17:06:54.697767) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-07-13 17:06:54.698093) ========= ========= Total master_lag: 0.24 =========