builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-003 starttime: 1482575526.99 results: success (0) buildid: 20161224004004 builduid: 5cce009b48fc49dbaed57b4ea4656770 revision: ec2672807887aa46bb4c2966478afa08d610d72d ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-12-24 02:32:06.991171) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-12-24 02:32:06.991674) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-12-24 02:32:06.991961) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-12-24 02:32:07.008026) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-24 02:32:07.008297) ========= 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=7de08804244eb36560b44971000001c3-1482554493.170783-613431067 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-12-24 02:32:07-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 225M=0s 2016-12-24 02:32:07 (225 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.136781 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-12-24 02:32:07.158713) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-12-24 02:32:07.159032) ========= 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=7de08804244eb36560b44971000001c3-1482554493.170783-613431067 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.020115 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-12-24 02:32:07.207848) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-12-24 02:32:07.208185) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev ec2672807887aa46bb4c2966478afa08d610d72d --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev ec2672807887aa46bb4c2966478afa08d610d72d --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=7de08804244eb36560b44971000001c3-1482554493.170783-613431067 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-12-24 02:32:08,042 truncating revision to first 12 chars 2016-12-24 02:32:08,042 Setting DEBUG logging. 2016-12-24 02:32:08,042 attempt 1/10 2016-12-24 02:32:08,042 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/ec2672807887?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-12-24 02:32:09,349 unpacking tar archive at: mozilla-aurora-ec2672807887/testing/mozharness/ program finished with exit code 0 elapsedTime=1.627686 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-12-24 02:32:08.849327) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-12-24 02:32:08.849648) ========= script_repo_revision: ec2672807887aa46bb4c2966478afa08d610d72d ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-12-24 02:32:08.850063) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-12-24 02:32:08.850351) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-12-24 02:32:08.858833) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-12-24 02:32:08.859103) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 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', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] 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=7de08804244eb36560b44971000001c3-1482554493.170783-613431067 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 02:32:09 INFO - MultiFileLogger online at 20161224 02:32:09 in /builds/slave/test 02:32:09 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 02:32:09 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 02:32:09 INFO - {'append_to_log': False, 02:32:09 INFO - 'base_work_dir': '/builds/slave/test', 02:32:09 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 02:32:09 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 02:32:09 INFO - 'branch': 'Mozilla-Aurora', 02:32:09 INFO - 'buildbot_json_path': 'buildprops.json', 02:32:09 INFO - 'config_files': ('talos/linux_config.py',), 02:32:09 INFO - 'default_actions': ('clobber', 02:32:09 INFO - 'read-buildbot-config', 02:32:09 INFO - 'download-and-extract', 02:32:09 INFO - 'populate-webroot', 02:32:09 INFO - 'create-virtualenv', 02:32:09 INFO - 'install', 02:32:09 INFO - 'run-tests'), 02:32:09 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 02:32:09 INFO - 'download_minidump_stackwalk': True, 02:32:09 INFO - 'download_symbols': 'ondemand', 02:32:09 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 02:32:09 INFO - 'tooltool.py': '/tools/tooltool.py', 02:32:09 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 02:32:09 INFO - '/tools/misc-python/virtualenv.py')}, 02:32:09 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 02:32:09 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 02:32:09 INFO - 'installer_path': 'installer.exe', 02:32:09 INFO - 'log_level': 'info', 02:32:09 INFO - 'log_name': 'talos', 02:32:09 INFO - 'log_to_console': True, 02:32:09 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 02:32:09 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 02:32:09 INFO - 'opt_config_files': (), 02:32:09 INFO - 'pip_index': False, 02:32:09 INFO - 'sps_profile': False, 02:32:09 INFO - 'sps_profile_interval': 0, 02:32:09 INFO - 'suite': 'dromaeojs-e10s', 02:32:09 INFO - 'system_bits': '32', 02:32:09 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 02:32:09 INFO - 'title': 'talos-linux64-ix-003', 02:32:09 INFO - 'tooltool_cache': '/builds/tooltool_cache', 02:32:09 INFO - 'use_talos_json': True, 02:32:09 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 02:32:09 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 02:32:09 INFO - 'work_dir': 'build'} 02:32:09 INFO - [mozharness: 2016-12-24 10:32:09.792173Z] Running clobber step. 02:32:09 INFO - Running pre-action listener: _resource_record_pre_action 02:32:09 INFO - Running main action method: clobber 02:32:09 INFO - rmtree: /builds/slave/test/build 02:32:09 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 02:32:10 INFO - Running post-action listener: _resource_record_post_action 02:32:10 INFO - [mozharness: 2016-12-24 10:32:10.258952Z] Finished clobber step (success) 02:32:10 INFO - [mozharness: 2016-12-24 10:32:10.259051Z] Running read-buildbot-config step. 02:32:10 INFO - Running pre-action listener: _resource_record_pre_action 02:32:10 INFO - Running main action method: read_buildbot_config 02:32:10 INFO - Using buildbot properties: 02:32:10 INFO - { 02:32:10 INFO - "project": "", 02:32:10 INFO - "product": "firefox", 02:32:10 INFO - "script_repo_revision": "production", 02:32:10 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs-e10s", 02:32:10 INFO - "repository": "", 02:32:10 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs-e10s", 02:32:10 INFO - "buildid": "20161224004004", 02:32:10 INFO - "stage_platform": "linux64-pgo", 02:32:10 INFO - "basedir": "/builds/slave/test", 02:32:10 INFO - "nightly_build": "True", 02:32:10 INFO - "buildnumber": 779, 02:32:10 INFO - "slavename": "talos-linux64-ix-003", 02:32:10 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 02:32:10 INFO - "platform": "ubuntu64_hw", 02:32:10 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 02:32:10 INFO - "branch": "mozilla-aurora", 02:32:10 INFO - "repo_path": "releases/mozilla-aurora", 02:32:10 INFO - "revision": "ec2672807887aa46bb4c2966478afa08d610d72d", 02:32:10 INFO - "pgo_build": "True", 02:32:10 INFO - "builduid": "5cce009b48fc49dbaed57b4ea4656770", 02:32:10 INFO - "slavebuilddir": "test" 02:32:10 INFO - } 02:32:10 INFO - Found installer url https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2. 02:32:10 INFO - Running post-action listener: _resource_record_post_action 02:32:10 INFO - [mozharness: 2016-12-24 10:32:10.261559Z] Finished read-buildbot-config step (success) 02:32:10 INFO - [mozharness: 2016-12-24 10:32:10.261647Z] Running download-and-extract step. 02:32:10 INFO - Running pre-action listener: _resource_record_pre_action 02:32:10 INFO - Running main action method: download_and_extract 02:32:10 INFO - mkdir: /builds/slave/test/build/tests 02:32:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:10 INFO - trying https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json 02:32:10 INFO - Downloading https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json 02:32:10 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json'}, attempt #1 02:32:10 INFO - Downloaded 1361 bytes. 02:32:10 INFO - Reading from file /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json 02:32:10 INFO - Using the following test package requirements: 02:32:10 INFO - {u'common': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'], 02:32:10 INFO - u'cppunittest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 02:32:10 INFO - u'firefox-52.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 02:32:10 INFO - u'gtest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 02:32:10 INFO - u'firefox-52.0a2.en-US.linux-x86_64.gtest.tests.zip'], 02:32:10 INFO - u'jittest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 02:32:10 INFO - u'jsshell-linux-x86_64.zip'], 02:32:10 INFO - u'mochitest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 02:32:10 INFO - u'firefox-52.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 02:32:10 INFO - u'mozbase': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'], 02:32:10 INFO - u'reftest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 02:32:10 INFO - u'firefox-52.0a2.en-US.linux-x86_64.reftest.tests.zip'], 02:32:10 INFO - u'talos': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 02:32:10 INFO - u'firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip'], 02:32:10 INFO - u'web-platform': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 02:32:10 INFO - u'firefox-52.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 02:32:10 INFO - u'xpcshell': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 02:32:10 INFO - u'firefox-52.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 02:32:10 INFO - Downloading packages: [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 02:32:10 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip 02:32:10 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 02:32:10 INFO - Fetch https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip into memory 02:32:11 INFO - Http code: 200 02:32:11 INFO - via: 1.1 e2af8a85927835558866752f53562ecd.cloudfront.net (CloudFront) 02:32:11 INFO - x-amz-cf-id: VWmXzcKzI_MLMZv09wlA6iZNrFA8c5SdE-yD9Fc7NQxPyrU46lOS9Q== 02:32:11 INFO - x-amz-version-id: HMkVbgvMotX0a8ecGxpRYVSdNhVs9Bwd 02:32:11 INFO - Expected file size: 21943802 02:32:11 INFO - Obtained file size: 21943802 02:32:15 INFO - Downloading packages: [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', u'firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 02:32:15 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip 02:32:15 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 02:32:15 INFO - Fetch https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip into memory 02:32:16 INFO - Http code: 200 02:32:16 INFO - via: 1.1 bfd7406fdd888e34dfca79886cb7c964.cloudfront.net (CloudFront) 02:32:16 INFO - x-amz-cf-id: HwdAjFnGJTYdn5gkaY5dHgC-ZH5JTFm2tANJ4JhpN_YIMLeYQgi-jw== 02:32:16 INFO - x-amz-version-id: HMkVbgvMotX0a8ecGxpRYVSdNhVs9Bwd 02:32:16 INFO - Expected file size: 21943802 02:32:16 INFO - Obtained file size: 21943802 02:32:21 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip 02:32:21 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 02:32:21 INFO - Fetch https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip into memory 02:32:22 INFO - Http code: 200 02:32:22 INFO - via: 1.1 6cd88b9fd84ad5daa3b3867fb8c5c91a.cloudfront.net (CloudFront) 02:32:22 INFO - x-amz-cf-id: TygtsEsDVGkvW-OMUAXiahs_cHjbc75u7F6zJUhpxRhcoOorXJ1AsQ== 02:32:22 INFO - x-amz-version-id: wJs22q4XF7wD9DDt4UMEJEVSWEhfP3zK 02:32:22 INFO - Expected file size: 14409038 02:32:22 INFO - Obtained file size: 14409038 02:32:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:22 INFO - trying https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 02:32:22 INFO - Downloading https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 02:32:22 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2'}, attempt #1 02:32:23 INFO - Downloaded 63966543 bytes. 02:32:23 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 02:32:23 INFO - mkdir: /builds/slave/test/properties 02:32:23 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 02:32:23 INFO - Writing to file /builds/slave/test/properties/build_url 02:32:23 INFO - Contents: 02:32:23 INFO - build_url:https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 02:32:24 INFO - Running post-action listener: _resource_record_post_action 02:32:24 INFO - Running post-action listener: set_extra_try_arguments 02:32:24 INFO - [mozharness: 2016-12-24 10:32:24.572305Z] Finished download-and-extract step (success) 02:32:24 INFO - [mozharness: 2016-12-24 10:32:24.572530Z] Running populate-webroot step. 02:32:24 INFO - Running pre-action listener: _resource_record_pre_action 02:32:24 INFO - Running main action method: populate_webroot 02:32:24 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 02:32:24 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 02:32:24 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 02:32:24 INFO - '--tppagecycles', 02:32:24 INFO - '7'], 02:32:24 INFO - 'tests': ['tsvgm']}}, 02:32:24 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 02:32:24 INFO - 'tests': ['tresize', 'tcanvasmark']}, 02:32:24 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 02:32:24 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 02:32:24 INFO - 'tests': ['dromaeo_css', 'kraken']}, 02:32:24 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 02:32:24 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:32:24 INFO - 'talos_options': ['--disable-e10s'], 02:32:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:32:24 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:32:24 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 02:32:24 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:32:24 INFO - 'talos_options': ['--disable-e10s'], 02:32:24 INFO - 'tests': ['damp', 'tps']}, 02:32:24 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:32:24 INFO - 'tests': ['damp', 'tps']}, 02:32:24 INFO - 'g3': {'talos_options': ['--disable-e10s'], 02:32:24 INFO - 'tests': ['dromaeo_dom']}, 02:32:24 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 02:32:24 INFO - 'g4': {'talos_options': ['--disable-e10s'], 02:32:24 INFO - 'tests': ['basic_compositor_video']}, 02:32:24 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 02:32:24 INFO - 'other': {'talos_options': ['--disable-e10s'], 02:32:24 INFO - 'tests': ['a11yr', 02:32:24 INFO - 'ts_paint', 02:32:24 INFO - 'tpaint', 02:32:24 INFO - 'sessionrestore', 02:32:24 INFO - 'sessionrestore_no_auto_restore', 02:32:24 INFO - 'tabpaint']}, 02:32:24 INFO - 'other-e10s': {'tests': ['a11yr', 02:32:24 INFO - 'ts_paint', 02:32:24 INFO - 'tpaint', 02:32:24 INFO - 'sessionrestore', 02:32:24 INFO - 'sessionrestore_no_auto_restore', 02:32:24 INFO - 'tabpaint']}, 02:32:24 INFO - 'other-e10s_l64': {'tests': ['a11yr', 02:32:24 INFO - 'ts_paint', 02:32:24 INFO - 'tpaint', 02:32:24 INFO - 'sessionrestore', 02:32:24 INFO - 'sessionrestore_no_auto_restore', 02:32:24 INFO - 'tabpaint']}, 02:32:24 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 02:32:24 INFO - 'ts_paint', 02:32:24 INFO - 'tpaint', 02:32:24 INFO - 'sessionrestore', 02:32:24 INFO - 'sessionrestore_no_auto_restore', 02:32:24 INFO - 'tabpaint']}, 02:32:24 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 02:32:24 INFO - 'tests': ['a11yr', 02:32:24 INFO - 'ts_paint', 02:32:24 INFO - 'tpaint', 02:32:24 INFO - 'sessionrestore', 02:32:24 INFO - 'sessionrestore_no_auto_restore', 02:32:24 INFO - 'tabpaint']}, 02:32:24 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 02:32:24 INFO - 'tests': ['a11yr', 02:32:24 INFO - 'ts_paint', 02:32:24 INFO - 'tpaint', 02:32:24 INFO - 'sessionrestore', 02:32:24 INFO - 'sessionrestore_no_auto_restore', 02:32:24 INFO - 'tabpaint']}, 02:32:24 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 02:32:24 INFO - 'tests': ['tsvgx', 02:32:24 INFO - 'tsvgr_opacity', 02:32:24 INFO - 'tart', 02:32:24 INFO - 'tscrollx', 02:32:24 INFO - 'cart']}, 02:32:24 INFO - 'svgr-e10s': {'tests': ['tsvgx', 02:32:24 INFO - 'tsvgr_opacity', 02:32:24 INFO - 'tart', 02:32:24 INFO - 'tscrollx', 02:32:24 INFO - 'cart']}, 02:32:24 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:32:24 INFO - 'talos_options': ['--disable-e10s'], 02:32:24 INFO - 'tests': ['tp5o']}, 02:32:24 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:32:24 INFO - 'tests': ['tp5o']}, 02:32:24 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:32:24 INFO - 'talos_options': ['--disable-e10s', 02:32:24 INFO - '--xperf_path', 02:32:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:32:24 INFO - 'tests': ['tp5n']}, 02:32:24 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 02:32:24 INFO - 'talos_options': ['--xperf_path', 02:32:24 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 02:32:24 INFO - 'tests': ['tp5n']}}, 02:32:24 INFO - 'talos.zip': {'path': '', 02:32:24 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 02:32:24 INFO - Running post-action listener: _resource_record_post_action 02:32:24 INFO - [mozharness: 2016-12-24 10:32:24.590007Z] Finished populate-webroot step (success) 02:32:24 INFO - [mozharness: 2016-12-24 10:32:24.590095Z] Running create-virtualenv step. 02:32:24 INFO - Running pre-action listener: _resource_record_pre_action 02:32:24 INFO - Running main action method: create_virtualenv 02:32:24 INFO - Creating virtualenv /builds/slave/test/build/venv 02:32:24 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 02:32:24 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 02:32:24 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 02:32:24 INFO - Using real prefix '/usr' 02:32:24 INFO - New python executable in /builds/slave/test/build/venv/bin/python 02:32:25 INFO - Installing distribute.............................................................................................................................................................................................done. 02:32:27 INFO - Installing pip.................done. 02:32:27 INFO - Return code: 0 02:32:27 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 02:32:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 02:32:27 INFO - Reading from file tmpfile_stdout 02:32:27 INFO - Output received: 02:32:27 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) 02:32:27 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 02:32:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:32:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:32:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:27 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fa0c236bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xee38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfb0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfadf60>, '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 0xfaed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfaf1d0>, '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': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', '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 02:32:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 02:32:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub pip>=1.5 02:32:27 INFO - Using env: {'DISPLAY': ':0', 02:32:27 INFO - 'HOME': '/home/cltbld', 02:32:27 INFO - 'LANG': 'en_US.UTF-8', 02:32:27 INFO - 'LANGUAGE': 'en_US:en', 02:32:27 INFO - 'LOGNAME': 'cltbld', 02:32:27 INFO - 'MAIL': '/var/mail/cltbld', 02:32:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:32:27 INFO - 'MOZ_NO_REMOTE': '1', 02:32:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:32:27 INFO - 'NO_EM_RESTART': '1', 02:32:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:32:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:32:27 INFO - 'PWD': '/builds/slave/test', 02:32:27 INFO - 'SHELL': '/bin/bash', 02:32:27 INFO - 'SHLVL': '1', 02:32:27 INFO - 'TERM': 'linux', 02:32:27 INFO - 'TMOUT': '86400', 02:32:27 INFO - 'USER': 'cltbld', 02:32:27 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', 02:32:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:32:27 INFO - '_': '/tools/buildbot/bin/python'} 02:32:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:32:27 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 02:32:27 INFO - Cleaning up... 02:32:27 INFO - Return code: 0 02:32:27 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 02:32:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:27 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:32:27 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:27 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:27 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:32:27 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:27 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fa0c236bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xee38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfb0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfadf60>, '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 0xfaed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfaf1d0>, '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': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', '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 02:32:27 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 02:32:27 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub psutil>=3.1.1 02:32:27 INFO - Using env: {'DISPLAY': ':0', 02:32:27 INFO - 'HOME': '/home/cltbld', 02:32:27 INFO - 'LANG': 'en_US.UTF-8', 02:32:27 INFO - 'LANGUAGE': 'en_US:en', 02:32:27 INFO - 'LOGNAME': 'cltbld', 02:32:27 INFO - 'MAIL': '/var/mail/cltbld', 02:32:27 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:32:27 INFO - 'MOZ_NO_REMOTE': '1', 02:32:27 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:32:27 INFO - 'NO_EM_RESTART': '1', 02:32:27 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:32:27 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:32:27 INFO - 'PWD': '/builds/slave/test', 02:32:27 INFO - 'SHELL': '/bin/bash', 02:32:27 INFO - 'SHLVL': '1', 02:32:27 INFO - 'TERM': 'linux', 02:32:27 INFO - 'TMOUT': '86400', 02:32:27 INFO - 'USER': 'cltbld', 02:32:27 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', 02:32:27 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:32:27 INFO - '_': '/tools/buildbot/bin/python'} 02:32:27 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:32:27 INFO - Downloading/unpacking psutil>=3.1.1 02:32:27 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 02:32:27 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 02:32:27 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:27 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:27 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 02:32:27 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 02:32:29 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 02:32:29 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:32:29 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:32:29 INFO - Installing collected packages: psutil 02:32:29 INFO - Running setup.py install for psutil 02:32:30 INFO - building 'psutil._psutil_linux' extension 02:32:30 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 02:32:30 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 02:32:30 INFO - building 'psutil._psutil_posix' extension 02:32:30 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 02:32:30 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 02:32:30 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 02:32:30 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 02:32:30 INFO - Successfully installed psutil 02:32:30 INFO - Cleaning up... 02:32:30 INFO - Return code: 0 02:32:30 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 02:32:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:30 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:32:30 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:30 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:30 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:32:30 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:30 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fa0c236bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xee38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfb0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfadf60>, '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 0xfaed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfaf1d0>, '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': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', '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 02:32:30 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 02:32:30 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub mozsystemmonitor==0.3 02:32:30 INFO - Using env: {'DISPLAY': ':0', 02:32:30 INFO - 'HOME': '/home/cltbld', 02:32:30 INFO - 'LANG': 'en_US.UTF-8', 02:32:30 INFO - 'LANGUAGE': 'en_US:en', 02:32:30 INFO - 'LOGNAME': 'cltbld', 02:32:30 INFO - 'MAIL': '/var/mail/cltbld', 02:32:30 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:32:30 INFO - 'MOZ_NO_REMOTE': '1', 02:32:30 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:32:30 INFO - 'NO_EM_RESTART': '1', 02:32:30 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:32:30 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:32:30 INFO - 'PWD': '/builds/slave/test', 02:32:30 INFO - 'SHELL': '/bin/bash', 02:32:30 INFO - 'SHLVL': '1', 02:32:30 INFO - 'TERM': 'linux', 02:32:30 INFO - 'TMOUT': '86400', 02:32:30 INFO - 'USER': 'cltbld', 02:32:30 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', 02:32:30 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:32:30 INFO - '_': '/tools/buildbot/bin/python'} 02:32:30 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:32:30 INFO - Downloading/unpacking mozsystemmonitor==0.3 02:32:30 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 02:32:30 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 02:32:30 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:30 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:30 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 02:32:30 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 02:32:32 INFO - Downloading mozsystemmonitor-0.3.tar.gz 02:32:32 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 02:32:32 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 02:32:32 INFO - Installing collected packages: mozsystemmonitor 02:32:32 INFO - Running setup.py install for mozsystemmonitor 02:32:32 INFO - Successfully installed mozsystemmonitor 02:32:32 INFO - Cleaning up... 02:32:32 INFO - Return code: 0 02:32:32 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 02:32:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:32:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:32:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:32 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fa0c236bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xee38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfb0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfadf60>, '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 0xfaed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfaf1d0>, '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': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', '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 02:32:32 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 02:32:32 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema==2.5.1 02:32:32 INFO - Using env: {'DISPLAY': ':0', 02:32:32 INFO - 'HOME': '/home/cltbld', 02:32:32 INFO - 'LANG': 'en_US.UTF-8', 02:32:32 INFO - 'LANGUAGE': 'en_US:en', 02:32:32 INFO - 'LOGNAME': 'cltbld', 02:32:32 INFO - 'MAIL': '/var/mail/cltbld', 02:32:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:32:32 INFO - 'MOZ_NO_REMOTE': '1', 02:32:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:32:32 INFO - 'NO_EM_RESTART': '1', 02:32:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:32:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:32:32 INFO - 'PWD': '/builds/slave/test', 02:32:32 INFO - 'SHELL': '/bin/bash', 02:32:32 INFO - 'SHLVL': '1', 02:32:32 INFO - 'TERM': 'linux', 02:32:32 INFO - 'TMOUT': '86400', 02:32:32 INFO - 'USER': 'cltbld', 02:32:32 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', 02:32:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:32:32 INFO - '_': '/tools/buildbot/bin/python'} 02:32:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:32:33 INFO - Downloading/unpacking jsonschema==2.5.1 02:32:33 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 02:32:33 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 02:32:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:33 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 02:32:33 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 02:32:35 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 02:32:35 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 02:32:35 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 02:32:35 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 02:32:35 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:35 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:35 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 02:32:35 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 02:32:35 INFO - Downloading functools32-3.2.3-2.tar.gz 02:32:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 02:32:35 INFO - warning: no files found matching '*.txt' 02:32:35 INFO - no previously-included directories found matching 'build' 02:32:35 INFO - no previously-included directories found matching 'dist' 02:32:35 INFO - no previously-included directories found matching '.git*' 02:32:35 INFO - Installing collected packages: jsonschema, functools32 02:32:35 INFO - Running setup.py install for functools32 02:32:35 INFO - warning: no files found matching '*.txt' 02:32:35 INFO - no previously-included directories found matching 'build' 02:32:35 INFO - no previously-included directories found matching 'dist' 02:32:35 INFO - no previously-included directories found matching '.git*' 02:32:35 INFO - Successfully installed jsonschema functools32 02:32:35 INFO - Cleaning up... 02:32:35 INFO - Return code: 0 02:32:35 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 02:32:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:32:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:32:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:35 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fa0c236bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xee38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfb0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfadf60>, '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 0xfaed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfaf1d0>, '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': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', '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 02:32:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 02:32:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub functools32==3.2.3-2 02:32:35 INFO - Using env: {'DISPLAY': ':0', 02:32:35 INFO - 'HOME': '/home/cltbld', 02:32:35 INFO - 'LANG': 'en_US.UTF-8', 02:32:35 INFO - 'LANGUAGE': 'en_US:en', 02:32:35 INFO - 'LOGNAME': 'cltbld', 02:32:35 INFO - 'MAIL': '/var/mail/cltbld', 02:32:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:32:35 INFO - 'MOZ_NO_REMOTE': '1', 02:32:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:32:35 INFO - 'NO_EM_RESTART': '1', 02:32:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:32:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:32:35 INFO - 'PWD': '/builds/slave/test', 02:32:35 INFO - 'SHELL': '/bin/bash', 02:32:35 INFO - 'SHLVL': '1', 02:32:35 INFO - 'TERM': 'linux', 02:32:35 INFO - 'TMOUT': '86400', 02:32:35 INFO - 'USER': 'cltbld', 02:32:35 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', 02:32:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:32:35 INFO - '_': '/tools/buildbot/bin/python'} 02:32:35 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:32:35 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 02:32:35 INFO - Cleaning up... 02:32:35 INFO - Return code: 0 02:32:35 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 02:32:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:35 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:32:35 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:35 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:35 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:32:35 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:35 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fa0c236bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xee38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfb0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfadf60>, '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 0xfaed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfaf1d0>, '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': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', '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 02:32:35 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 02:32:35 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub blobuploader==1.2.4 02:32:35 INFO - Using env: {'DISPLAY': ':0', 02:32:35 INFO - 'HOME': '/home/cltbld', 02:32:35 INFO - 'LANG': 'en_US.UTF-8', 02:32:35 INFO - 'LANGUAGE': 'en_US:en', 02:32:35 INFO - 'LOGNAME': 'cltbld', 02:32:35 INFO - 'MAIL': '/var/mail/cltbld', 02:32:35 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:32:35 INFO - 'MOZ_NO_REMOTE': '1', 02:32:35 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:32:35 INFO - 'NO_EM_RESTART': '1', 02:32:35 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:32:35 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:32:35 INFO - 'PWD': '/builds/slave/test', 02:32:35 INFO - 'SHELL': '/bin/bash', 02:32:35 INFO - 'SHLVL': '1', 02:32:35 INFO - 'TERM': 'linux', 02:32:35 INFO - 'TMOUT': '86400', 02:32:35 INFO - 'USER': 'cltbld', 02:32:35 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', 02:32:35 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:32:35 INFO - '_': '/tools/buildbot/bin/python'} 02:32:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:32:36 INFO - Downloading/unpacking blobuploader==1.2.4 02:32:36 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 02:32:36 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 02:32:36 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:36 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:36 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 02:32:36 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 02:32:38 INFO - Downloading blobuploader-1.2.4.tar.gz 02:32:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 02:32:38 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 02:32:38 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 02:32:38 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 02:32:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:38 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 02:32:38 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 02:32:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 02:32:38 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 02:32:38 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 02:32:38 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 02:32:38 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:38 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:38 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 02:32:38 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 02:32:38 INFO - Downloading docopt-0.6.1.tar.gz 02:32:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 02:32:38 INFO - Installing collected packages: blobuploader, requests, docopt 02:32:38 INFO - Running setup.py install for blobuploader 02:32:38 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 02:32:38 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 02:32:38 INFO - Running setup.py install for requests 02:32:39 INFO - Running setup.py install for docopt 02:32:39 INFO - Successfully installed blobuploader requests docopt 02:32:39 INFO - Cleaning up... 02:32:39 INFO - Return code: 0 02:32:39 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:32:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:39 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:32:39 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:39 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:39 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:32:39 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:39 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fa0c236bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xee38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfb0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfadf60>, '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 0xfaed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfaf1d0>, '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': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', '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 02:32:39 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 02:32:39 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 02:32:39 INFO - Using env: {'DISPLAY': ':0', 02:32:39 INFO - 'HOME': '/home/cltbld', 02:32:39 INFO - 'LANG': 'en_US.UTF-8', 02:32:39 INFO - 'LANGUAGE': 'en_US:en', 02:32:39 INFO - 'LOGNAME': 'cltbld', 02:32:39 INFO - 'MAIL': '/var/mail/cltbld', 02:32:39 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:32:39 INFO - 'MOZ_NO_REMOTE': '1', 02:32:39 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:32:39 INFO - 'NO_EM_RESTART': '1', 02:32:39 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:32:39 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:32:39 INFO - 'PWD': '/builds/slave/test', 02:32:39 INFO - 'SHELL': '/bin/bash', 02:32:39 INFO - 'SHLVL': '1', 02:32:39 INFO - 'TERM': 'linux', 02:32:39 INFO - 'TMOUT': '86400', 02:32:39 INFO - 'USER': 'cltbld', 02:32:39 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', 02:32:39 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:32:39 INFO - '_': '/tools/buildbot/bin/python'} 02:32:39 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:32:39 INFO - Running setup.py (path:/tmp/pip-ldsptj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:32:39 INFO - Running setup.py (path:/tmp/pip-0oZtfo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:32:39 INFO - Running setup.py (path:/tmp/pip-iJ38Oh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:32:39 INFO - Running setup.py (path:/tmp/pip-Q27sSx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:32:39 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:32:39 INFO - Running setup.py (path:/tmp/pip-aXvD8F-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:32:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:32:40 INFO - Running setup.py (path:/tmp/pip-grLdRr-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:32:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:32:40 INFO - Running setup.py (path:/tmp/pip-iS893r-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:32:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:32:40 INFO - Running setup.py (path:/tmp/pip-z4wTvA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:32:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:32:40 INFO - Running setup.py (path:/tmp/pip-aUFCTw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:32:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:32:40 INFO - Running setup.py (path:/tmp/pip-8w2N80-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:32:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:32:40 INFO - Running setup.py (path:/tmp/pip-W6xFLl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:32:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:32:40 INFO - Running setup.py (path:/tmp/pip-JHH4VL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:32:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:32:40 INFO - Running setup.py (path:/tmp/pip-2RRsxk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:32:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:32:40 INFO - Running setup.py (path:/tmp/pip-vWgrEP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:32:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:32:40 INFO - Running setup.py (path:/tmp/pip-yB5aBC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:32:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:32:40 INFO - Running setup.py (path:/tmp/pip-Tlfceb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:32:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:32:40 INFO - Running setup.py (path:/tmp/pip-B4IgVI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:32:40 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 02:32:40 INFO - Running setup.py install for manifestparser 02:32:41 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 02:32:41 INFO - Running setup.py install for mozcrash 02:32:41 INFO - Running setup.py install for mozdebug 02:32:41 INFO - Running setup.py install for mozdevice 02:32:41 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 02:32:41 INFO - Installing dm script to /builds/slave/test/build/venv/bin 02:32:41 INFO - Running setup.py install for mozfile 02:32:41 INFO - Running setup.py install for mozhttpd 02:32:41 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 02:32:41 INFO - Running setup.py install for mozinfo 02:32:41 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 02:32:41 INFO - Running setup.py install for mozInstall 02:32:41 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 02:32:41 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 02:32:41 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 02:32:41 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 02:32:41 INFO - Running setup.py install for mozleak 02:32:41 INFO - Running setup.py install for mozlog 02:32:41 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 02:32:41 INFO - Running setup.py install for moznetwork 02:32:42 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 02:32:42 INFO - Running setup.py install for mozprocess 02:32:42 INFO - Running setup.py install for mozprofile 02:32:42 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 02:32:42 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 02:32:42 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 02:32:42 INFO - Running setup.py install for mozrunner 02:32:42 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 02:32:42 INFO - Running setup.py install for mozscreenshot 02:32:42 INFO - Running setup.py install for moztest 02:32:42 INFO - Running setup.py install for mozversion 02:32:42 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 02:32:42 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 02:32:42 INFO - Cleaning up... 02:32:42 INFO - Return code: 0 02:32:42 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:32:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:42 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:32:42 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:42 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:32:42 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:42 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fa0c236bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xee38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfb0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfadf60>, '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 0xfaed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfaf1d0>, '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': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', '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 02:32:42 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 02:32:42 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 02:32:42 INFO - Using env: {'DISPLAY': ':0', 02:32:42 INFO - 'HOME': '/home/cltbld', 02:32:42 INFO - 'LANG': 'en_US.UTF-8', 02:32:42 INFO - 'LANGUAGE': 'en_US:en', 02:32:42 INFO - 'LOGNAME': 'cltbld', 02:32:42 INFO - 'MAIL': '/var/mail/cltbld', 02:32:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:32:42 INFO - 'MOZ_NO_REMOTE': '1', 02:32:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:32:42 INFO - 'NO_EM_RESTART': '1', 02:32:42 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:32:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:32:42 INFO - 'PWD': '/builds/slave/test', 02:32:42 INFO - 'SHELL': '/bin/bash', 02:32:42 INFO - 'SHLVL': '1', 02:32:42 INFO - 'TERM': 'linux', 02:32:42 INFO - 'TMOUT': '86400', 02:32:42 INFO - 'USER': 'cltbld', 02:32:42 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', 02:32:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:32:42 INFO - '_': '/tools/buildbot/bin/python'} 02:32:42 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:32:42 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 02:32:42 INFO - Running setup.py (path:/tmp/pip-8sJ9BW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 02:32:43 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)) 02:32:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 02:32:43 INFO - Running setup.py (path:/tmp/pip-z8z1Bq-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 02:32:43 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)) 02:32:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 02:32:43 INFO - Running setup.py (path:/tmp/pip-md9Lzx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 02:32:43 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)) 02:32:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 02:32:43 INFO - Running setup.py (path:/tmp/pip-BAj945-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 02:32:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.48 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)) 02:32:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 02:32:43 INFO - Running setup.py (path:/tmp/pip-qVgR26-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 02:32:43 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)) 02:32:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 02:32:43 INFO - Running setup.py (path:/tmp/pip-Ere8MS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 02:32:43 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)) 02:32:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 02:32:43 INFO - Running setup.py (path:/tmp/pip-S71Mgl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 02:32:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo==0.9 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)) 02:32:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 02:32:43 INFO - Running setup.py (path:/tmp/pip-pzadUd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 02:32:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozInstall==1.12 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)) 02:32:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 02:32:43 INFO - Running setup.py (path:/tmp/pip-K_p1ip-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 02:32:43 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)) 02:32:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 02:32:43 INFO - Running setup.py (path:/tmp/pip-KpLHBx-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 02:32:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 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)) 02:32:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 02:32:43 INFO - Running setup.py (path:/tmp/pip-_37fKI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 02:32:43 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)) 02:32:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 02:32:43 INFO - Running setup.py (path:/tmp/pip-vPsK7Y-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 02:32:43 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.23 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)) 02:32:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 02:32:43 INFO - Running setup.py (path:/tmp/pip-Y0uiYY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 02:32:43 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)) 02:32:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 02:32:43 INFO - Running setup.py (path:/tmp/pip-tuebZn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 02:32:44 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)) 02:32:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 02:32:44 INFO - Running setup.py (path:/tmp/pip-oVtJka-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 02:32:44 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)) 02:32:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 02:32:44 INFO - Running setup.py (path:/tmp/pip-2etynK-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 02:32:44 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.7 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)) 02:32:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 02:32:44 INFO - Running setup.py (path:/tmp/pip-QPVzNE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 02:32:44 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)) 02:32:44 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)) 02:32:44 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)) 02:32:44 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)) 02:32:44 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 02:32:44 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.48->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 02:32:44 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 02:32: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 02:32: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 02:32:44 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32:44 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 02:32: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 02:32: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 02:32:46 INFO - Downloading blessings-1.6.tar.gz 02:32:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 02:32:46 INFO - Installing collected packages: blessings 02:32:46 INFO - Running setup.py install for blessings 02:32:46 INFO - Successfully installed blessings 02:32:46 INFO - Cleaning up... 02:32:46 INFO - Return code: 0 02:32:46 INFO - Done creating virtualenv /builds/slave/test/build/venv. 02:32:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:32:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:32:46 INFO - Reading from file tmpfile_stdout 02:32:46 INFO - Current package versions: 02:32:46 INFO - argparse == 1.2.1 02:32:46 INFO - blessings == 1.6 02:32:46 INFO - blobuploader == 1.2.4 02:32:46 INFO - docopt == 0.6.1 02:32:46 INFO - functools32 == 3.2.3-2 02:32:46 INFO - jsonschema == 2.5.1 02:32:46 INFO - manifestparser == 1.1 02:32:46 INFO - mozInstall == 1.12 02:32:46 INFO - mozcrash == 1.0 02:32:46 INFO - mozdebug == 0.1 02:32:46 INFO - mozdevice == 0.48 02:32:46 INFO - mozfile == 1.2 02:32:46 INFO - mozhttpd == 0.7 02:32:46 INFO - mozinfo == 0.9 02:32:46 INFO - mozleak == 0.1 02:32:46 INFO - mozlog == 3.4 02:32:46 INFO - moznetwork == 0.27 02:32:46 INFO - mozprocess == 0.23 02:32:46 INFO - mozprofile == 0.28 02:32:46 INFO - mozrunner == 6.13 02:32:46 INFO - mozscreenshot == 0.1 02:32:46 INFO - mozsystemmonitor == 0.3 02:32:46 INFO - moztest == 0.7 02:32:46 INFO - mozversion == 1.4 02:32:46 INFO - psutil == 3.1.1 02:32:46 INFO - requests == 1.2.3 02:32:46 INFO - wsgiref == 0.1.2 02:32:46 INFO - Installing None into virtualenv /builds/slave/test/build/venv 02:32:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:32:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:32:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:46 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fa0c236bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xee38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfb0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfadf60>, '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 0xfaed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfaf1d0>, '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': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', '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 02:32:46 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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 02:32:46 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.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub 02:32:46 INFO - Using env: {'DISPLAY': ':0', 02:32:46 INFO - 'HOME': '/home/cltbld', 02:32:46 INFO - 'LANG': 'en_US.UTF-8', 02:32:46 INFO - 'LANGUAGE': 'en_US:en', 02:32:46 INFO - 'LOGNAME': 'cltbld', 02:32:46 INFO - 'MAIL': '/var/mail/cltbld', 02:32:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:32:46 INFO - 'MOZ_NO_REMOTE': '1', 02:32:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:32:46 INFO - 'NO_EM_RESTART': '1', 02:32:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:32:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:32:46 INFO - 'PWD': '/builds/slave/test', 02:32:46 INFO - 'SHELL': '/bin/bash', 02:32:46 INFO - 'SHLVL': '1', 02:32:46 INFO - 'TERM': 'linux', 02:32:46 INFO - 'TMOUT': '86400', 02:32:46 INFO - 'USER': 'cltbld', 02:32:46 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', 02:32:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:32:46 INFO - '_': '/tools/buildbot/bin/python'} 02:32:46 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:32:46 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)) 02:32:46 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)) 02:32:46 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)) 02:32:46 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)) 02:32:46 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)) 02:32:46 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)) 02:32:46 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)) 02:32:46 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)) 02:32:46 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)) 02:32:46 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)) 02:32:46 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)) 02:32:46 INFO - Cleaning up... 02:32:46 INFO - Return code: 0 02:32:46 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 02:32:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:46 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 02:32:46 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:32:46 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 02:32:46 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 02:32: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.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--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 0x7fa0c236bf10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xee38a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0xfb0ca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0xfadf60>, '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 0xfaed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfaf1d0>, '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': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', '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 02:32:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 02:32:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 02:32:46 INFO - Using env: {'DISPLAY': ':0', 02:32:46 INFO - 'HOME': '/home/cltbld', 02:32:46 INFO - 'LANG': 'en_US.UTF-8', 02:32:46 INFO - 'LANGUAGE': 'en_US:en', 02:32:46 INFO - 'LOGNAME': 'cltbld', 02:32:46 INFO - 'MAIL': '/var/mail/cltbld', 02:32:46 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:32:46 INFO - 'MOZ_NO_REMOTE': '1', 02:32:46 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:32:46 INFO - 'NO_EM_RESTART': '1', 02:32:46 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:32:46 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:32:46 INFO - 'PWD': '/builds/slave/test', 02:32:46 INFO - 'SHELL': '/bin/bash', 02:32:46 INFO - 'SHLVL': '1', 02:32:46 INFO - 'TERM': 'linux', 02:32:46 INFO - 'TMOUT': '86400', 02:32:46 INFO - 'USER': 'cltbld', 02:32:46 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', 02:32:46 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:32:46 INFO - '_': '/tools/buildbot/bin/python'} 02:32:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 02:32:47 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 02:32:47 INFO - Cleaning up... 02:32:47 INFO - Return code: 0 02:32:47 INFO - Running post-action listener: _resource_record_post_action 02:32:47 INFO - Running post-action listener: _start_resource_monitoring 02:32:47 INFO - Starting resource monitoring. 02:32:47 INFO - [mozharness: 2016-12-24 10:32:47.200538Z] Finished create-virtualenv step (success) 02:32:47 INFO - [mozharness: 2016-12-24 10:32:47.200995Z] Running install step. 02:32:47 INFO - Running pre-action listener: _resource_record_pre_action 02:32:47 INFO - Running main action method: install 02:32:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 02:32:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 02:32:47 INFO - Reading from file tmpfile_stdout 02:32:47 INFO - Detecting whether we're running mozinstall >=1.0... 02:32:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 02:32:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 02:32:47 INFO - Reading from file tmpfile_stdout 02:32:47 INFO - Output received: 02:32:47 INFO - Usage: mozinstall [options] installer 02:32:47 INFO - Options: 02:32:47 INFO - -h, --help show this help message and exit 02:32:47 INFO - -d DEST, --destination=DEST 02:32:47 INFO - Directory to install application into. [default: 02:32:47 INFO - "/builds/slave/test"] 02:32:47 INFO - --app=APP Application being installed. [default: firefox] 02:32:47 INFO - mkdir: /builds/slave/test/build/application 02:32:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 02:32:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 02:33:03 INFO - Reading from file tmpfile_stdout 02:33:03 INFO - Output received: 02:33:03 INFO - /builds/slave/test/build/application/firefox/firefox 02:33:03 INFO - Running post-action listener: _resource_record_post_action 02:33:03 INFO - [mozharness: 2016-12-24 10:33:03.454410Z] Finished install step (success) 02:33:03 INFO - [mozharness: 2016-12-24 10:33:03.454653Z] Running run-tests step. 02:33:03 INFO - Running pre-action listener: _resource_record_pre_action 02:33:03 INFO - Running main action method: run_tests 02:33:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 02:33:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 02:33:03 INFO - Python 2.7.3 02:33:03 INFO - Return code: 0 02:33:03 INFO - grabbing minidump binary from tooltool 02:33:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.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')]} 02:33:03 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 0xfadf60>, '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 0xfaed40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0xfaf1d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 02:33:03 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 02:33:03 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 02:33:03 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 02:33:03 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 02:33:03 INFO - Return code: 0 02:33:03 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 02:33:03 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 02:33:03 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 02:33:03 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 02:33:03 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 02:33:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-003', '--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 02:33:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-003 --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 02:33:03 INFO - Using env: {'DISPLAY': ':0', 02:33:03 INFO - 'HOME': '/home/cltbld', 02:33:03 INFO - 'LANG': 'en_US.UTF-8', 02:33:03 INFO - 'LANGUAGE': 'en_US:en', 02:33:03 INFO - 'LOGNAME': 'cltbld', 02:33:03 INFO - 'MAIL': '/var/mail/cltbld', 02:33:03 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 02:33:03 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 02:33:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 02:33:03 INFO - 'MOZ_NO_REMOTE': '1', 02:33:03 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 02:33:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 02:33:03 INFO - 'NO_EM_RESTART': '1', 02:33:03 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 02:33:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 02:33:03 INFO - 'PWD': '/builds/slave/test', 02:33:03 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 02:33:03 INFO - 'SHELL': '/bin/bash', 02:33:03 INFO - 'SHLVL': '1', 02:33:03 INFO - 'TERM': 'linux', 02:33:03 INFO - 'TMOUT': '86400', 02:33:03 INFO - 'USER': 'cltbld', 02:33:03 INFO - 'XDG_SESSION_COOKIE': '7de08804244eb36560b44971000001c3-1482554493.170783-613431067', 02:33:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 02:33:03 INFO - '_': '/tools/buildbot/bin/python'} 02:33:03 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-003', '--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 02:33:03 INFO - mozversion application_buildid: 20161224004004 02:33:03 INFO - mozversion application_changeset: ec2672807887aa46bb4c2966478afa08d610d72d 02:33:03 INFO - mozversion application_display_name: FirefoxDeveloperEdition 02:33:03 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 02:33:03 INFO - mozversion application_name: Firefox 02:33:03 INFO - mozversion application_remotingname: firefox-dev 02:33:03 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 02:33:03 INFO - mozversion application_vendor: Mozilla 02:33:03 INFO - mozversion application_version: 52.0a2 02:33:03 INFO - mozversion platform_buildid: 20161224004004 02:33:03 INFO - mozversion platform_changeset: ec2672807887aa46bb4c2966478afa08d610d72d 02:33:03 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 02:33:03 INFO - mozversion platform_version: 52.0a2 02:33:03 INFO - using testdate: 1482575583 02:33:03 INFO - actual date: 1482575583 02:33:03 INFO - starting webserver on 'localhost:37252' 02:33:03 INFO - SUITE-START | Running 2 tests 02:33:03 INFO - TEST-START | dromaeo_css 02:33:03 INFO - operating with platform_type : linux_ 02:33:03 INFO - Initialising browser for dromaeo_css test... 02:33:03 INFO - TEST-INFO | started process 9145 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpbfpd3p/profile http://localhost:37252/getInfo.html) 02:33:08 INFO - PROCESS | 9145 | __metrics Screen width/height:1600/1200 02:33:08 INFO - PROCESS | 9145 | colorDepth:24 02:33:08 INFO - PROCESS | 9145 | Browser inner width/height: 1024/697 02:33:08 INFO - PROCESS | 9145 | __metrics 02:33:09 ERROR - PROCESS | 9145 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3175: TypeError: this.tabs is undefined 02:33:09 INFO - TEST-INFO | 9145: exit 0 02:33:09 INFO - Browser initialized. 02:33:09 INFO - Running cycle 1/1 for dromaeo_css test... 02:33:09 INFO - TEST-INFO | started process 9278 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpbfpd3p/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 02:33:21 INFO - PROCESS | 9278 | RSS: Main: 152051712 02:33:21 INFO - PROCESS | 9278 | 02:34:11 INFO - PROCESS | 9278 | 1482575651227 addons.productaddons ERROR Request failed certificate checks: [Exception... "SSL is required and URI scheme is not https." nsresult: "0x8000ffff (NS_ERROR_UNEXPECTED)" location: "JS frame :: resource://gre/modules/CertUtils.jsm :: checkCert :: line 145" data: no] 02:36:22 INFO - PROCESS | 9278 | Cycle 1(1): loaded http://localhost:37252/tests/dromaeo/cssquery-dojo.html (next: http://localhost:37252/tests/dromaeo/cssquery-ext.html) 02:36:23 INFO - PROCESS | 9278 | RSS: Main: 155070464 02:36:23 INFO - PROCESS | 9278 | 02:39:25 INFO - PROCESS | 9278 | Cycle 1(1): loaded http://localhost:37252/tests/dromaeo/cssquery-ext.html (next: http://localhost:37252/tests/dromaeo/cssquery-jquery.html) 02:39:26 INFO - PROCESS | 9278 | RSS: Main: 152526848 02:39:26 INFO - PROCESS | 9278 | 02:42:27 INFO - PROCESS | 9278 | Cycle 1(1): loaded http://localhost:37252/tests/dromaeo/cssquery-jquery.html (next: http://localhost:37252/tests/dromaeo/cssquery-mootools.html) 02:42:28 INFO - PROCESS | 9278 | RSS: Main: 153747456 02:42:28 INFO - PROCESS | 9278 | 02:45:30 INFO - PROCESS | 9278 | Cycle 1(1): loaded http://localhost:37252/tests/dromaeo/cssquery-mootools.html (next: http://localhost:37252/tests/dromaeo/cssquery-prototype.html) 02:45:30 INFO - PROCESS | 9278 | RSS: Main: 151744512 02:45:30 INFO - PROCESS | 9278 | 02:48:33 INFO - PROCESS | 9278 | Cycle 1(1): loaded http://localhost:37252/tests/dromaeo/cssquery-prototype.html (next: http://localhost:37252/tests/dromaeo/cssquery-yui.html) 02:48:34 INFO - PROCESS | 9278 | RSS: Main: 153853952 02:48:34 INFO - PROCESS | 9278 | 02:51:36 INFO - PROCESS | 9278 | Cycle 1(1): loaded http://localhost:37252/tests/dromaeo/cssquery-yui.html (next: http://localhost:37252/tests/dromaeo/cssquery-dojo.html) 02:51:36 INFO - PROCESS | 9278 | RSS: Main: 155754496 02:51:36 INFO - PROCESS | 9278 | 02:51:36 INFO - PROCESS | 9278 | __start_tp_report 02:51:36 INFO - PROCESS | 9278 | _x_x_mozilla_page_load 02:51:36 INFO - PROCESS | 9278 | _x_x_mozilla_page_load_details 02:51:36 INFO - PROCESS | 9278 | |i|pagename|runs| 02:51:36 INFO - PROCESS | 9278 | |0;dojo.html;3234.935301293973;3278.7377009839215;3330.966690333096;3345.6152542457626;3351.748618853587;5702.315722113347;5751.827445176641;5767.855803604912;5770.163326317686;5774.566907481934;5791.276090488689;5844.006518891788;5871.383504732005;5876.4123587641325;5888;5295.338082739658;5297.523222909927;5328.600354973373;5343.332083489564;5346.117890548075;5329.520343169133;5372.54333381661;5375.919361209585;5378.865528361783;5401.108817045183;5172.120739474299;5181;5367.597430192732;5390.164524498709;5393.78424863005;5239.895202095956;5279.680079980024;5343.599230057723;5391.24522566837;5409.377921539034;5243.9213411798855;5313.149896016657;5319.069162896478;5325.547328477084;5327.946720532784;5563;5802.303723553158;5855.355910849803;5900.822975310747;5910.893259210565;6024.367441418632;6066.302375226861;6076.574639775217;6107.816765497042;6137.60105593135;6090.939090609126;6105.053716673922;6120.265568131853;6206.906896396557;6215.9378406216265;5740.885182296414;5741.540676745851;5742.368339482696;5757.88484230313;5769.249997500298;6215.378462153749;6231.034189700604;6254.249490061131;6270;6353.555251132377;6013.729382177812;6063.181470501514;6067.876243314893;6068.6358818471035;6071.119687645267;5986;6025.18659980897;6145.555794388315;6159.907601385983;6173.32093469718;6112.290716697417;6132.78535251264;6133.233345831771;6210.4100110489435;6230.844228894223;6190.350013248634;6199.535034872402;6220.906686399708;6233.2208473940755;6246.375362463808;4677.204875171229;4824.011077729057;4827.8551643450755;4836.032793441326;4839.806407743651;4161.729487583298;4213.936790948138;4224.66202703783;4299.204647140289;4312.310030395121;5933.465988061095;5970.432808883149;5971.970140149271;5972.761089556456;5977.760889564455;6252.843678908063;6263.123162757218;6281.371862813682;6283.96858015707;6288.654124023131;5811.389804070512;5864.677442740605;5911.7635294587735;5912.3496415394275;5932.703364831741;5342.198670199501;5345.33183352081;5349.86625334362;5351.625386222927;5362.383325917492;5900.557458190567;6477.060826180177;6487.2539657939;6507.349265073455;6510.348965103546;6014.0678194879865;6038.064100064497;6127.372786728296;6185.443310102112;6282.183316168869;6520;6531.444827189552;6548.0832683423405;6555.4427873631275;6564.048213009182;6136.631802091889;6154.292256390572;6167.198264225622;6179.3202747698615;6180.443760061616;6031.698415079316;6128.136482154469;6130.673316708229;6304.6847657617855;6331.588446750947;5982.341942386247;6091.695415229132;6104.755809767559;6110.77140286259;6139.140520327247;5978.641281523122;5990.7004649768205;5997.250343707036;6008.969955150196;6009.278886533644;5906.468417842415;5946.821595352147;6004.849878753066;6073.605215660968;6089.056196289582;6002.189704389852;6048.90926636092;6080.179175811386;6090.056041313604;6135.07973803933;5855.238818953509;5920.319163296103;5921.437463440966;5927.2590926134235;5955.940440595538 02:51:36 INFO - PROCESS | 9278 | |1;ext.html;600.2886579403407;625.440230993261;657.5528640524444;660.92729799722;683.5488577538825;43849.34225986609;44895.326570101475;45059;45147;45211.54788452115;45753.542464575345;45764.31353529691;45939.540604593945;46392.768036159854;46440.53559464413;9042;9080.727578172633;9087.273018158565;9094.727158185266;9148.222401095882;8894.332925030616;9013.819723605557;9065.22945549629;9101.408408453462;9137.817243655123;9077.954610226972;9087.091290870892;9096.27229821616;9126.498042607654;9155.313351498631;9067.954660226722;9112.316576256773;9123.270138388913;9131.634734610607;9161.083891610819;8947.239484643747;8967.910320896837;9014.053524379977;9033.277337812959;9043.547822608909;44471.777641111585;44926.55073449289;44977.10045799066;45063.32405013927;45067.323990140176;3576.946345804815;3663.725220608465;3831.348670725983;4106.260873042851;4413.977930110361;32492.837535812407;32841.34317313664;32942.34115317704;32969.17577060569;33212.667873321196;3926.371780515104;3943.4479172915817;3976.5824588418377;3990;4031.9596804031876;352148;354002;354473;357945;358080;62982.055269170996;63095.36904630895;63294;63378.68310658417;63394;60551.394486054574;60742;60744.39255607476;60915.39084609186;60994;18348.63302733938;18693.439196824118;18715.157817898227;18715.251389944522;18730.438086857415;14308;14362.989181514597;14470.131792092508;14473.203973781543;14489.492867749788;17747.378841740734;18064.548386290448;18172.63654726898;18237.45287641373;18519;6163;6166.9383306167265;6244.500439964792;6324.841878952971;6417.935820641827;958.3770549143113;1009.4246279620546;1036.528379587286;1132.445101900063;1142.2689478733616;33228.66771332304;33705.32589348199;33748.49377259343;33946.49080263798;33970.660293397246;1133.489929531714;1162.0587324267372;1183.9822402663967;1188.2157775867886;1189.102227817992;17058.914705426392;17114.914425427793;17712.202950867242;17837.732434013502;18002.54993625144;171321;171952;172068.1396593009;172159.13920430318;172628;64270.678646606466;64377.356226438074;64431.67784161049;65052.34947650557;65151;1421.2112277685776;1422.4879043544315;1454.978175327371;1456.293697556663;1464.399596165567;32707.509387358732;33838.3232335347;34071;34154.975350739514;34760.652393476754;56601;57261.71369143128;57487.71256143692;57646;57740.4225957735;505477;506991;508635;509593;510188;30900.845495772377;31140.53289200709;49370.259446107615;49446.258306126154;51446.22830657468;51654.48345516647;52370.476295236556;52622.47377526176;53936.460635393145;53945.730271348395;42380;42621.36067959045;42738.145237095705;43360.13279734325;44222.77888610536;45096;45959.77020114878;46287.76856115833;47453.28820067771;49874.25188622246;44679.329810053525;45316.54683453123;45608.315875261236;46205.30692039689;46210.30684539668;37375.813120934225;39641;40431.1913761729;40713.38929916113;40938.59061409467;26802.329941751614;27121.86439067792;27266.454670906867;27381.452370952073;27494 02:51:36 INFO - PROCESS | 9278 | |2;jquery.html;427.5480121503177;433.7874441523653;438.1193800461072;443.87952692571236;446.5266817173795;18915.432537023913;19300.613987720255;20042;20507.794922050776;20539.897300513476;20129.69805452916;20664.8966755166;20742.377728668125;20764;20969;5624.325080990287;5910.34986151523;5913.2608423947;5913.970430147865;5914.2015827863115;5631.690257035882;5723.055695810186;5798.2172406725185;5861;5904.0553511438175;5978.192943952576;5985.221921150244;5987.9401205987815;5994.220751302325;6003.0395136778125;5954.672493012882;6133.233345831771;6389.936100639027;6443.96778016107;6503.544751867371;5669.9433005669825;5814.912776308359;5837.036888913324;5856.648601083949;5879.706014699248;15078.246087695572;15302.387904483807;15343.309551070228;15364.923175384163;22478.213262535734;2236.944076398087;2313.086330899302;2315.235972129193;2413.5172965406987;2529.3929456930387;10566.260361774679;10723.195760318007;10734.409607471585;10933.56265749377;11397.544098236143;1898.2596787252983;1926.749522562058;1962.3622322745023;1971.3297478857114;1992.9701054484194;89897;89937.10062899353;93389.5330523343;94283.52858235665;95297.9999999993;11556.59551915679;11595.536178552931;11723.4138293085;11809.173357865038;12100.939495302468;16991.32034718622;17033.31866725317;17072.573185670208;17077.316907323817;17092.145392730316;8605.612747426381;8764.430312029697;8769.905148715992;8813.691520796741;9038.638454461749;8388.622511986976;8478.364122690822;8500.44747091437;8645.049044605088;8657.437266577652;5089.567386772092;5097.388313402341;5108.693478391308;5109.412417571953;5114.43741188469;2035.460602940222;2068.400163952467;2128.584925939458;2131.9253826116324;2137.5297434564372;911.9589618467185;1023.4984857419811;1035.596117514155;1060.3266925502362;1112.1547623805966;20094.497637558885;20570.28004019882;20821.271255505984;20856.687149692767;21049.158033678483;991.5785791038779;1003.227514813604;1020.5917632946732;1039.2309690828884;1089.5315014543821;9576.23390128788;10922.508487118099;11396.94721073388;11437.885621143849;11481.253718508437;546482;556582;558181;560568;562986;53573.73213133909;93632.53183734174;95136.52431737797;96849;96945;1068.4817863336275;1073.8765042020111;1103.1560855945047;1109.389835590422;1109.755853712182;18635.534111647317;18955.431337059912;19186.642337590587;19245.03774811282;19259;44589.55410445854;45171.096578068915;45753.08493830171;46025.76987115043;46392.76803615961;61394;61592.69203653953;62667.686661566404;62841.68579157075;62940;8650.221480066573;8670.869936950825;8832.470051796656;8868.600912959062;9107;10827.945860270649;12901.225926444444;12961.740765184832;12970.80543791825;13054.216746995211;5854.531637468907;8767.693130740394;11560.248583842023;11765.294082355085;11850.348230847387;11231.606893758679;11272.943635281772;11501.53993840237;11529.827052594386;11686.590969316034;11527.884721153017;11948.641540753792;11990.520379184734;12026.579069732867;12063.758724825278;8719.694810681596;8789.428687135316;8931.062238464867;9024.413413128126;9107.635694572144;9018.549072546477;10962.465254864166;11269.492872820907;11371.829422558503;11669.76660466803 02:51:36 INFO - PROCESS | 9278 | |3;mootools.html;1489.419126540649;1516.4995551468016;1686.266474083773;1793.9641207175848;1830.2404502131617;7951.76144715658;8103.068147163078;8702.869456958151;9316.068393160689;9325.766855828608;8682;8976.057513961037;8983.95508022459;9122.908770912289;9208.447493150416;2469.728329883716;2486.465409936863;2497.912573059943;2503.3491292264052;2518.3074654469983;2482.354587807174;2538.959026799013;2547.5159719653207;2552.247087109298;2563.4232297732956;2460.495598402323;2472.987635061822;2477.801775857927;2478.0459523083564;2491.476789874129;2442.9755702443013;2455.5579995600783;2460.938476538092;2467.037855236459;2486.154707399484;2426.2236084452984;2461.9753802461923;2477.913273035435;2492.6136448850457;2493.613489909067;9113.225375843062;9178.816423671557;9192.632294708204;9198.448093114435;9208.861867071999;5606.803761868315;5774.653520788766;5782.826515204551;5786.305643322786;5789.247397838254;3516.261585067139;3524.9118772030647;3656.2687462507606;3702.2965636528975;3704.518412606371;1184.7689700508404;1194.1939191046097;1226.4174517104393;1230.655416483386;1233.734747029393;12655.557055503014;12712.046596505206;12751.87248127516;12761;12825.87174128256;4826.107170173529;5051.974740126349;5108.7190204538365;5161.974190129025;5172.612054095958;10757.193210509087;10798.622048228275;10817.405042722727;10822.350658960488;10831.566737330419;5788.855278618068;5838.4453476919625;5841.912371314434;5842.357340692521;5858.150568167592;4497.347884556786;4952.182889823211;5213.947860521346;5218.086834803894;5274.97362513185;4213.852515161954;4278.657707383401;4315.417418648442;4356.4336636237085;4372.584604462571;1416.7024924765708;1429.2139323372103;1438.9568312950628;1439.632893612143;1448.5654303708845;792.528445574882;879.5821984557411;884.1997991817416;893.3478560650632;904.7647611620895;5963.821085367359;6033.577649564576;6086.573939824169;6095.05526643371;6095.6952152392205;471.6062088156359;475.82156691240783;476.5044353872004;478.0820824017894;492.1338444337991;4066.674666026711;4143.958560414418;4179.9582004179565;4187.330027195634;4204.87385378433;10340.534675939602;10934.125269978382;10943.398113103856;10952.835707464394;10957.561697532168;10682.572697092184;10731.785364292671;10789.730256743487;10797.622083227207;10824.079953204066;8326.333893288522;8413.242808147295;8413.747587572383;8420.410571259952;8425.705100321582;6208.2239720034995;6327.114204011534;6342.302346741947;6349.269833969152;6370;10555.102816260396;10583.047525722723;10673.8932610676;10734.677959661223;10735.838962415413;10368.118709909742;10559.102476289294;10566.841497377392;10630.574777008833;10747.570097196025;7656.540607563564;7821.139674635671;7832.138464768757;7917.722879699183;7940.0471943364855;8603.139686031347;8617.224449799549;8638.13618638131;8700.956495217484;8700.999385070798;7896.605169741375;7915.1293357729455;7966.243206895336;7982.920170798217;8028.638711258124;7422.851542969002;7470.402367810453;7487.588182650006;7488.475806693479;7490.925090749023;6983.441324694114;7000.369966703021;7001.8249543759775;7077.433805295667;7079.1505019398;5313.2561441397465;5371.355437347387;5427;5476.479734425223;5479.972600136974;5181.55956743666;5292.52367286946;5305.787768489372;5363.490468405495;5373.247745315581 02:51:36 INFO - PROCESS | 9278 | |4;prototype.html;354.1270767557969;358.290584642408;361.2594181927049;361.8588750387349;365.8006386519345;5592.420850655579;5626.352969408519;5641.407652196512;5651.350094739107;5661.830145095649;5471.398146203915;5546.667199968005;5572.9968605650965;5583.469570390816;5609.242752228448;4312.460942382202;4378.540253273408;4403.163398954204;4413.713108647944;4425.8450954216605;4386.780660966955;4406.950767892929;4412.360207769888;4420.182266280748;4421.403110580062;4371.322445021011;4407.669424793137;4409.118176364724;4410.140022695576;4410.713303635253;4251.298535741599;4353;4373.934390984138;4378.759717808831;4379.386885835986;3900.531936167678;3913.3934240192816;3915.6280153385383;3923.8816937173056;3924.7645141291614;5397.163439666858;5432.592555558349;5470.261514695505;5472.50747432733;5501.9174712379345;4694.718316900997;4891.364122664031;4929.556339929388;4982.77921909131;5091.847244582668;5754.165645981309;5815.680137592431;5831.358550559435;5831.854203644901;5850.151727999459;4197.559256278108;4215.725977811463;4226.78866056699;4227;4228.069824638575;5917.408259174048;5997.970010149921;6102.69486525672;6111.57218994675;6130.509559235251;4303.4190384298345;4305.268104422255;4305.901994991257;4310;4323.200207961537;4312.805923733439;4349.15161056556;4360.193364227564;4392.560743925582;4392.934105988413;4839.838438774669;4935.580475659537;4961;4985.177445721488;4999.925001124986;5866.943950088939;5873.823785286449;5874.500667443315;5889.792592518524;5904.132793020578;1462.824461064679;1472.2565104622097;1477.8915813140145;1478.6672998575234;1478.6839712655744;974.3958745577787;1009.8838633557089;1015.9034891685278;1022.8107800057013;1038.937663740178;5550.306211723535;5554.611177217636;5559.805406810742;5594.216809646653;5607.7476513556985;5854.912176317359;5878.5297176225795;5938.851528711817;5962.568983444029;5974.671393073336;5390.784368625211;5514.228008078872;5520.267467603562;5548.500634942794;5561.888762224733;3053.908382748521;3084.892028778982;3087.320789426323;3089.382123575249;3122.8126312421327;5885.293764748258;6062.484688801413;6085.9695701521205;6120.479759220427;6122.969385153046;5899.734511946973;5958.6424814511265;5968.432998865101;5976.593341795222;6004.309504407049;6059.122161816441;6088.208532890696;6099.370874329678;6126.78556250538;6186.051393810935;5586.026495654259;5783.363829978614;5813.593048486566;5818.2436283282905;5828.184054232326;5691.658500489983;5753.280839895013;5780.508656764054;5797.8550536236935;5813.360530341574;6037.818865434044;6171.382861713792;6172.444479996642;6217.626942383471;6269.529785266214;4295.871123866289;4316.266234740165;4316.827326907014;4319.308910574293;4328.8268469260875;5847.532197424281;6063.545234107548;6073.453389194994;6086.330503644507;6091.695415229309;5919.556033297434;5923.229980102559;5931.495822855106;5937.643741375531;5938.524918006636;5821.370016395416;5842.909963025814;5849.859277440858;5855.473007429352;5858.7070646466655;5739.770409183586;5905.962442957173;5928.762849486145;5939.881202375842;5959.851003724768;5939.881202376015;5959.510122469383;5975.954208013667;5976.671283079472;5978.282606087298;5689.175069614966;5791.594588378773;5827.388124246893;5836.445537673914;5859.384764599826 02:51:36 INFO - PROCESS | 9278 | |5;yui.html;719.2843121094512;726.9164046134696;763.5304287862966;775.60056570866;779.0184367696704;14395.42418303268;16035.919820400897;16227.83772162278;16336.509904702849;16420.42528511501;14805.481808136718;15693.686126277467;16123.27445264963;16193.676126477463;16548.089855057966;848.7241646464893;862.361852229352;863.218786997768;867.5445391169624;869.1048220333067;837.3050368194384;854.6965827131372;859.4628357276702;859.5143743784773;862.7713655881197;909.3634455880876;909.6952520905504;912.4753266871543;914.3325372478095;919.4345477531336;896.8520194167954;900.0594378874059;902.2871931174332;908.2143945487172;910.0444533240071;667.3993405934649;672.3545396419444;672.4754691340762;672.5897202706345;673.0241150331989;15601.297941592655;15935.282912268976;15943.362265509482;15978.840211597852;16170.11064391458;14398.640033999234;14784.556463306119;14914.403423863032;14927.776083358758;14963.775543366859;11829.290242585472;11883.40582970848;11896.66893269877;12014.159008869383;12051.638450846489;3784.5080139581955;3786.583475817658;3832.2143960488033;3837.9232415351535;3854.3062248795204;68337.65831170863;69170;69298.30701692968;70123.64938175328;70535.64732176306;10952.507137178845;11240.98831105188;11454.312741235386;11596.478158482889;11642.825357619642;21662.675059874113;21663.133474661154;21984.340469785933;22126.88936555307;22317.665235021486;8433.578321083922;8443.915560844436;8581.184787445183;8702.956485217534;8835.674648802602;4675.08835777027;4675.602573781199;4839.322494850724;4991.401031876198;4991.9500804991485;3659.524261845943;3721.5906250312446;3746.5691445484117;3747.3442147624055;3755.061234691327;627.2786295759913;634.1280738983897;640.4044238857907;641.0544446940725;656.9704363303663;671.5534169777142;689.675852349395;691.5643144818832;778.260652380241;799.5282783157965;9336.90663093374;9962.402255864672;10117.190624750003;10201.94899025515;10383.22125840565;602.5992714844667;664.8005598320484;760.3195140349357;779.473855147773;784.8430313937235;4717.5282471753235;4774.856754297377;4833.178359678863;4865.367502224688;4867.829625963145;87907;95317.52341238249;95509.52245238869;97846.51076744714;98232.50883745536;65780.6710966442;67141.32858671449;84706.57646711727;85228.57385713156;85830.14169858347;51788.74105629448;53989.460105398444;55634.72182639061;63356.683216583624;72370.2762972374;9843.753906152404;9864.605415783288;9977.251706121924;10324.896751032393;10391.012853778879;38481.42277865778;42791.14417711566;44591;45784;49382;50744.74627626838;56202;63579.774707885;65102.674486627264;66147;13227.735445291233;13389.531366402129;13392.665183370103;13714.24571648569;13795.034347595572;14406.855931440552;14496.927515362355;14500;14745;14867.776983345475;13060.151090179108;13254.867451325363;13268.203907765565;13281;13509;12359.25844449336;13341;13573.660658483617;13672.179669219879;13791.241481718602;12373.376979809933;12512.937435312766;12698.619041428772;12839.550615728405;13262.137961032502;11092.833607496055;11249.831387419226;11332.546698131982;11566.248193867372;11798.292102473879;10031.123173069915;10800.08199303068;10984.395858227874;11014.118870490502;11087.22389432732 02:51:36 INFO - PROCESS | 9278 | __end_tp_report 02:51:36 INFO - PROCESS | 9278 | __start_cc_report 02:51:36 INFO - PROCESS | 9278 | _x_x_mozilla_cycle_collect,311 02:51:36 INFO - PROCESS | 9278 | __end_cc_report 02:51:36 INFO - PROCESS | 9278 | __startTimestamp1482576696648__endTimestamp 02:51:36 INFO - PROCESS | 9278 | 02:51:36 INFO - PROCESS | 9278 | ------- Summary: start ------- 02:51:36 INFO - PROCESS | 9278 | Number of tests: 6 02:51:36 INFO - PROCESS | 9278 | 02:51:36 INFO - PROCESS | 9278 | [#0] dojo.html Cycles:165 Average:5761.53 Median:5977.76 stddev:647.04 (10.8%) stddev-sans-first:617.92 02:51:36 INFO - PROCESS | 9278 | Values: 3234.9 3278.7 3331.0 3345.6 3351.7 5702.3 5751.8 5767.9 5770.2 5774.6 5791.3 5844.0 5871.4 5876.4 5888.0 5295.3 5297.5 5328.6 5343.3 5346.1 5329.5 5372.5 5375.9 5378.9 5401.1 5172.1 5181.0 5367.6 5390.2 5393.8 5239.9 5279.7 5343.6 5391.2 5409.4 5243.9 5313.1 5319.1 5325.5 5327.9 5563.0 5802.3 5855.4 5900.8 5910.9 6024.4 6066.3 6076.6 6107.8 6137.6 6090.9 6105.1 6120.3 6206.9 6215.9 5740.9 5741.5 5742.4 5757.9 5769.2 6215.4 6231.0 6254.2 6270.0 6353.6 6013.7 6063.2 6067.9 6068.6 6071.1 5986.0 6025.2 6145.6 6159.9 6173.3 6112.3 6132.8 6133.2 6210.4 6230.8 6190.4 6199.5 6220.9 6233.2 6246.4 4677.2 4824.0 4827.9 4836.0 4839.8 4161.7 4213.9 4224.7 4299.2 4312.3 5933.5 5970.4 5972.0 5972.8 5977.8 6252.8 6263.1 6281.4 6284.0 6288.7 5811.4 5864.7 5911.8 5912.3 5932.7 5342.2 5345.3 5349.9 5351.6 5362.4 5900.6 6477.1 6487.3 6507.3 6510.3 6014.1 6038.1 6127.4 6185.4 6282.2 6520.0 6531.4 6548.1 6555.4 6564.0 6136.6 6154.3 6167.2 6179.3 6180.4 6031.7 6128.1 6130.7 6304.7 6331.6 5982.3 6091.7 6104.8 6110.8 6139.1 5978.6 5990.7 5997.3 6009.0 6009.3 5906.5 5946.8 6004.8 6073.6 6089.1 6002.2 6048.9 6080.2 6090.1 6135.1 5855.2 5920.3 5921.4 5927.3 5955.9 02:51:36 INFO - PROCESS | 9278 | 02:51:36 INFO - PROCESS | 9278 | [#1] ext.html Cycles:180 Average:54123.78 Median:44951.83 stddev:98616.85 (219.4%) stddev-sans-first:98811.62 02:51:36 INFO - PROCESS | 9278 | Values: 600.3 625.4 657.6 660.9 683.5 43849.3 44895.3 45059.0 45147.0 45211.5 45753.5 45764.3 45939.5 46392.8 46440.5 9042.0 9080.7 9087.3 9094.7 9148.2 8894.3 9013.8 9065.2 9101.4 9137.8 9078.0 9087.1 9096.3 9126.5 9155.3 9068.0 9112.3 9123.3 9131.6 9161.1 8947.2 8967.9 9014.1 9033.3 9043.5 44471.8 44926.6 44977.1 45063.3 45067.3 3576.9 3663.7 3831.3 4106.3 4414.0 32492.8 32841.3 32942.3 32969.2 33212.7 3926.4 3943.4 3976.6 3990.0 4032.0 352148.0 354002.0 354473.0 357945.0 358080.0 62982.1 63095.4 63294.0 63378.7 63394.0 60551.4 60742.0 60744.4 60915.4 60994.0 18348.6 18693.4 18715.2 18715.3 18730.4 14308.0 14363.0 14470.1 14473.2 14489.5 17747.4 18064.5 18172.6 18237.5 18519.0 6163.0 6166.9 6244.5 6324.8 6417.9 958.4 1009.4 1036.5 1132.4 1142.3 33228.7 33705.3 33748.5 33946.5 33970.7 1133.5 1162.1 1184.0 1188.2 1189.1 17058.9 17114.9 17712.2 17837.7 18002.5 171321.0 171952.0 172068.1 172159.1 172628.0 64270.7 64377.4 64431.7 65052.3 65151.0 1421.2 1422.5 1455.0 1456.3 1464.4 32707.5 33838.3 34071.0 34155.0 34760.7 56601.0 57261.7 57487.7 57646.0 57740.4 505477.0 506991.0 508635.0 509593.0 510188.0 30900.8 31140.5 49370.3 49446.3 51446.2 51654.5 52370.5 52622.5 53936.5 53945.7 42380.0 42621.4 42738.1 43360.1 44222.8 45096.0 45959.8 46287.8 47453.3 49874.3 44679.3 45316.5 45608.3 46205.3 46210.3 37375.8 39641.0 40431.2 40713.4 40938.6 26802.3 27121.9 27266.5 27381.5 27494.0 02:51:36 INFO - PROCESS | 9278 | 02:51:36 INFO - PROCESS | 9278 | [#2] jquery.html Cycles:180 Average:31356.93 Median:2314.16 stddev:91696.35 (3962.4%) stddev-sans-first:91924.17 02:51:36 INFO - PROCESS | 9278 | Values: 427.5 433.8 438.1 443.9 446.5 18915.4 19300.6 20042.0 20507.8 20539.9 20129.7 20664.9 20742.4 20764.0 20969.0 5624.3 5910.3 5913.3 5914.0 5914.2 5631.7 5723.1 5798.2 5861.0 5904.1 5978.2 5985.2 5987.9 5994.2 6003.0 5954.7 6133.2 6389.9 6444.0 6503.5 5669.9 5814.9 5837.0 5856.6 5879.7 15078.2 15302.4 15343.3 15364.9 22478.2 2236.9 2313.1 2315.2 2413.5 2529.4 10566.3 10723.2 10734.4 10933.6 11397.5 1898.3 1926.7 1962.4 1971.3 1993.0 89897.0 89937.1 93389.5 94283.5 95298.0 11556.6 11595.5 11723.4 11809.2 12100.9 16991.3 17033.3 17072.6 17077.3 17092.1 8605.6 8764.4 8769.9 8813.7 9038.6 8388.6 8478.4 8500.4 8645.0 8657.4 5089.6 5097.4 5108.7 5109.4 5114.4 2035.5 2068.4 2128.6 2131.9 2137.5 912.0 1023.5 1035.6 1060.3 1112.2 20094.5 20570.3 20821.3 20856.7 21049.2 991.6 1003.2 1020.6 1039.2 1089.5 9576.2 10922.5 11396.9 11437.9 11481.3 546482.0 556582.0 558181.0 560568.0 562986.0 53573.7 93632.5 95136.5 96849.0 96945.0 1068.5 1073.9 1103.2 1109.4 1109.8 18635.5 18955.4 19186.6 19245.0 19259.0 44589.6 45171.1 45753.1 46025.8 46392.8 61394.0 61592.7 62667.7 62841.7 62940.0 8650.2 8670.9 8832.5 8868.6 9107.0 10827.9 12901.2 12961.7 12970.8 13054.2 5854.5 8767.7 11560.2 11765.3 11850.3 11231.6 11272.9 11501.5 11529.8 11686.6 11527.9 11948.6 11990.5 12026.6 12063.8 8719.7 8789.4 8931.1 9024.4 9107.6 9018.5 10962.5 11269.5 11371.8 11669.8 02:51:36 INFO - PROCESS | 9278 | 02:51:36 INFO - PROCESS | 9278 | [#3] mootools.html Cycles:180 Average:5986.71 Median:2659.12 stddev:3355.16 (126.2%) stddev-sans-first:3347.55 02:51:36 INFO - PROCESS | 9278 | Values: 1489.4 1516.5 1686.3 1794.0 1830.2 7951.8 8103.1 8702.9 9316.1 9325.8 8682.0 8976.1 8984.0 9122.9 9208.4 2469.7 2486.5 2497.9 2503.3 2518.3 2482.4 2539.0 2547.5 2552.2 2563.4 2460.5 2473.0 2477.8 2478.0 2491.5 2443.0 2455.6 2460.9 2467.0 2486.2 2426.2 2462.0 2477.9 2492.6 2493.6 9113.2 9178.8 9192.6 9198.4 9208.9 5606.8 5774.7 5782.8 5786.3 5789.2 3516.3 3524.9 3656.3 3702.3 3704.5 1184.8 1194.2 1226.4 1230.7 1233.7 12655.6 12712.0 12751.9 12761.0 12825.9 4826.1 5052.0 5108.7 5162.0 5172.6 10757.2 10798.6 10817.4 10822.4 10831.6 5788.9 5838.4 5841.9 5842.4 5858.2 4497.3 4952.2 5213.9 5218.1 5275.0 4213.9 4278.7 4315.4 4356.4 4372.6 1416.7 1429.2 1439.0 1439.6 1448.6 792.5 879.6 884.2 893.3 904.8 5963.8 6033.6 6086.6 6095.1 6095.7 471.6 475.8 476.5 478.1 492.1 4066.7 4144.0 4180.0 4187.3 4204.9 10340.5 10934.1 10943.4 10952.8 10957.6 10682.6 10731.8 10789.7 10797.6 10824.1 8326.3 8413.2 8413.7 8420.4 8425.7 6208.2 6327.1 6342.3 6349.3 6370.0 10555.1 10583.0 10673.9 10734.7 10735.8 10368.1 10559.1 10566.8 10630.6 10747.6 7656.5 7821.1 7832.1 7917.7 7940.0 8603.1 8617.2 8638.1 8701.0 8701.0 7896.6 7915.1 7966.2 7982.9 8028.6 7422.9 7470.4 7487.6 7488.5 7490.9 6983.4 7000.4 7001.8 7077.4 7079.2 5313.3 5371.4 5427.0 5476.5 5480.0 5181.6 5292.5 5305.8 5363.5 5373.2 02:51:36 INFO - PROCESS | 9278 | 02:51:36 INFO - PROCESS | 9278 | [#4] prototype.html Cycles:180 Average:4921.34 Median:5584.75 stddev:1435.77 (25.7%) stddev-sans-first:1398.28 02:51:36 INFO - PROCESS | 9278 | Values: 354.1 358.3 361.3 361.9 365.8 5592.4 5626.4 5641.4 5651.4 5661.8 5471.4 5546.7 5573.0 5583.5 5609.2 4312.5 4378.5 4403.2 4413.7 4425.8 4386.8 4407.0 4412.4 4420.2 4421.4 4371.3 4407.7 4409.1 4410.1 4410.7 4251.3 4353.0 4373.9 4378.8 4379.4 3900.5 3913.4 3915.6 3923.9 3924.8 5397.2 5432.6 5470.3 5472.5 5501.9 4694.7 4891.4 4929.6 4982.8 5091.8 5754.2 5815.7 5831.4 5831.9 5850.2 4197.6 4215.7 4226.8 4227.0 4228.1 5917.4 5998.0 6102.7 6111.6 6130.5 4303.4 4305.3 4305.9 4310.0 4323.2 4312.8 4349.2 4360.2 4392.6 4392.9 4839.8 4935.6 4961.0 4985.2 4999.9 5866.9 5873.8 5874.5 5889.8 5904.1 1462.8 1472.3 1477.9 1478.7 1478.7 974.4 1009.9 1015.9 1022.8 1038.9 5550.3 5554.6 5559.8 5594.2 5607.7 5854.9 5878.5 5938.9 5962.6 5974.7 5390.8 5514.2 5520.3 5548.5 5561.9 3053.9 3084.9 3087.3 3089.4 3122.8 5885.3 6062.5 6086.0 6120.5 6123.0 5899.7 5958.6 5968.4 5976.6 6004.3 6059.1 6088.2 6099.4 6126.8 6186.1 5586.0 5783.4 5813.6 5818.2 5828.2 5691.7 5753.3 5780.5 5797.9 5813.4 6037.8 6171.4 6172.4 6217.6 6269.5 4295.9 4316.3 4316.8 4319.3 4328.8 5847.5 6063.5 6073.5 6086.3 6091.7 5919.6 5923.2 5931.5 5937.6 5938.5 5821.4 5842.9 5849.9 5855.5 5858.7 5739.8 5906.0 5928.8 5939.9 5959.9 5939.9 5959.5 5976.0 5976.7 5978.3 5689.2 5791.6 5827.4 5836.4 5859.4 02:51:36 INFO - PROCESS | 9278 | 02:51:36 INFO - PROCESS | 9278 | [#5] yui.html Cycles:180 Average:18236.04 Median:4696.57 stddev:23929.04 (509.5%) stddev-sans-first:23960.01 02:51:36 INFO - PROCESS | 9278 | Values: 719.3 726.9 763.5 775.6 779.0 14395.4 16035.9 16227.8 16336.5 16420.4 14805.5 15693.7 16123.3 16193.7 16548.1 848.7 862.4 863.2 867.5 869.1 837.3 854.7 859.5 859.5 862.8 909.4 909.7 912.5 914.3 919.4 896.9 900.1 902.3 908.2 910.0 667.4 672.4 672.5 672.6 673.0 15601.3 15935.3 15943.4 15978.8 16170.1 14398.6 14784.6 14914.4 14927.8 14963.8 11829.3 11883.4 11896.7 12014.2 12051.6 3784.5 3786.6 3832.2 3837.9 3854.3 68337.7 69170.0 69298.3 70123.6 70535.6 10952.5 11241.0 11454.3 11596.5 11642.8 21662.7 21663.1 21984.3 22126.9 22317.7 8433.6 8443.9 8581.2 8703.0 8835.7 4675.1 4675.6 4839.3 4991.4 4992.0 3659.5 3721.6 3746.6 3747.3 3755.1 627.3 634.1 640.4 641.1 657.0 671.6 689.7 691.6 778.3 799.5 9336.9 9962.4 10117.2 10201.9 10383.2 602.6 664.8 760.3 779.5 784.8 4717.5 4774.9 4833.2 4865.4 4867.8 87907.0 95317.5 95509.5 97846.5 98232.5 65780.7 67141.3 84706.6 85228.6 85830.1 51788.7 53989.5 55634.7 63356.7 72370.3 9843.8 9864.6 9977.3 10324.9 10391.0 38481.4 42791.1 44591.0 45784.0 49382.0 50744.7 56202.0 63579.8 65102.7 66147.0 13227.7 13389.5 13392.7 13714.2 13795.0 14406.9 14496.9 14500.0 14745.0 14867.8 13060.2 13254.9 13268.2 13281.0 13509.0 12359.3 13341.0 13573.7 13672.2 13791.2 12373.4 12512.9 12698.6 12839.6 13262.1 11092.8 11249.8 11332.5 11566.2 11798.3 10031.1 10800.1 10984.4 11014.1 11087.2 02:51:36 INFO - PROCESS | 9278 | -------- Summary: end -------- 02:51:36 INFO - PROCESS | 9278 | 02:51:37 INFO - TEST-INFO | 9278: exit 0 02:51:37 INFO - TEST-OK | dromaeo_css | took 1113705ms 02:51:37 INFO - TEST-START | kraken 02:51:37 INFO - operating with platform_type : linux_ 02:51:37 INFO - Initialising browser for kraken test... 02:51:37 INFO - TEST-INFO | started process 9654 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpicLFIE/profile http://localhost:37252/getInfo.html) 02:51:42 INFO - PROCESS | 9654 | __metrics Screen width/height:1600/1200 02:51:42 INFO - PROCESS | 9654 | colorDepth:24 02:51:42 INFO - PROCESS | 9654 | Browser inner width/height: 1024/697 02:51:42 INFO - PROCESS | 9654 | __metrics 02:51:42 ERROR - PROCESS | 9654 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3175: TypeError: this.tabs is undefined 02:51:43 INFO - TEST-INFO | 9654: exit 0 02:51:43 INFO - Browser initialized. 02:51:43 INFO - Running cycle 1/1 for kraken test... 02:51:43 INFO - TEST-INFO | started process 9785 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpicLFIE/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 02:51:55 INFO - PROCESS | 9785 | RSS: Main: 151621632 02:51:55 INFO - PROCESS | 9785 | 02:51:58 INFO - PROCESS | 9785 | Cycle 1(1): loaded http://localhost:37252/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:37252/tests/kraken/driver.html?testName=audio-beat-detection) 02:51:58 INFO - PROCESS | 9785 | RSS: Main: 156815360 02:51:58 INFO - PROCESS | 9785 | 02:52:01 INFO - PROCESS | 9785 | Cycle 1(1): loaded http://localhost:37252/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:37252/tests/kraken/driver.html?testName=audio-dft) 02:52:02 INFO - PROCESS | 9785 | RSS: Main: 155435008 02:52:02 INFO - PROCESS | 9785 | 02:52:04 INFO - PROCESS | 9785 | Cycle 1(1): loaded http://localhost:37252/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:37252/tests/kraken/driver.html?testName=audio-fft) 02:52:05 INFO - PROCESS | 9785 | RSS: Main: 155897856 02:52:05 INFO - PROCESS | 9785 | 02:52:07 INFO - PROCESS | 9785 | Cycle 1(1): loaded http://localhost:37252/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:37252/tests/kraken/driver.html?testName=audio-oscillator) 02:52:08 INFO - PROCESS | 9785 | RSS: Main: 155828224 02:52:08 INFO - PROCESS | 9785 | 02:52:10 INFO - PROCESS | 9785 | Cycle 1(1): loaded http://localhost:37252/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:37252/tests/kraken/driver.html?testName=imaging-gaussian-blur) 02:52:10 INFO - PROCESS | 9785 | RSS: Main: 155754496 02:52:10 INFO - PROCESS | 9785 | 02:52:13 INFO - PROCESS | 9785 | Cycle 1(1): loaded http://localhost:37252/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:37252/tests/kraken/driver.html?testName=imaging-darkroom) 02:52:14 INFO - PROCESS | 9785 | RSS: Main: 158306304 02:52:14 INFO - PROCESS | 9785 | 02:52:17 INFO - PROCESS | 9785 | Cycle 1(1): loaded http://localhost:37252/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:37252/tests/kraken/driver.html?testName=imaging-desaturate) 02:52:18 INFO - PROCESS | 9785 | RSS: Main: 158339072 02:52:18 INFO - PROCESS | 9785 | 02:52:21 INFO - PROCESS | 9785 | Cycle 1(1): loaded http://localhost:37252/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:37252/tests/kraken/driver.html?testName=json-parse-financial) 02:52:22 INFO - PROCESS | 9785 | RSS: Main: 158179328 02:52:22 INFO - PROCESS | 9785 | 02:52:23 INFO - PROCESS | 9785 | Cycle 1(1): loaded http://localhost:37252/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:37252/tests/kraken/driver.html?testName=json-stringify-tinderbox) 02:52:24 INFO - PROCESS | 9785 | RSS: Main: 157138944 02:52:24 INFO - PROCESS | 9785 | 02:52:25 INFO - PROCESS | 9785 | Cycle 1(1): loaded http://localhost:37252/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:37252/tests/kraken/driver.html?testName=stanford-crypto-aes) 02:52:26 INFO - PROCESS | 9785 | RSS: Main: 157282304 02:52:26 INFO - PROCESS | 9785 | 02:52:28 INFO - PROCESS | 9785 | Cycle 1(1): loaded http://localhost:37252/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:37252/tests/kraken/driver.html?testName=stanford-crypto-ccm) 02:52:29 INFO - PROCESS | 9785 | RSS: Main: 157429760 02:52:29 INFO - PROCESS | 9785 | 02:52:31 INFO - PROCESS | 9785 | Cycle 1(1): loaded http://localhost:37252/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:37252/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 02:52:32 INFO - PROCESS | 9785 | RSS: Main: 157384704 02:52:32 INFO - PROCESS | 9785 | 02:52:35 INFO - PROCESS | 9785 | Cycle 1(1): loaded http://localhost:37252/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:37252/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 02:52:35 INFO - PROCESS | 9785 | RSS: Main: 157728768 02:52:35 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | Cycle 1(1): loaded http://localhost:37252/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:37252/tests/kraken/driver.html?testName=ai-astar) 02:52:37 INFO - PROCESS | 9785 | RSS: Main: 159010816 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | __start_tp_report 02:52:37 INFO - PROCESS | 9785 | _x_x_mozilla_page_load 02:52:37 INFO - PROCESS | 9785 | _x_x_mozilla_page_load_details 02:52:37 INFO - PROCESS | 9785 | |i|pagename|runs| 02:52:37 INFO - PROCESS | 9785 | |0;ai-astar;103;113;110;111;113;112;110;112;110;114 02:52:37 INFO - PROCESS | 9785 | |1;audio-beat-detection;145;120;119;162;123;122;118;121;157;120 02:52:37 INFO - PROCESS | 9785 | |2;audio-dft;162;163;164;163;162;161;162;161;162;164 02:52:37 INFO - PROCESS | 9785 | |3;audio-fft;75;75;77;105;75;76;77;76;99;76 02:52:37 INFO - PROCESS | 9785 | |4;audio-oscillator;82;81;114;82;80;81;104;81;80;105 02:52:37 INFO - PROCESS | 9785 | |5;imaging-gaussian-blur;117;118;120;118;118;118;118;118;120;117 02:52:37 INFO - PROCESS | 9785 | |6;imaging-darkroom;147;149;148;148;149;146;149;147;150;147 02:52:37 INFO - PROCESS | 9785 | |7;imaging-desaturate;89;87;85;90;90;86;85;89;85;88 02:52:37 INFO - PROCESS | 9785 | |8;json-parse-financial;52;52;56;52;56;53;54;56;52;54 02:52:37 INFO - PROCESS | 9785 | |9;json-stringify-tinderbox;60;59;59;59;60;62;59;60;58;59 02:52:37 INFO - PROCESS | 9785 | |10;stanford-crypto-aes;75;75;75;77;75;76;82;76;84;74 02:52:37 INFO - PROCESS | 9785 | |11;stanford-crypto-ccm;126;131;122;122;125;131;132;131;166;121 02:52:37 INFO - PROCESS | 9785 | |12;stanford-crypto-pbkdf2;156;155;163;160;156;152;152;153;151;156 02:52:37 INFO - PROCESS | 9785 | |13;stanford-crypto-sha256-iterative;65;63;63;64;63;62;62;63;61;69 02:52:37 INFO - PROCESS | 9785 | __end_tp_report 02:52:37 INFO - PROCESS | 9785 | __start_cc_report 02:52:37 INFO - PROCESS | 9785 | _x_x_mozilla_cycle_collect,804 02:52:37 INFO - PROCESS | 9785 | __end_cc_report 02:52:37 INFO - PROCESS | 9785 | __startTimestamp1482576757653__endTimestamp 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | ------- Summary: start ------- 02:52:37 INFO - PROCESS | 9785 | Number of tests: 14 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | [#0] ai-astar Cycles:10 Average:110.80 Median:112.00 stddev:3.08 (2.8%) stddev-sans-first:1.50 02:52:37 INFO - PROCESS | 9785 | Values: 103.0 113.0 110.0 111.0 113.0 112.0 110.0 112.0 110.0 114.0 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | [#1] audio-beat-detection Cycles:10 Average:130.70 Median:122.50 stddev:17.10 (14.0%) stddev-sans-first:17.34 02:52:37 INFO - PROCESS | 9785 | Values: 145.0 120.0 119.0 162.0 123.0 122.0 118.0 121.0 157.0 120.0 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | [#2] audio-dft Cycles:10 Average:162.40 Median:162.50 stddev:1.07 (0.7%) stddev-sans-first:1.13 02:52:37 INFO - PROCESS | 9785 | Values: 162.0 163.0 164.0 163.0 162.0 161.0 162.0 161.0 162.0 164.0 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | [#3] audio-fft Cycles:10 Average:81.10 Median:76.00 stddev:11.13 (14.6%) stddev-sans-first:11.58 02:52:37 INFO - PROCESS | 9785 | Values: 75.0 75.0 77.0 105.0 75.0 76.0 77.0 76.0 99.0 76.0 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | [#4] audio-oscillator Cycles:10 Average:89.00 Median:81.00 stddev:13.16 (16.2%) stddev-sans-first:13.71 02:52:37 INFO - PROCESS | 9785 | Values: 82.0 81.0 114.0 82.0 80.0 81.0 104.0 81.0 80.0 105.0 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | [#5] imaging-gaussian-blur Cycles:10 Average:118.20 Median:118.00 stddev:1.03 (0.9%) stddev-sans-first:1.00 02:52:37 INFO - PROCESS | 9785 | Values: 117.0 118.0 120.0 118.0 118.0 118.0 118.0 118.0 120.0 117.0 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | [#6] imaging-darkroom Cycles:10 Average:148.00 Median:148.50 stddev:1.25 (0.8%) stddev-sans-first:1.27 02:52:37 INFO - PROCESS | 9785 | Values: 147.0 149.0 148.0 148.0 149.0 146.0 149.0 147.0 150.0 147.0 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | [#7] imaging-desaturate Cycles:10 Average:87.40 Median:88.50 stddev:2.07 (2.3%) stddev-sans-first:2.11 02:52:37 INFO - PROCESS | 9785 | Values: 89.0 87.0 85.0 90.0 90.0 86.0 85.0 89.0 85.0 88.0 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | [#8] json-parse-financial Cycles:10 Average:53.70 Median:54.00 stddev:1.77 (3.3%) stddev-sans-first:1.76 02:52:37 INFO - PROCESS | 9785 | Values: 52.0 52.0 56.0 52.0 56.0 53.0 54.0 56.0 52.0 54.0 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | [#9] json-stringify-tinderbox Cycles:10 Average:59.50 Median:59.50 stddev:1.08 (1.8%) stddev-sans-first:1.13 02:52:37 INFO - PROCESS | 9785 | Values: 60.0 59.0 59.0 59.0 60.0 62.0 59.0 60.0 58.0 59.0 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | [#10] stanford-crypto-aes Cycles:10 Average:76.90 Median:76.00 stddev:3.35 (4.4%) stddev-sans-first:3.48 02:52:37 INFO - PROCESS | 9785 | Values: 75.0 75.0 75.0 77.0 75.0 76.0 82.0 76.0 84.0 74.0 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | [#11] stanford-crypto-ccm Cycles:10 Average:130.70 Median:131.00 stddev:13.12 (10.0%) stddev-sans-first:13.80 02:52:37 INFO - PROCESS | 9785 | Values: 126.0 131.0 122.0 122.0 125.0 131.0 132.0 131.0 166.0 121.0 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:155.40 Median:156.00 stddev:3.78 (2.4%) stddev-sans-first:4.00 02:52:37 INFO - PROCESS | 9785 | Values: 156.0 155.0 163.0 160.0 156.0 152.0 152.0 153.0 151.0 156.0 02:52:37 INFO - PROCESS | 9785 | 02:52:37 INFO - PROCESS | 9785 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:63.50 Median:63.00 stddev:2.22 (3.5%) stddev-sans-first:2.29 02:52:37 INFO - PROCESS | 9785 | Values: 65.0 63.0 63.0 64.0 63.0 62.0 62.0 63.0 61.0 69.0 02:52:37 INFO - PROCESS | 9785 | -------- Summary: end -------- 02:52:37 INFO - PROCESS | 9785 | 02:52:38 INFO - TEST-INFO | 9785: exit 0 02:52:38 INFO - TEST-OK | kraken | took 61256ms 02:52:38 INFO - SUITE-END | took 1174s 02:52:38 INFO - Completed test suite (00:19:35) 02:52:38 INFO - javascript benchmark 02:52:38 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7491.20100649484, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3234.935301293973, 3278.7377009839215, 3330.966690333096, 3345.6152542457626, 3351.748618853587, 5702.315722113347, 5751.827445176641, 5767.855803604912, 5770.163326317686, 5774.566907481934, 5791.276090488689, 5844.006518891788, 5871.383504732005, 5876.4123587641325, 5888.0, 5295.338082739658, 5297.523222909927, 5328.600354973373, 5343.332083489564, 5346.117890548075, 5329.520343169133, 5372.54333381661, 5375.919361209585, 5378.865528361783, 5401.108817045183, 5172.120739474299, 5181.0, 5367.597430192732, 5390.164524498709, 5393.78424863005, 5239.895202095956, 5279.680079980024, 5343.599230057723, 5391.24522566837, 5409.377921539034, 5243.9213411798855, 5313.149896016657, 5319.069162896478, 5325.547328477084, 5327.946720532784, 5563.0, 5802.303723553158, 5855.355910849803, 5900.822975310747, 5910.893259210565, 6024.367441418632, 6066.302375226861, 6076.574639775217, 6107.816765497042, 6137.60105593135, 6090.939090609126, 6105.053716673922, 6120.265568131853, 6206.906896396557, 6215.9378406216265, 5740.885182296414, 5741.540676745851, 5742.368339482696, 5757.88484230313, 5769.249997500298, 6215.378462153749, 6231.034189700604, 6254.249490061131, 6270.0, 6353.555251132377, 6013.729382177812, 6063.181470501514, 6067.876243314893, 6068.6358818471035, 6071.119687645267, 5986.0, 6025.18659980897, 6145.555794388315, 6159.907601385983, 6173.32093469718, 6112.290716697417, 6132.78535251264, 6133.233345831771, 6210.4100110489435, 6230.844228894223, 6190.350013248634, 6199.535034872402, 6220.906686399708, 6233.2208473940755, 6246.375362463808, 4677.204875171229, 4824.011077729057, 4827.8551643450755, 4836.032793441326, 4839.806407743651, 4161.729487583298, 4213.936790948138, 4224.66202703783, 4299.204647140289, 4312.310030395121, 5933.465988061095, 5970.432808883149, 5971.970140149271, 5972.761089556456, 5977.760889564455, 6252.843678908063, 6263.123162757218, 6281.371862813682, 6283.96858015707, 6288.654124023131, 5811.389804070512, 5864.677442740605, 5911.7635294587735, 5912.3496415394275, 5932.703364831741, 5342.198670199501, 5345.33183352081, 5349.86625334362, 5351.625386222927, 5362.383325917492, 5900.557458190567, 6477.060826180177, 6487.2539657939, 6507.349265073455, 6510.348965103546, 6014.0678194879865, 6038.064100064497, 6127.372786728296, 6185.443310102112, 6282.183316168869, 6520.0, 6531.444827189552, 6548.0832683423405, 6555.4427873631275, 6564.048213009182, 6136.631802091889, 6154.292256390572, 6167.198264225622, 6179.3202747698615, 6180.443760061616, 6031.698415079316, 6128.136482154469, 6130.673316708229, 6304.6847657617855, 6331.588446750947, 5982.341942386247, 6091.695415229132, 6104.755809767559, 6110.77140286259, 6139.140520327247, 5978.641281523122, 5990.7004649768205, 5997.250343707036, 6008.969955150196, 6009.278886533644, 5906.468417842415, 5946.821595352147, 6004.849878753066, 6073.605215660968, 6089.056196289582, 6002.189704389852, 6048.90926636092, 6080.179175811386, 6090.056041313604, 6135.07973803933, 5855.238818953509, 5920.319163296103, 5921.437463440966, 5927.2590926134235, 5955.940440595538], "value": 5717.960570065085, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [600.2886579403407, 625.440230993261, 657.5528640524444, 660.92729799722, 683.5488577538825, 43849.34225986609, 44895.326570101475, 45059.0, 45147.0, 45211.54788452115, 45753.542464575345, 45764.31353529691, 45939.540604593945, 46392.768036159854, 46440.53559464413, 9042.0, 9080.727578172633, 9087.273018158565, 9094.727158185266, 9148.222401095882, 8894.332925030616, 9013.819723605557, 9065.22945549629, 9101.408408453462, 9137.817243655123, 9077.954610226972, 9087.091290870892, 9096.27229821616, 9126.498042607654, 9155.313351498631, 9067.954660226722, 9112.316576256773, 9123.270138388913, 9131.634734610607, 9161.083891610819, 8947.239484643747, 8967.910320896837, 9014.053524379977, 9033.277337812959, 9043.547822608909, 44471.777641111585, 44926.55073449289, 44977.10045799066, 45063.32405013927, 45067.323990140176, 3576.946345804815, 3663.725220608465, 3831.348670725983, 4106.260873042851, 4413.977930110361, 32492.837535812407, 32841.34317313664, 32942.34115317704, 32969.17577060569, 33212.667873321196, 3926.371780515104, 3943.4479172915817, 3976.5824588418377, 3990.0, 4031.9596804031876, 352148.0, 354002.0, 354473.0, 357945.0, 358080.0, 62982.055269170996, 63095.36904630895, 63294.0, 63378.68310658417, 63394.0, 60551.394486054574, 60742.0, 60744.39255607476, 60915.39084609186, 60994.0, 18348.63302733938, 18693.439196824118, 18715.157817898227, 18715.251389944522, 18730.438086857415, 14308.0, 14362.989181514597, 14470.131792092508, 14473.203973781543, 14489.492867749788, 17747.378841740734, 18064.548386290448, 18172.63654726898, 18237.45287641373, 18519.0, 6163.0, 6166.9383306167265, 6244.500439964792, 6324.841878952971, 6417.935820641827, 958.3770549143113, 1009.4246279620546, 1036.528379587286, 1132.445101900063, 1142.2689478733616, 33228.66771332304, 33705.32589348199, 33748.49377259343, 33946.49080263798, 33970.660293397246, 1133.489929531714, 1162.0587324267372, 1183.9822402663967, 1188.2157775867886, 1189.102227817992, 17058.914705426392, 17114.914425427793, 17712.202950867242, 17837.732434013502, 18002.54993625144, 171321.0, 171952.0, 172068.1396593009, 172159.13920430318, 172628.0, 64270.678646606466, 64377.356226438074, 64431.67784161049, 65052.34947650557, 65151.0, 1421.2112277685776, 1422.4879043544315, 1454.978175327371, 1456.293697556663, 1464.399596165567, 32707.509387358732, 33838.3232335347, 34071.0, 34154.975350739514, 34760.652393476754, 56601.0, 57261.71369143128, 57487.71256143692, 57646.0, 57740.4225957735, 505477.0, 506991.0, 508635.0, 509593.0, 510188.0, 30900.845495772377, 31140.53289200709, 49370.259446107615, 49446.258306126154, 51446.22830657468, 51654.48345516647, 52370.476295236556, 52622.47377526176, 53936.460635393145, 53945.730271348395, 42380.0, 42621.36067959045, 42738.145237095705, 43360.13279734325, 44222.77888610536, 45096.0, 45959.77020114878, 46287.76856115833, 47453.28820067771, 49874.25188622246, 44679.329810053525, 45316.54683453123, 45608.315875261236, 46205.30692039689, 46210.30684539668, 37375.813120934225, 39641.0, 40431.1913761729, 40713.38929916113, 40938.59061409467, 26802.329941751614, 27121.86439067792, 27266.454670906867, 27381.452370952073, 27494.0], "value": 20618.43312752759, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [427.5480121503177, 433.7874441523653, 438.1193800461072, 443.87952692571236, 446.5266817173795, 18915.432537023913, 19300.613987720255, 20042.0, 20507.794922050776, 20539.897300513476, 20129.69805452916, 20664.8966755166, 20742.377728668125, 20764.0, 20969.0, 5624.325080990287, 5910.34986151523, 5913.2608423947, 5913.970430147865, 5914.2015827863115, 5631.690257035882, 5723.055695810186, 5798.2172406725185, 5861.0, 5904.0553511438175, 5978.192943952576, 5985.221921150244, 5987.9401205987815, 5994.220751302325, 6003.0395136778125, 5954.672493012882, 6133.233345831771, 6389.936100639027, 6443.96778016107, 6503.544751867371, 5669.9433005669825, 5814.912776308359, 5837.036888913324, 5856.648601083949, 5879.706014699248, 15078.246087695572, 15302.387904483807, 15343.309551070228, 15364.923175384163, 22478.213262535734, 2236.944076398087, 2313.086330899302, 2315.235972129193, 2413.5172965406987, 2529.3929456930387, 10566.260361774679, 10723.195760318007, 10734.409607471585, 10933.56265749377, 11397.544098236143, 1898.2596787252983, 1926.749522562058, 1962.3622322745023, 1971.3297478857114, 1992.9701054484194, 89897.0, 89937.10062899353, 93389.5330523343, 94283.52858235665, 95297.9999999993, 11556.59551915679, 11595.536178552931, 11723.4138293085, 11809.173357865038, 12100.939495302468, 16991.32034718622, 17033.31866725317, 17072.573185670208, 17077.316907323817, 17092.145392730316, 8605.612747426381, 8764.430312029697, 8769.905148715992, 8813.691520796741, 9038.638454461749, 8388.622511986976, 8478.364122690822, 8500.44747091437, 8645.049044605088, 8657.437266577652, 5089.567386772092, 5097.388313402341, 5108.693478391308, 5109.412417571953, 5114.43741188469, 2035.460602940222, 2068.400163952467, 2128.584925939458, 2131.9253826116324, 2137.5297434564372, 911.9589618467185, 1023.4984857419811, 1035.596117514155, 1060.3266925502362, 1112.1547623805966, 20094.497637558885, 20570.28004019882, 20821.271255505984, 20856.687149692767, 21049.158033678483, 991.5785791038779, 1003.227514813604, 1020.5917632946732, 1039.2309690828884, 1089.5315014543821, 9576.23390128788, 10922.508487118099, 11396.94721073388, 11437.885621143849, 11481.253718508437, 546482.0, 556582.0, 558181.0, 560568.0, 562986.0, 53573.73213133909, 93632.53183734174, 95136.52431737797, 96849.0, 96945.0, 1068.4817863336275, 1073.8765042020111, 1103.1560855945047, 1109.389835590422, 1109.755853712182, 18635.534111647317, 18955.431337059912, 19186.642337590587, 19245.03774811282, 19259.0, 44589.55410445854, 45171.096578068915, 45753.08493830171, 46025.76987115043, 46392.76803615961, 61394.0, 61592.69203653953, 62667.686661566404, 62841.68579157075, 62940.0, 8650.221480066573, 8670.869936950825, 8832.470051796656, 8868.600912959062, 9107.0, 10827.945860270649, 12901.225926444444, 12961.740765184832, 12970.80543791825, 13054.216746995211, 5854.531637468907, 8767.693130740394, 11560.248583842023, 11765.294082355085, 11850.348230847387, 11231.606893758679, 11272.943635281772, 11501.53993840237, 11529.827052594386, 11686.590969316034, 11527.884721153017, 11948.641540753792, 11990.520379184734, 12026.579069732867, 12063.758724825278, 8719.694810681596, 8789.428687135316, 8931.062238464867, 9024.413413128126, 9107.635694572144, 9018.549072546477, 10962.465254864166, 11269.492872820907, 11371.829422558503, 11669.76660466803], "value": 9516.2352581583, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1489.419126540649, 1516.4995551468016, 1686.266474083773, 1793.9641207175848, 1830.2404502131617, 7951.76144715658, 8103.068147163078, 8702.869456958151, 9316.068393160689, 9325.766855828608, 8682.0, 8976.057513961037, 8983.95508022459, 9122.908770912289, 9208.447493150416, 2469.728329883716, 2486.465409936863, 2497.912573059943, 2503.3491292264052, 2518.3074654469983, 2482.354587807174, 2538.959026799013, 2547.5159719653207, 2552.247087109298, 2563.4232297732956, 2460.495598402323, 2472.987635061822, 2477.801775857927, 2478.0459523083564, 2491.476789874129, 2442.9755702443013, 2455.5579995600783, 2460.938476538092, 2467.037855236459, 2486.154707399484, 2426.2236084452984, 2461.9753802461923, 2477.913273035435, 2492.6136448850457, 2493.613489909067, 9113.225375843062, 9178.816423671557, 9192.632294708204, 9198.448093114435, 9208.861867071999, 5606.803761868315, 5774.653520788766, 5782.826515204551, 5786.305643322786, 5789.247397838254, 3516.261585067139, 3524.9118772030647, 3656.2687462507606, 3702.2965636528975, 3704.518412606371, 1184.7689700508404, 1194.1939191046097, 1226.4174517104393, 1230.655416483386, 1233.734747029393, 12655.557055503014, 12712.046596505206, 12751.87248127516, 12761.0, 12825.87174128256, 4826.107170173529, 5051.974740126349, 5108.7190204538365, 5161.974190129025, 5172.612054095958, 10757.193210509087, 10798.622048228275, 10817.405042722727, 10822.350658960488, 10831.566737330419, 5788.855278618068, 5838.4453476919625, 5841.912371314434, 5842.357340692521, 5858.150568167592, 4497.347884556786, 4952.182889823211, 5213.947860521346, 5218.086834803894, 5274.97362513185, 4213.852515161954, 4278.657707383401, 4315.417418648442, 4356.4336636237085, 4372.584604462571, 1416.7024924765708, 1429.2139323372103, 1438.9568312950628, 1439.632893612143, 1448.5654303708845, 792.528445574882, 879.5821984557411, 884.1997991817416, 893.3478560650632, 904.7647611620895, 5963.821085367359, 6033.577649564576, 6086.573939824169, 6095.05526643371, 6095.6952152392205, 471.6062088156359, 475.82156691240783, 476.5044353872004, 478.0820824017894, 492.1338444337991, 4066.674666026711, 4143.958560414418, 4179.9582004179565, 4187.330027195634, 4204.87385378433, 10340.534675939602, 10934.125269978382, 10943.398113103856, 10952.835707464394, 10957.561697532168, 10682.572697092184, 10731.785364292671, 10789.730256743487, 10797.622083227207, 10824.079953204066, 8326.333893288522, 8413.242808147295, 8413.747587572383, 8420.410571259952, 8425.705100321582, 6208.2239720034995, 6327.114204011534, 6342.302346741947, 6349.269833969152, 6370.0, 10555.102816260396, 10583.047525722723, 10673.8932610676, 10734.677959661223, 10735.838962415413, 10368.118709909742, 10559.102476289294, 10566.841497377392, 10630.574777008833, 10747.570097196025, 7656.540607563564, 7821.139674635671, 7832.138464768757, 7917.722879699183, 7940.0471943364855, 8603.139686031347, 8617.224449799549, 8638.13618638131, 8700.956495217484, 8700.999385070798, 7896.605169741375, 7915.1293357729455, 7966.243206895336, 7982.920170798217, 8028.638711258124, 7422.851542969002, 7470.402367810453, 7487.588182650006, 7488.475806693479, 7490.925090749023, 6983.441324694114, 7000.369966703021, 7001.8249543759775, 7077.433805295667, 7079.1505019398, 5313.2561441397465, 5371.355437347387, 5427.0, 5476.479734425223, 5479.972600136974, 5181.55956743666, 5292.52367286946, 5305.787768489372, 5363.490468405495, 5373.247745315581], "value": 4742.457365514505, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [354.1270767557969, 358.290584642408, 361.2594181927049, 361.8588750387349, 365.8006386519345, 5592.420850655579, 5626.352969408519, 5641.407652196512, 5651.350094739107, 5661.830145095649, 5471.398146203915, 5546.667199968005, 5572.9968605650965, 5583.469570390816, 5609.242752228448, 4312.460942382202, 4378.540253273408, 4403.163398954204, 4413.713108647944, 4425.8450954216605, 4386.780660966955, 4406.950767892929, 4412.360207769888, 4420.182266280748, 4421.403110580062, 4371.322445021011, 4407.669424793137, 4409.118176364724, 4410.140022695576, 4410.713303635253, 4251.298535741599, 4353.0, 4373.934390984138, 4378.759717808831, 4379.386885835986, 3900.531936167678, 3913.3934240192816, 3915.6280153385383, 3923.8816937173056, 3924.7645141291614, 5397.163439666858, 5432.592555558349, 5470.261514695505, 5472.50747432733, 5501.9174712379345, 4694.718316900997, 4891.364122664031, 4929.556339929388, 4982.77921909131, 5091.847244582668, 5754.165645981309, 5815.680137592431, 5831.358550559435, 5831.854203644901, 5850.151727999459, 4197.559256278108, 4215.725977811463, 4226.78866056699, 4227.0, 4228.069824638575, 5917.408259174048, 5997.970010149921, 6102.69486525672, 6111.57218994675, 6130.509559235251, 4303.4190384298345, 4305.268104422255, 4305.901994991257, 4310.0, 4323.200207961537, 4312.805923733439, 4349.15161056556, 4360.193364227564, 4392.560743925582, 4392.934105988413, 4839.838438774669, 4935.580475659537, 4961.0, 4985.177445721488, 4999.925001124986, 5866.943950088939, 5873.823785286449, 5874.500667443315, 5889.792592518524, 5904.132793020578, 1462.824461064679, 1472.2565104622097, 1477.8915813140145, 1478.6672998575234, 1478.6839712655744, 974.3958745577787, 1009.8838633557089, 1015.9034891685278, 1022.8107800057013, 1038.937663740178, 5550.306211723535, 5554.611177217636, 5559.805406810742, 5594.216809646653, 5607.7476513556985, 5854.912176317359, 5878.5297176225795, 5938.851528711817, 5962.568983444029, 5974.671393073336, 5390.784368625211, 5514.228008078872, 5520.267467603562, 5548.500634942794, 5561.888762224733, 3053.908382748521, 3084.892028778982, 3087.320789426323, 3089.382123575249, 3122.8126312421327, 5885.293764748258, 6062.484688801413, 6085.9695701521205, 6120.479759220427, 6122.969385153046, 5899.734511946973, 5958.6424814511265, 5968.432998865101, 5976.593341795222, 6004.309504407049, 6059.122161816441, 6088.208532890696, 6099.370874329678, 6126.78556250538, 6186.051393810935, 5586.026495654259, 5783.363829978614, 5813.593048486566, 5818.2436283282905, 5828.184054232326, 5691.658500489983, 5753.280839895013, 5780.508656764054, 5797.8550536236935, 5813.360530341574, 6037.818865434044, 6171.382861713792, 6172.444479996642, 6217.626942383471, 6269.529785266214, 4295.871123866289, 4316.266234740165, 4316.827326907014, 4319.308910574293, 4328.8268469260875, 5847.532197424281, 6063.545234107548, 6073.453389194994, 6086.330503644507, 6091.695415229309, 5919.556033297434, 5923.229980102559, 5931.495822855106, 5937.643741375531, 5938.524918006636, 5821.370016395416, 5842.909963025814, 5849.859277440858, 5855.473007429352, 5858.7070646466655, 5739.770409183586, 5905.962442957173, 5928.762849486145, 5939.881202375842, 5959.851003724768, 5939.881202376015, 5959.510122469383, 5975.954208013667, 5976.671283079472, 5978.282606087298, 5689.175069614966, 5791.594588378773, 5827.388124246893, 5836.445537673914, 5859.384764599826], "value": 4465.950946623226, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [719.2843121094512, 726.9164046134696, 763.5304287862966, 775.60056570866, 779.0184367696704, 14395.42418303268, 16035.919820400897, 16227.83772162278, 16336.509904702849, 16420.42528511501, 14805.481808136718, 15693.686126277467, 16123.27445264963, 16193.676126477463, 16548.089855057966, 848.7241646464893, 862.361852229352, 863.218786997768, 867.5445391169624, 869.1048220333067, 837.3050368194384, 854.6965827131372, 859.4628357276702, 859.5143743784773, 862.7713655881197, 909.3634455880876, 909.6952520905504, 912.4753266871543, 914.3325372478095, 919.4345477531336, 896.8520194167954, 900.0594378874059, 902.2871931174332, 908.2143945487172, 910.0444533240071, 667.3993405934649, 672.3545396419444, 672.4754691340762, 672.5897202706345, 673.0241150331989, 15601.297941592655, 15935.282912268976, 15943.362265509482, 15978.840211597852, 16170.11064391458, 14398.640033999234, 14784.556463306119, 14914.403423863032, 14927.776083358758, 14963.775543366859, 11829.290242585472, 11883.40582970848, 11896.66893269877, 12014.159008869383, 12051.638450846489, 3784.5080139581955, 3786.583475817658, 3832.2143960488033, 3837.9232415351535, 3854.3062248795204, 68337.65831170863, 69170.0, 69298.30701692968, 70123.64938175328, 70535.64732176306, 10952.507137178845, 11240.98831105188, 11454.312741235386, 11596.478158482889, 11642.825357619642, 21662.675059874113, 21663.133474661154, 21984.340469785933, 22126.88936555307, 22317.665235021486, 8433.578321083922, 8443.915560844436, 8581.184787445183, 8702.956485217534, 8835.674648802602, 4675.08835777027, 4675.602573781199, 4839.322494850724, 4991.401031876198, 4991.9500804991485, 3659.524261845943, 3721.5906250312446, 3746.5691445484117, 3747.3442147624055, 3755.061234691327, 627.2786295759913, 634.1280738983897, 640.4044238857907, 641.0544446940725, 656.9704363303663, 671.5534169777142, 689.675852349395, 691.5643144818832, 778.260652380241, 799.5282783157965, 9336.90663093374, 9962.402255864672, 10117.190624750003, 10201.94899025515, 10383.22125840565, 602.5992714844667, 664.8005598320484, 760.3195140349357, 779.473855147773, 784.8430313937235, 4717.5282471753235, 4774.856754297377, 4833.178359678863, 4865.367502224688, 4867.829625963145, 87907.0, 95317.52341238249, 95509.52245238869, 97846.51076744714, 98232.50883745536, 65780.6710966442, 67141.32858671449, 84706.57646711727, 85228.57385713156, 85830.14169858347, 51788.74105629448, 53989.460105398444, 55634.72182639061, 63356.683216583624, 72370.2762972374, 9843.753906152404, 9864.605415783288, 9977.251706121924, 10324.896751032393, 10391.012853778879, 38481.42277865778, 42791.14417711566, 44591.0, 45784.0, 49382.0, 50744.74627626838, 56202.0, 63579.774707885, 65102.674486627264, 66147.0, 13227.735445291233, 13389.531366402129, 13392.665183370103, 13714.24571648569, 13795.034347595572, 14406.855931440552, 14496.927515362355, 14500.0, 14745.0, 14867.776983345475, 13060.151090179108, 13254.867451325363, 13268.203907765565, 13281.0, 13509.0, 12359.25844449336, 13341.0, 13573.660658483617, 13672.179669219879, 13791.241481718602, 12373.376979809933, 12512.937435312766, 12698.619041428772, 12839.550615728405, 13262.137961032502, 11092.833607496055, 11249.831387419226, 11332.546698131982, 11566.248193867372, 11798.292102473879, 10031.123173069915, 10800.08199303068, 10984.395858227874, 11014.118870490502, 11087.22389432732], "value": 7436.820777066019, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1467.3000000000004, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 113.0, 110.0, 111.0, 113.0, 112.0, 110.0, 112.0, 110.0, 114.0], "value": 110.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 120.0, 119.0, 162.0, 123.0, 122.0, 118.0, 121.0, 157.0, 120.0], "value": 130.7, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 163.0, 164.0, 163.0, 162.0, 161.0, 162.0, 161.0, 162.0, 164.0], "value": 162.4, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 77.0, 105.0, 75.0, 76.0, 77.0, 76.0, 99.0, 76.0], "value": 81.1, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 81.0, 114.0, 82.0, 80.0, 81.0, 104.0, 81.0, 80.0, 105.0], "value": 89.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 118.0, 120.0, 118.0, 118.0, 118.0, 118.0, 118.0, 120.0, 117.0], "value": 118.2, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [147.0, 149.0, 148.0, 148.0, 149.0, 146.0, 149.0, 147.0, 150.0, 147.0], "value": 148.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [89.0, 87.0, 85.0, 90.0, 90.0, 86.0, 85.0, 89.0, 85.0, 88.0], "value": 87.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [52.0, 52.0, 56.0, 52.0, 56.0, 53.0, 54.0, 56.0, 52.0, 54.0], "value": 53.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 59.0, 59.0, 59.0, 60.0, 62.0, 59.0, 60.0, 58.0, 59.0], "value": 59.5, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 75.0, 75.0, 77.0, 75.0, 76.0, 82.0, 76.0, 84.0, 74.0], "value": 76.9, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [126.0, 131.0, 122.0, 122.0, 125.0, 131.0, 132.0, 131.0, 166.0, 121.0], "value": 130.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [156.0, 155.0, 163.0, 160.0, 156.0, 152.0, 152.0, 153.0, 151.0, 156.0], "value": 155.4, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 63.0, 63.0, 64.0, 63.0, 62.0, 62.0, 63.0, 61.0, 69.0], "value": 63.5, "unit": "score"}]}]} 02:52:38 INFO - Return code: 0 02:52:38 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 02:52:38 ERROR - # TBPL SUCCESS # 02:52:38 INFO - Running post-action listener: _resource_record_post_action 02:52:38 INFO - [mozharness: 2016-12-24 10:52:38.937742Z] Finished run-tests step (success) 02:52:38 INFO - Running post-run listener: _resource_record_post_run 02:52:39 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 4096; Write bytes: 365244416; Read time: 8; Write time: 282392 02:52:39 INFO - TinderboxPrint: CPU usage
13.3% 02:52:39 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 02:52:39 INFO - TinderboxPrint: I/O write bytes / time
365,244,416 / 282,392 02:52:39 INFO - TinderboxPrint: CPU idle
8,234.5 (86.7%) 02:52:39 INFO - TinderboxPrint: CPU user
1,207.8 (12.7%) 02:52:39 INFO - TinderboxPrint: Swap in / out
0 / 0 02:52:39 INFO - install - Wall time: 16s; CPU: 14.0%; Read bytes: 0; Write bytes: 108109824; Read time: 0; Write time: 115896 02:52:39 INFO - run-tests - Wall time: 1175s; CPU: 13.0%; Read bytes: 0; Write bytes: 245444608; Read time: 0; Write time: 160992 02:52:39 INFO - Running post-run listener: _upload_blobber_files 02:52:39 INFO - Blob upload gear active. 02:52:39 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 02:52:39 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 02:52:39 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', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 02:52:39 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 Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 02:52:39 INFO - (blobuploader) - INFO - Open directory for files ... 02:52:39 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 02:52:39 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:52:39 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:52:40 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 02:52:40 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:52:40 INFO - (blobuploader) - INFO - Done attempting. 02:52:40 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 02:52:40 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:52:40 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:52:41 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 02:52:41 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:52:41 INFO - (blobuploader) - INFO - Done attempting. 02:52:41 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 02:52:41 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 02:52:41 INFO - (blobuploader) - INFO - Uploading, attempt #1. 02:52:45 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 02:52:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 02:52:45 INFO - (blobuploader) - INFO - Done attempting. 02:52:45 INFO - (blobuploader) - INFO - Iteration through files over. 02:52:45 INFO - Return code: 0 02:52:45 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 02:52:45 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 02:52:45 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ebefd327628ee7f8325c39412a94b6d05d82a205993c50b4a173ac051fb6967f5660bddc230220241c62f6c684fc5a93c0c2661015198a0f4299962159cb955f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/1df4bd768020fef4aaf1675d555dd92dc83f8995544209c3f975c3e641a00115f3700597c600475ef451431a448f72ed9726a0fdf0457b2706d19e1f8933149b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d9a2200320bf41e40769b7522287ec3ff68ec69887d42736d3ea619aa11632e307517aeae0d61460b23210dbffd1733b94b06daf8126bf14c63d68b53e952829"} 02:52:45 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 02:52:45 INFO - Writing to file /builds/slave/test/properties/blobber_files 02:52:45 INFO - Contents: 02:52:45 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ebefd327628ee7f8325c39412a94b6d05d82a205993c50b4a173ac051fb6967f5660bddc230220241c62f6c684fc5a93c0c2661015198a0f4299962159cb955f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/1df4bd768020fef4aaf1675d555dd92dc83f8995544209c3f975c3e641a00115f3700597c600475ef451431a448f72ed9726a0fdf0457b2706d19e1f8933149b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d9a2200320bf41e40769b7522287ec3ff68ec69887d42736d3ea619aa11632e307517aeae0d61460b23210dbffd1733b94b06daf8126bf14c63d68b53e952829"} 02:52:45 INFO - Running post-run listener: copy_logs_to_upload_dir 02:52:45 INFO - Copying logs to upload dir... 02:52:45 INFO - mkdir: /builds/slave/test/build/upload/logs 02:52:45 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1235.486684 ========= master_lag: 0.18 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 35 secs) (at 2016-12-24 02:52:44.527982) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-12-24 02:52:44.532871) ========= 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=7de08804244eb36560b44971000001c3-1482554493.170783-613431067 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/Mozilla-Aurora/sha512/ebefd327628ee7f8325c39412a94b6d05d82a205993c50b4a173ac051fb6967f5660bddc230220241c62f6c684fc5a93c0c2661015198a0f4299962159cb955f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/1df4bd768020fef4aaf1675d555dd92dc83f8995544209c3f975c3e641a00115f3700597c600475ef451431a448f72ed9726a0fdf0457b2706d19e1f8933149b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d9a2200320bf41e40769b7522287ec3ff68ec69887d42736d3ea619aa11632e307517aeae0d61460b23210dbffd1733b94b06daf8126bf14c63d68b53e952829"} build_url:https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011406 build_url: 'https://queue.taskcluster.net/v1/task/VE3DghuxSw-brz4y6MJQkw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/ebefd327628ee7f8325c39412a94b6d05d82a205993c50b4a173ac051fb6967f5660bddc230220241c62f6c684fc5a93c0c2661015198a0f4299962159cb955f", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/1df4bd768020fef4aaf1675d555dd92dc83f8995544209c3f975c3e641a00115f3700597c600475ef451431a448f72ed9726a0fdf0457b2706d19e1f8933149b", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/d9a2200320bf41e40769b7522287ec3ff68ec69887d42736d3ea619aa11632e307517aeae0d61460b23210dbffd1733b94b06daf8126bf14c63d68b53e952829"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-12-24 02:52:44.565257) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-12-24 02:52:44.565701) ========= 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=7de08804244eb36560b44971000001c3-1482554493.170783-613431067 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004519 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-12-24 02:52:44.615199) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-12-24 02:52:44.615523) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-12-24 02:52:44.615818) ========= ========= Total master_lag: 0.30 =========