builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-027 starttime: 1479676446.45 results: success (0) buildid: 20161120101722 builduid: 7b432ad44ceb44af9fc920cc669a1cbf revision: 3929c921fc44d50a7b7b85557520188f455cf816 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-11-20 13:14:06.446512) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-11-20 13:14:06.446955) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-20 13:14:06.447565) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-11-20 13:14:06.499224) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-11-20 13:14:06.499725) ========= 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=1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-11-20 13:14:06-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 102M=0s 2016-11-20 13:14:07 (102 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.094644 ========= master_lag: 0.04 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-11-20 13:14:06.630909) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-11-20 13:14:06.631281) ========= 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=1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019200 ========= master_lag: 0.05 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-11-20 13:14:06.700404) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-11-20 13:14:06.700765) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev 3929c921fc44d50a7b7b85557520188f455cf816 --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 3929c921fc44d50a7b7b85557520188f455cf816 --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=1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-11-20 13:14:07,166 truncating revision to first 12 chars 2016-11-20 13:14:07,166 Setting DEBUG logging. 2016-11-20 13:14:07,166 attempt 1/10 2016-11-20 13:14:07,166 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/3929c921fc44?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-11-20 13:14:07,520 unpacking tar archive at: mozilla-aurora-3929c921fc44/testing/mozharness/ program finished with exit code 0 elapsedTime=0.647397 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-11-20 13:14:07.365922) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-11-20 13:14:07.366248) ========= script_repo_revision: 3929c921fc44d50a7b7b85557520188f455cf816 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-11-20 13:14:07.366673) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-11-20 13:14:07.367007) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-11-20 13:14:07.380145) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-11-20 13:14:07.380448) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --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', '--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=1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 13:14:07 INFO - MultiFileLogger online at 20161120 13:14:07 in /builds/slave/test 13:14:07 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 13:14:07 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 13:14:07 INFO - {'append_to_log': False, 13:14:07 INFO - 'base_work_dir': '/builds/slave/test', 13:14:07 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 13:14:07 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 13:14:07 INFO - 'branch': 'Mozilla-Aurora', 13:14:07 INFO - 'buildbot_json_path': 'buildprops.json', 13:14:07 INFO - 'config_files': ('talos/linux_config.py',), 13:14:07 INFO - 'default_actions': ('clobber', 13:14:07 INFO - 'read-buildbot-config', 13:14:07 INFO - 'download-and-extract', 13:14:07 INFO - 'populate-webroot', 13:14:07 INFO - 'create-virtualenv', 13:14:07 INFO - 'install', 13:14:07 INFO - 'run-tests'), 13:14:07 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 13:14:07 INFO - 'download_minidump_stackwalk': True, 13:14:07 INFO - 'download_symbols': 'ondemand', 13:14:07 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 13:14:07 INFO - 'tooltool.py': '/tools/tooltool.py', 13:14:07 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 13:14:07 INFO - '/tools/misc-python/virtualenv.py')}, 13:14:07 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 13:14:07 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 13:14:07 INFO - 'installer_path': 'installer.exe', 13:14:07 INFO - 'log_level': 'info', 13:14:07 INFO - 'log_name': 'talos', 13:14:07 INFO - 'log_to_console': True, 13:14:07 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 13:14:07 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 13:14:07 INFO - 'opt_config_files': (), 13:14:07 INFO - 'pip_index': False, 13:14:07 INFO - 'sps_profile': False, 13:14:07 INFO - 'sps_profile_interval': 0, 13:14:07 INFO - 'suite': 'dromaeojs', 13:14:07 INFO - 'system_bits': '32', 13:14:07 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 13:14:07 INFO - 'title': 'talos-linux64-ix-027', 13:14:07 INFO - 'tooltool_cache': '/builds/tooltool_cache', 13:14:07 INFO - 'use_talos_json': True, 13:14:07 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 13:14:07 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 13:14:07 INFO - 'work_dir': 'build'} 13:14:07 INFO - [mozharness: 2016-11-20 21:14:07.943269Z] Running clobber step. 13:14:07 INFO - Running pre-action listener: _resource_record_pre_action 13:14:07 INFO - Running main action method: clobber 13:14:07 INFO - rmtree: /builds/slave/test/build 13:14:07 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 13:14:08 INFO - Running post-action listener: _resource_record_post_action 13:14:08 INFO - [mozharness: 2016-11-20 21:14:08.922268Z] Finished clobber step (success) 13:14:08 INFO - [mozharness: 2016-11-20 21:14:08.922368Z] Running read-buildbot-config step. 13:14:08 INFO - Running pre-action listener: _resource_record_pre_action 13:14:08 INFO - Running main action method: read_buildbot_config 13:14:08 INFO - Using buildbot properties: 13:14:08 INFO - { 13:14:08 INFO - "project": "", 13:14:08 INFO - "product": "firefox", 13:14:08 INFO - "script_repo_revision": "production", 13:14:08 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 13:14:08 INFO - "repository": "", 13:14:08 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 13:14:08 INFO - "buildid": "20161120101722", 13:14:08 INFO - "pgo_build": "True", 13:14:08 INFO - "basedir": "/builds/slave/test", 13:14:08 INFO - "buildnumber": 607, 13:14:08 INFO - "slavename": "talos-linux64-ix-027", 13:14:08 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 13:14:08 INFO - "platform": "ubuntu64_hw", 13:14:08 INFO - "scheduler": "tests-mozilla-aurora-linux64-pgo-talos", 13:14:08 INFO - "branch": "mozilla-aurora", 13:14:08 INFO - "repo_path": "releases/mozilla-aurora", 13:14:08 INFO - "revision": "3929c921fc44d50a7b7b85557520188f455cf816", 13:14:08 INFO - "stage_platform": "linux64-pgo", 13:14:08 INFO - "builduid": "7b432ad44ceb44af9fc920cc669a1cbf", 13:14:08 INFO - "slavebuilddir": "test" 13:14:08 INFO - } 13:14:08 INFO - Found installer url https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2. 13:14:08 INFO - Running post-action listener: _resource_record_post_action 13:14:08 INFO - [mozharness: 2016-11-20 21:14:08.924786Z] Finished read-buildbot-config step (success) 13:14:08 INFO - [mozharness: 2016-11-20 21:14:08.924874Z] Running download-and-extract step. 13:14:08 INFO - Running pre-action listener: _resource_record_pre_action 13:14:08 INFO - Running main action method: download_and_extract 13:14:08 INFO - mkdir: /builds/slave/test/build/tests 13:14:08 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')]} 13:14:08 INFO - trying https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json 13:14:08 INFO - Downloading https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/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 13:14:08 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/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 13:14:09 INFO - Downloaded 1361 bytes. 13:14:09 INFO - Reading from file /builds/slave/test/build/firefox-52.0a2.en-US.linux-x86_64.test_packages.json 13:14:09 INFO - Using the following test package requirements: 13:14:09 INFO - {u'common': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'], 13:14:09 INFO - u'cppunittest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:14:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.cppunittest.tests.zip'], 13:14:09 INFO - u'gtest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:14:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.gtest.tests.zip'], 13:14:09 INFO - u'jittest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:14:09 INFO - u'jsshell-linux-x86_64.zip'], 13:14:09 INFO - u'mochitest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:14:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.mochitest.tests.zip'], 13:14:09 INFO - u'mozbase': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'], 13:14:09 INFO - u'reftest': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:14:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.reftest.tests.zip'], 13:14:09 INFO - u'talos': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:14:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip'], 13:14:09 INFO - u'web-platform': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:14:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.web-platform.tests.zip'], 13:14:09 INFO - u'xpcshell': [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip', 13:14:09 INFO - u'firefox-52.0a2.en-US.linux-x86_64.xpcshell.tests.zip']} 13:14:09 INFO - Downloading packages: [u'firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 13:14:09 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip 13:14:09 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 13:14:09 INFO - Fetch https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip into memory 13:14:10 INFO - Http code: 200 13:14:10 INFO - via: 1.1 0302e8c462515ae281b72d9c815a5698.cloudfront.net (CloudFront) 13:14:10 INFO - x-amz-cf-id: Vvpk6xE_5NXhYK_AXBK-E5aad6EGA2ms8S4-Osl4j6AG2ey1zjZkFw== 13:14:10 INFO - x-amz-version-id: r27ozc.gvQFteHJMMxluaMGh0oEWw_61 13:14:10 INFO - Expected file size: 21946344 13:14:10 INFO - Obtained file size: 21946344 13:14:14 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 13:14:14 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip 13:14:14 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip'}, attempt #1 13:14:14 INFO - Fetch https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.common.tests.zip into memory 13:14:15 INFO - Http code: 200 13:14:15 INFO - via: 1.1 455cf6ccbccc261c46d02110de1c0237.cloudfront.net (CloudFront) 13:14:15 INFO - x-amz-cf-id: 8Qbfm_ePtSFzgdtC4NjEuJf7FGnS664HAIr5WsNc32IX-UHVkvijNA== 13:14:15 INFO - x-amz-version-id: r27ozc.gvQFteHJMMxluaMGh0oEWw_61 13:14:15 INFO - Expected file size: 21946344 13:14:15 INFO - Obtained file size: 21946344 13:14:19 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip 13:14:19 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 13:14:19 INFO - Fetch https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.talos.tests.zip into memory 13:14:20 INFO - Http code: 200 13:14:20 INFO - via: 1.1 41b2ee7cbe95749816a7586d9ab4629d.cloudfront.net (CloudFront) 13:14:20 INFO - x-amz-cf-id: YOIIgkV2G8AQ0oUHog-MqJrpcVpDvovm038JwOtL0Okz_iVCNTDnyg== 13:14:20 INFO - x-amz-version-id: K99BnRdekbCW4U3lW6v4N84sNPW2jglR 13:14:20 INFO - Expected file size: 14409038 13:14:20 INFO - Obtained file size: 14409038 13:14:20 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')]} 13:14:20 INFO - trying https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 13:14:20 INFO - Downloading https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/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 13:14:20 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/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 13:14:24 INFO - Downloaded 63949231 bytes. 13:14:24 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 13:14:24 INFO - mkdir: /builds/slave/test/properties 13:14:24 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 13:14:24 INFO - Writing to file /builds/slave/test/properties/build_url 13:14:24 INFO - Contents: 13:14:24 INFO - build_url:https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 13:14:25 INFO - Running post-action listener: _resource_record_post_action 13:14:25 INFO - Running post-action listener: set_extra_try_arguments 13:14:25 INFO - [mozharness: 2016-11-20 21:14:25.496192Z] Finished download-and-extract step (success) 13:14:25 INFO - [mozharness: 2016-11-20 21:14:25.496417Z] Running populate-webroot step. 13:14:25 INFO - Running pre-action listener: _resource_record_pre_action 13:14:25 INFO - Running main action method: populate_webroot 13:14:25 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 13:14:25 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 13:14:25 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 13:14:25 INFO - '--tppagecycles', 13:14:25 INFO - '7'], 13:14:25 INFO - 'tests': ['tsvgm']}}, 13:14:25 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 13:14:25 INFO - 'tests': ['tresize', 'tcanvasmark']}, 13:14:25 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 13:14:25 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 13:14:25 INFO - 'tests': ['dromaeo_css', 'kraken']}, 13:14:25 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 13:14:25 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:14:25 INFO - 'talos_options': ['--disable-e10s'], 13:14:25 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:14:25 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:14:25 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:14:25 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:14:25 INFO - 'talos_options': ['--disable-e10s'], 13:14:25 INFO - 'tests': ['damp', 'tps']}, 13:14:25 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:14:25 INFO - 'tests': ['damp', 'tps']}, 13:14:25 INFO - 'g3': {'talos_options': ['--disable-e10s'], 13:14:25 INFO - 'tests': ['dromaeo_dom']}, 13:14:25 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 13:14:25 INFO - 'g4': {'talos_options': ['--disable-e10s'], 13:14:25 INFO - 'tests': ['basic_compositor_video']}, 13:14:25 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 13:14:25 INFO - 'other': {'talos_options': ['--disable-e10s'], 13:14:25 INFO - 'tests': ['a11yr', 13:14:25 INFO - 'ts_paint', 13:14:25 INFO - 'tpaint', 13:14:25 INFO - 'sessionrestore', 13:14:25 INFO - 'sessionrestore_no_auto_restore', 13:14:25 INFO - 'tabpaint']}, 13:14:25 INFO - 'other-e10s': {'tests': ['a11yr', 13:14:25 INFO - 'ts_paint', 13:14:25 INFO - 'tpaint', 13:14:25 INFO - 'sessionrestore', 13:14:25 INFO - 'sessionrestore_no_auto_restore', 13:14:25 INFO - 'tabpaint']}, 13:14:25 INFO - 'other-e10s_l64': {'tests': ['a11yr', 13:14:25 INFO - 'ts_paint', 13:14:25 INFO - 'tpaint', 13:14:25 INFO - 'sessionrestore', 13:14:25 INFO - 'sessionrestore_no_auto_restore', 13:14:25 INFO - 'tabpaint']}, 13:14:25 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 13:14:25 INFO - 'ts_paint', 13:14:25 INFO - 'tpaint', 13:14:25 INFO - 'sessionrestore', 13:14:25 INFO - 'sessionrestore_no_auto_restore', 13:14:25 INFO - 'tabpaint']}, 13:14:25 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 13:14:25 INFO - 'tests': ['a11yr', 13:14:25 INFO - 'ts_paint', 13:14:25 INFO - 'tpaint', 13:14:25 INFO - 'sessionrestore', 13:14:25 INFO - 'sessionrestore_no_auto_restore', 13:14:25 INFO - 'tabpaint']}, 13:14:25 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 13:14:25 INFO - 'tests': ['a11yr', 13:14:25 INFO - 'ts_paint', 13:14:25 INFO - 'tpaint', 13:14:25 INFO - 'sessionrestore', 13:14:25 INFO - 'sessionrestore_no_auto_restore', 13:14:25 INFO - 'tabpaint']}, 13:14:25 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 13:14:25 INFO - 'tests': ['tsvgx', 13:14:25 INFO - 'tsvgr_opacity', 13:14:25 INFO - 'tart', 13:14:25 INFO - 'tscrollx', 13:14:25 INFO - 'cart']}, 13:14:25 INFO - 'svgr-e10s': {'tests': ['tsvgx', 13:14:25 INFO - 'tsvgr_opacity', 13:14:25 INFO - 'tart', 13:14:25 INFO - 'tscrollx', 13:14:25 INFO - 'cart']}, 13:14:25 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:14:25 INFO - 'talos_options': ['--disable-e10s'], 13:14:25 INFO - 'tests': ['tp5o']}, 13:14:25 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:14:25 INFO - 'tests': ['tp5o']}, 13:14:25 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:14:25 INFO - 'talos_options': ['--disable-e10s', 13:14:25 INFO - '--xperf_path', 13:14:25 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:14:25 INFO - 'tests': ['tp5n']}, 13:14:25 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:14:25 INFO - 'talos_options': ['--xperf_path', 13:14:25 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:14:25 INFO - 'tests': ['tp5n']}}, 13:14:25 INFO - 'talos.zip': {'path': '', 13:14:25 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 13:14:25 INFO - Running post-action listener: _resource_record_post_action 13:14:25 INFO - [mozharness: 2016-11-20 21:14:25.515381Z] Finished populate-webroot step (success) 13:14:25 INFO - [mozharness: 2016-11-20 21:14:25.515470Z] Running create-virtualenv step. 13:14:25 INFO - Running pre-action listener: _resource_record_pre_action 13:14:25 INFO - Running main action method: create_virtualenv 13:14:25 INFO - Creating virtualenv /builds/slave/test/build/venv 13:14:25 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 13:14:25 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 13:14:25 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 13:14:25 INFO - Using real prefix '/usr' 13:14:25 INFO - New python executable in /builds/slave/test/build/venv/bin/python 13:14:26 INFO - Installing distribute.............................................................................................................................................................................................done. 13:14:28 INFO - Installing pip.................done. 13:14:28 INFO - Return code: 0 13:14:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 13:14:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 13:14:28 INFO - Reading from file tmpfile_stdout 13:14:28 INFO - Output received: 13:14:28 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) 13:14:28 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 13:14:28 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')]} 13:14:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:14:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:28 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')]} 13:14:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:14:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:28 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 0x7f7b8b772f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x206dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206af60>, '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 0x206bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206c1d0>, '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': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', '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 13:14:28 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 13:14:28 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 13:14:28 INFO - Using env: {'DISPLAY': ':0', 13:14:28 INFO - 'HOME': '/home/cltbld', 13:14:28 INFO - 'LANG': 'en_US.UTF-8', 13:14:28 INFO - 'LANGUAGE': 'en_US:en', 13:14:28 INFO - 'LOGNAME': 'cltbld', 13:14:28 INFO - 'MAIL': '/var/mail/cltbld', 13:14:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:14:28 INFO - 'MOZ_NO_REMOTE': '1', 13:14:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:14:28 INFO - 'NO_EM_RESTART': '1', 13:14:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:14:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:14:28 INFO - 'PWD': '/builds/slave/test', 13:14:28 INFO - 'SHELL': '/bin/bash', 13:14:28 INFO - 'SHLVL': '1', 13:14:28 INFO - 'TERM': 'linux', 13:14:28 INFO - 'TMOUT': '86400', 13:14:28 INFO - 'USER': 'cltbld', 13:14:28 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', 13:14:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:14:28 INFO - '_': '/tools/buildbot/bin/python'} 13:14:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:14:28 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 13:14:28 INFO - Cleaning up... 13:14:28 INFO - Return code: 0 13:14:28 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 13:14:28 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')]} 13:14:28 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:14:28 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:28 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')]} 13:14:28 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:14:28 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:28 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 0x7f7b8b772f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x206dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206af60>, '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 0x206bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206c1d0>, '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': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', '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 13:14:28 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 13:14:28 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 13:14:28 INFO - Using env: {'DISPLAY': ':0', 13:14:28 INFO - 'HOME': '/home/cltbld', 13:14:28 INFO - 'LANG': 'en_US.UTF-8', 13:14:28 INFO - 'LANGUAGE': 'en_US:en', 13:14:28 INFO - 'LOGNAME': 'cltbld', 13:14:28 INFO - 'MAIL': '/var/mail/cltbld', 13:14:28 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:14:28 INFO - 'MOZ_NO_REMOTE': '1', 13:14:28 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:14:28 INFO - 'NO_EM_RESTART': '1', 13:14:28 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:14:28 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:14:28 INFO - 'PWD': '/builds/slave/test', 13:14:28 INFO - 'SHELL': '/bin/bash', 13:14:28 INFO - 'SHLVL': '1', 13:14:28 INFO - 'TERM': 'linux', 13:14:28 INFO - 'TMOUT': '86400', 13:14:28 INFO - 'USER': 'cltbld', 13:14:28 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', 13:14:28 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:14:28 INFO - '_': '/tools/buildbot/bin/python'} 13:14:28 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:14:28 INFO - Downloading/unpacking psutil>=3.1.1 13:14:28 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 13:14:28 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 13:14:28 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 13:14:28 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 13:14:28 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 13:14:28 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 13:14:30 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 13:14:30 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:14:30 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:14:30 INFO - Installing collected packages: psutil 13:14:30 INFO - Running setup.py install for psutil 13:14:30 INFO - building 'psutil._psutil_linux' extension 13:14: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 13:14:31 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 13:14:31 INFO - building 'psutil._psutil_posix' extension 13:14:31 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 13:14:31 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 13:14:31 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:14:31 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:14:31 INFO - Successfully installed psutil 13:14:31 INFO - Cleaning up... 13:14:31 INFO - Return code: 0 13:14:31 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 13:14:31 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')]} 13:14:31 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:14:31 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:31 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')]} 13:14:31 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:14:31 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:31 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 0x7f7b8b772f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x206dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206af60>, '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 0x206bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206c1d0>, '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': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', '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 13:14:31 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 13:14:31 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 13:14:31 INFO - Using env: {'DISPLAY': ':0', 13:14:31 INFO - 'HOME': '/home/cltbld', 13:14:31 INFO - 'LANG': 'en_US.UTF-8', 13:14:31 INFO - 'LANGUAGE': 'en_US:en', 13:14:31 INFO - 'LOGNAME': 'cltbld', 13:14:31 INFO - 'MAIL': '/var/mail/cltbld', 13:14:31 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:14:31 INFO - 'MOZ_NO_REMOTE': '1', 13:14:31 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:14:31 INFO - 'NO_EM_RESTART': '1', 13:14:31 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:14:31 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:14:31 INFO - 'PWD': '/builds/slave/test', 13:14:31 INFO - 'SHELL': '/bin/bash', 13:14:31 INFO - 'SHLVL': '1', 13:14:31 INFO - 'TERM': 'linux', 13:14:31 INFO - 'TMOUT': '86400', 13:14:31 INFO - 'USER': 'cltbld', 13:14:31 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', 13:14:31 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:14:31 INFO - '_': '/tools/buildbot/bin/python'} 13:14:31 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:14:31 INFO - Downloading/unpacking mozsystemmonitor==0.3 13:14:31 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 13:14:31 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 13:14:31 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 13:14:31 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 13:14:31 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 13:14:31 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 13:14:33 INFO - Downloading mozsystemmonitor-0.3.tar.gz 13:14:33 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 13:14:33 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 13:14:33 INFO - Installing collected packages: mozsystemmonitor 13:14:33 INFO - Running setup.py install for mozsystemmonitor 13:14:33 INFO - Successfully installed mozsystemmonitor 13:14:33 INFO - Cleaning up... 13:14:33 INFO - Return code: 0 13:14:33 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 13:14:33 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')]} 13:14:33 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:14:33 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:33 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')]} 13:14:33 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:14:33 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:33 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 0x7f7b8b772f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x206dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206af60>, '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 0x206bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206c1d0>, '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': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', '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 13:14:33 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 13:14:33 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 13:14:33 INFO - Using env: {'DISPLAY': ':0', 13:14:33 INFO - 'HOME': '/home/cltbld', 13:14:33 INFO - 'LANG': 'en_US.UTF-8', 13:14:33 INFO - 'LANGUAGE': 'en_US:en', 13:14:33 INFO - 'LOGNAME': 'cltbld', 13:14:33 INFO - 'MAIL': '/var/mail/cltbld', 13:14:33 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:14:33 INFO - 'MOZ_NO_REMOTE': '1', 13:14:33 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:14:33 INFO - 'NO_EM_RESTART': '1', 13:14:33 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:14:33 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:14:33 INFO - 'PWD': '/builds/slave/test', 13:14:33 INFO - 'SHELL': '/bin/bash', 13:14:33 INFO - 'SHLVL': '1', 13:14:33 INFO - 'TERM': 'linux', 13:14:33 INFO - 'TMOUT': '86400', 13:14:33 INFO - 'USER': 'cltbld', 13:14:33 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', 13:14:33 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:14:33 INFO - '_': '/tools/buildbot/bin/python'} 13:14:33 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:14:33 INFO - Downloading/unpacking jsonschema==2.5.1 13:14: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 13:14: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 13:14: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 13:14: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 13:14: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 13:14: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 13:14:35 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 13:14:35 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 13:14: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 13:14: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 13:14: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 13:14: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 13:14: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 13:14: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 13:14:36 INFO - Downloading functools32-3.2.3-2.tar.gz 13:14:36 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 13:14:36 INFO - warning: no files found matching '*.txt' 13:14:36 INFO - no previously-included directories found matching 'build' 13:14:36 INFO - no previously-included directories found matching 'dist' 13:14:36 INFO - no previously-included directories found matching '.git*' 13:14:36 INFO - Installing collected packages: jsonschema, functools32 13:14:36 INFO - Running setup.py install for functools32 13:14:36 INFO - warning: no files found matching '*.txt' 13:14:36 INFO - no previously-included directories found matching 'build' 13:14:36 INFO - no previously-included directories found matching 'dist' 13:14:36 INFO - no previously-included directories found matching '.git*' 13:14:36 INFO - Successfully installed jsonschema functools32 13:14:36 INFO - Cleaning up... 13:14:36 INFO - Return code: 0 13:14:36 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 13:14:36 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')]} 13:14:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:14:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:36 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')]} 13:14:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:14:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:36 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 0x7f7b8b772f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x206dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206af60>, '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 0x206bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206c1d0>, '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': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', '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 13:14:36 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 13:14:36 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 13:14:36 INFO - Using env: {'DISPLAY': ':0', 13:14:36 INFO - 'HOME': '/home/cltbld', 13:14:36 INFO - 'LANG': 'en_US.UTF-8', 13:14:36 INFO - 'LANGUAGE': 'en_US:en', 13:14:36 INFO - 'LOGNAME': 'cltbld', 13:14:36 INFO - 'MAIL': '/var/mail/cltbld', 13:14:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:14:36 INFO - 'MOZ_NO_REMOTE': '1', 13:14:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:14:36 INFO - 'NO_EM_RESTART': '1', 13:14:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:14:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:14:36 INFO - 'PWD': '/builds/slave/test', 13:14:36 INFO - 'SHELL': '/bin/bash', 13:14:36 INFO - 'SHLVL': '1', 13:14:36 INFO - 'TERM': 'linux', 13:14:36 INFO - 'TMOUT': '86400', 13:14:36 INFO - 'USER': 'cltbld', 13:14:36 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', 13:14:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:14:36 INFO - '_': '/tools/buildbot/bin/python'} 13:14:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:14:36 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 13:14:36 INFO - Cleaning up... 13:14:36 INFO - Return code: 0 13:14:36 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 13:14:36 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')]} 13:14:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:14:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:36 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')]} 13:14:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:14:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:36 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 0x7f7b8b772f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x206dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206af60>, '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 0x206bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206c1d0>, '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': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', '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 13:14:36 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 13:14:36 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 13:14:36 INFO - Using env: {'DISPLAY': ':0', 13:14:36 INFO - 'HOME': '/home/cltbld', 13:14:36 INFO - 'LANG': 'en_US.UTF-8', 13:14:36 INFO - 'LANGUAGE': 'en_US:en', 13:14:36 INFO - 'LOGNAME': 'cltbld', 13:14:36 INFO - 'MAIL': '/var/mail/cltbld', 13:14:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:14:36 INFO - 'MOZ_NO_REMOTE': '1', 13:14:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:14:36 INFO - 'NO_EM_RESTART': '1', 13:14:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:14:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:14:36 INFO - 'PWD': '/builds/slave/test', 13:14:36 INFO - 'SHELL': '/bin/bash', 13:14:36 INFO - 'SHLVL': '1', 13:14:36 INFO - 'TERM': 'linux', 13:14:36 INFO - 'TMOUT': '86400', 13:14:36 INFO - 'USER': 'cltbld', 13:14:36 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', 13:14:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:14:36 INFO - '_': '/tools/buildbot/bin/python'} 13:14:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:14:36 INFO - Downloading/unpacking blobuploader==1.2.4 13:14: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 13:14: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 13:14: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 13:14: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 13:14: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 13:14: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 13:14:38 INFO - Downloading blobuploader-1.2.4.tar.gz 13:14:38 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 13:14:38 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 13:14: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 13:14: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 13:14: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 13:14: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 13:14: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 13:14: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 13:14:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 13:14:39 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 13:14:39 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 13:14:39 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 13:14:39 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 13:14:39 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 13:14:39 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 13:14:39 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 13:14:39 INFO - Downloading docopt-0.6.1.tar.gz 13:14:39 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 13:14:39 INFO - Installing collected packages: blobuploader, requests, docopt 13:14:39 INFO - Running setup.py install for blobuploader 13:14:39 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 13:14:39 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 13:14:39 INFO - Running setup.py install for requests 13:14:39 INFO - Running setup.py install for docopt 13:14:40 INFO - Successfully installed blobuploader requests docopt 13:14:40 INFO - Cleaning up... 13:14:40 INFO - Return code: 0 13:14:40 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:14:40 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')]} 13:14:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:14:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:40 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')]} 13:14:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:14:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:40 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 0x7f7b8b772f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x206dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206af60>, '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 0x206bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206c1d0>, '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': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', '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 13:14:40 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 13:14:40 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 13:14:40 INFO - Using env: {'DISPLAY': ':0', 13:14:40 INFO - 'HOME': '/home/cltbld', 13:14:40 INFO - 'LANG': 'en_US.UTF-8', 13:14:40 INFO - 'LANGUAGE': 'en_US:en', 13:14:40 INFO - 'LOGNAME': 'cltbld', 13:14:40 INFO - 'MAIL': '/var/mail/cltbld', 13:14:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:14:40 INFO - 'MOZ_NO_REMOTE': '1', 13:14:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:14:40 INFO - 'NO_EM_RESTART': '1', 13:14:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:14:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:14:40 INFO - 'PWD': '/builds/slave/test', 13:14:40 INFO - 'SHELL': '/bin/bash', 13:14:40 INFO - 'SHLVL': '1', 13:14:40 INFO - 'TERM': 'linux', 13:14:40 INFO - 'TMOUT': '86400', 13:14:40 INFO - 'USER': 'cltbld', 13:14:40 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', 13:14:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:14:40 INFO - '_': '/tools/buildbot/bin/python'} 13:14:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:14:40 INFO - Running setup.py (path:/tmp/pip-dQSkfw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:14:40 INFO - Running setup.py (path:/tmp/pip-jDHjdQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:14:40 INFO - Running setup.py (path:/tmp/pip-X1RVwI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:14:40 INFO - Running setup.py (path:/tmp/pip-SlbNV3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:14:40 INFO - Running setup.py (path:/tmp/pip-4yislE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:14:40 INFO - Running setup.py (path:/tmp/pip-qaJVqn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:14:40 INFO - Running setup.py (path:/tmp/pip-XIPog8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:14:40 INFO - Running setup.py (path:/tmp/pip-YpcRkd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:14:40 INFO - Running setup.py (path:/tmp/pip-JKMUZE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:14:40 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:14:40 INFO - Running setup.py (path:/tmp/pip-temcaY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:14:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:14:41 INFO - Running setup.py (path:/tmp/pip-8Dvvqc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:14:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:14:41 INFO - Running setup.py (path:/tmp/pip-Ac7Ry3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:14:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:14:41 INFO - Running setup.py (path:/tmp/pip-cs66Om-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:14:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:14:41 INFO - Running setup.py (path:/tmp/pip-7e7uZB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:14:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:14:41 INFO - Running setup.py (path:/tmp/pip-I0Bp9E-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:14:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:14:41 INFO - Running setup.py (path:/tmp/pip-nwgo75-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:14:41 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:14:41 INFO - Running setup.py (path:/tmp/pip-NIOndM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:14:41 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 13:14:41 INFO - Running setup.py install for manifestparser 13:14:41 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 13:14:41 INFO - Running setup.py install for mozcrash 13:14:41 INFO - Running setup.py install for mozdebug 13:14:41 INFO - Running setup.py install for mozdevice 13:14:41 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 13:14:41 INFO - Installing dm script to /builds/slave/test/build/venv/bin 13:14:41 INFO - Running setup.py install for mozfile 13:14:42 INFO - Running setup.py install for mozhttpd 13:14:42 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 13:14:42 INFO - Running setup.py install for mozinfo 13:14:42 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 13:14:42 INFO - Running setup.py install for mozInstall 13:14:42 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 13:14:42 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 13:14:42 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 13:14:42 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 13:14:42 INFO - Running setup.py install for mozleak 13:14:42 INFO - Running setup.py install for mozlog 13:14:42 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 13:14:42 INFO - Running setup.py install for moznetwork 13:14:42 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 13:14:42 INFO - Running setup.py install for mozprocess 13:14:42 INFO - Running setup.py install for mozprofile 13:14:42 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 13:14:42 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 13:14:42 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 13:14:42 INFO - Running setup.py install for mozrunner 13:14:43 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 13:14:43 INFO - Running setup.py install for mozscreenshot 13:14:43 INFO - Running setup.py install for moztest 13:14:43 INFO - Running setup.py install for mozversion 13:14:43 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 13:14:43 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 13:14:43 INFO - Cleaning up... 13:14:43 INFO - Return code: 0 13:14:43 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:14:43 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')]} 13:14:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:14:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:43 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')]} 13:14:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:14:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:43 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 0x7f7b8b772f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x206dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206af60>, '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 0x206bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206c1d0>, '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': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', '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 13:14:43 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 13:14:43 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 13:14:43 INFO - Using env: {'DISPLAY': ':0', 13:14:43 INFO - 'HOME': '/home/cltbld', 13:14:43 INFO - 'LANG': 'en_US.UTF-8', 13:14:43 INFO - 'LANGUAGE': 'en_US:en', 13:14:43 INFO - 'LOGNAME': 'cltbld', 13:14:43 INFO - 'MAIL': '/var/mail/cltbld', 13:14:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:14:43 INFO - 'MOZ_NO_REMOTE': '1', 13:14:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:14:43 INFO - 'NO_EM_RESTART': '1', 13:14:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:14:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:14:43 INFO - 'PWD': '/builds/slave/test', 13:14:43 INFO - 'SHELL': '/bin/bash', 13:14:43 INFO - 'SHLVL': '1', 13:14:43 INFO - 'TERM': 'linux', 13:14:43 INFO - 'TMOUT': '86400', 13:14:43 INFO - 'USER': 'cltbld', 13:14:43 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', 13:14:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:14:43 INFO - '_': '/tools/buildbot/bin/python'} 13:14:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:14:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:14:43 INFO - Running setup.py (path:/tmp/pip-OXqNo2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:14: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)) 13:14:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:14:43 INFO - Running setup.py (path:/tmp/pip-f9rCbH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:14: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)) 13:14:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:14:43 INFO - Running setup.py (path:/tmp/pip-gLnicP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:14: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)) 13:14:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:14:43 INFO - Running setup.py (path:/tmp/pip-pYnY4K-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:14: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)) 13:14:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:14:43 INFO - Running setup.py (path:/tmp/pip-qr9HHb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:14: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)) 13:14:43 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:14:43 INFO - Running setup.py (path:/tmp/pip-1LiNvN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:14:44 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)) 13:14:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:14:44 INFO - Running setup.py (path:/tmp/pip-O7fH_j-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:14:44 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)) 13:14:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:14:44 INFO - Running setup.py (path:/tmp/pip-S29LGs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:14:44 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)) 13:14:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:14:44 INFO - Running setup.py (path:/tmp/pip-BjL7zt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:14:44 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)) 13:14:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:14:44 INFO - Running setup.py (path:/tmp/pip-enl9UY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:14:44 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)) 13:14:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:14:44 INFO - Running setup.py (path:/tmp/pip-Shizwy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:14:44 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)) 13:14:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:14:44 INFO - Running setup.py (path:/tmp/pip-8DCiEG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:14:44 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)) 13:14:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:14:44 INFO - Running setup.py (path:/tmp/pip-dAVl4U-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:14:44 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)) 13:14:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:14:44 INFO - Running setup.py (path:/tmp/pip-fEgKrD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:14: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)) 13:14:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:14:44 INFO - Running setup.py (path:/tmp/pip-mHoFAo-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:14: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)) 13:14:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:14:44 INFO - Running setup.py (path:/tmp/pip-T_Bjhm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:14: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)) 13:14:44 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:14:44 INFO - Running setup.py (path:/tmp/pip-FoH4bO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:14: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)) 13:14: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)) 13:14: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)) 13:14: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)) 13:14: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)) 13:14: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)) 13:14:44 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 13:14: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 13:14: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 13:14: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 13:14: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 13:14: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 13:14: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 13:14:46 INFO - Downloading blessings-1.6.tar.gz 13:14:46 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 13:14:46 INFO - Installing collected packages: blessings 13:14:46 INFO - Running setup.py install for blessings 13:14:46 INFO - Successfully installed blessings 13:14:46 INFO - Cleaning up... 13:14:46 INFO - Return code: 0 13:14:46 INFO - Done creating virtualenv /builds/slave/test/build/venv. 13:14:46 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:14:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:14:47 INFO - Reading from file tmpfile_stdout 13:14:47 INFO - Current package versions: 13:14:47 INFO - argparse == 1.2.1 13:14:47 INFO - blessings == 1.6 13:14:47 INFO - blobuploader == 1.2.4 13:14:47 INFO - docopt == 0.6.1 13:14:47 INFO - functools32 == 3.2.3-2 13:14:47 INFO - jsonschema == 2.5.1 13:14:47 INFO - manifestparser == 1.1 13:14:47 INFO - mozInstall == 1.12 13:14:47 INFO - mozcrash == 1.0 13:14:47 INFO - mozdebug == 0.1 13:14:47 INFO - mozdevice == 0.48 13:14:47 INFO - mozfile == 1.2 13:14:47 INFO - mozhttpd == 0.7 13:14:47 INFO - mozinfo == 0.9 13:14:47 INFO - mozleak == 0.1 13:14:47 INFO - mozlog == 3.4 13:14:47 INFO - moznetwork == 0.27 13:14:47 INFO - mozprocess == 0.23 13:14:47 INFO - mozprofile == 0.28 13:14:47 INFO - mozrunner == 6.13 13:14:47 INFO - mozscreenshot == 0.1 13:14:47 INFO - mozsystemmonitor == 0.3 13:14:47 INFO - moztest == 0.7 13:14:47 INFO - mozversion == 1.4 13:14:47 INFO - psutil == 3.1.1 13:14:47 INFO - requests == 1.2.3 13:14:47 INFO - wsgiref == 0.1.2 13:14:47 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:14:47 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')]} 13:14:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:14:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:47 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')]} 13:14:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:14:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:47 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 0x7f7b8b772f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x206dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206af60>, '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 0x206bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206c1d0>, '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': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', '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 13:14:47 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 13:14:47 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 13:14:47 INFO - Using env: {'DISPLAY': ':0', 13:14:47 INFO - 'HOME': '/home/cltbld', 13:14:47 INFO - 'LANG': 'en_US.UTF-8', 13:14:47 INFO - 'LANGUAGE': 'en_US:en', 13:14:47 INFO - 'LOGNAME': 'cltbld', 13:14:47 INFO - 'MAIL': '/var/mail/cltbld', 13:14:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:14:47 INFO - 'MOZ_NO_REMOTE': '1', 13:14:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:14:47 INFO - 'NO_EM_RESTART': '1', 13:14:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:14:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:14:47 INFO - 'PWD': '/builds/slave/test', 13:14:47 INFO - 'SHELL': '/bin/bash', 13:14:47 INFO - 'SHLVL': '1', 13:14:47 INFO - 'TERM': 'linux', 13:14:47 INFO - 'TMOUT': '86400', 13:14:47 INFO - 'USER': 'cltbld', 13:14:47 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', 13:14:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:14:47 INFO - '_': '/tools/buildbot/bin/python'} 13:14:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:14:47 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)) 13:14:47 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)) 13:14:47 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)) 13:14:47 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)) 13:14:47 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)) 13:14:47 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)) 13:14:47 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)) 13:14:47 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)) 13:14:47 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)) 13:14:47 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)) 13:14:47 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)) 13:14:47 INFO - Cleaning up... 13:14:47 INFO - Return code: 0 13:14:47 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 13:14:47 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')]} 13:14:47 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:14:47 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:47 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')]} 13:14:47 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:14:47 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:14:47 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 0x7f7b8b772f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1fa08a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x206dca0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x206af60>, '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 0x206bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206c1d0>, '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': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', '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 13:14:47 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 13:14:47 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 13:14:47 INFO - Using env: {'DISPLAY': ':0', 13:14:47 INFO - 'HOME': '/home/cltbld', 13:14:47 INFO - 'LANG': 'en_US.UTF-8', 13:14:47 INFO - 'LANGUAGE': 'en_US:en', 13:14:47 INFO - 'LOGNAME': 'cltbld', 13:14:47 INFO - 'MAIL': '/var/mail/cltbld', 13:14:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:14:47 INFO - 'MOZ_NO_REMOTE': '1', 13:14:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:14:47 INFO - 'NO_EM_RESTART': '1', 13:14:47 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:14:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:14:47 INFO - 'PWD': '/builds/slave/test', 13:14:47 INFO - 'SHELL': '/bin/bash', 13:14:47 INFO - 'SHLVL': '1', 13:14:47 INFO - 'TERM': 'linux', 13:14:47 INFO - 'TMOUT': '86400', 13:14:47 INFO - 'USER': 'cltbld', 13:14:47 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', 13:14:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:14:47 INFO - '_': '/tools/buildbot/bin/python'} 13:14:47 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:14:47 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 13:14:47 INFO - Cleaning up... 13:14:47 INFO - Return code: 0 13:14:47 INFO - Running post-action listener: _resource_record_post_action 13:14:47 INFO - Running post-action listener: _start_resource_monitoring 13:14:47 INFO - Starting resource monitoring. 13:14:47 INFO - [mozharness: 2016-11-20 21:14:47.709829Z] Finished create-virtualenv step (success) 13:14:47 INFO - [mozharness: 2016-11-20 21:14:47.710346Z] Running install step. 13:14:47 INFO - Running pre-action listener: _resource_record_pre_action 13:14:47 INFO - Running main action method: install 13:14:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:14:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:14:47 INFO - Reading from file tmpfile_stdout 13:14:47 INFO - Detecting whether we're running mozinstall >=1.0... 13:14:47 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 13:14:47 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 13:14:47 INFO - Reading from file tmpfile_stdout 13:14:47 INFO - Output received: 13:14:48 INFO - Usage: mozinstall [options] installer 13:14:48 INFO - Options: 13:14:48 INFO - -h, --help show this help message and exit 13:14:48 INFO - -d DEST, --destination=DEST 13:14:48 INFO - Directory to install application into. [default: 13:14:48 INFO - "/builds/slave/test"] 13:14:48 INFO - --app=APP Application being installed. [default: firefox] 13:14:48 INFO - mkdir: /builds/slave/test/build/application 13:14:48 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'] 13:14:48 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 13:15:03 INFO - Reading from file tmpfile_stdout 13:15:03 INFO - Output received: 13:15:03 INFO - /builds/slave/test/build/application/firefox/firefox 13:15:03 INFO - Running post-action listener: _resource_record_post_action 13:15:03 INFO - [mozharness: 2016-11-20 21:15:03.927744Z] Finished install step (success) 13:15:03 INFO - [mozharness: 2016-11-20 21:15:03.927985Z] Running run-tests step. 13:15:03 INFO - Running pre-action listener: _resource_record_pre_action 13:15:03 INFO - Running main action method: run_tests 13:15:03 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 13:15:03 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 13:15:03 INFO - Python 2.7.3 13:15:03 INFO - Return code: 0 13:15:03 INFO - grabbing minidump binary from tooltool 13:15: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')]} 13:15: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 0x206af60>, '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 0x206bd40>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x206c1d0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 13:15: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 13:15: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 13:15: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 13:15:03 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 13:15:04 INFO - Return code: 0 13:15:04 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 13:15:04 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 13:15:04 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 13:15:04 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 13:15:04 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 13:15:04 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', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 13:15:04 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 --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-027 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 13:15:04 INFO - Using env: {'DISPLAY': ':0', 13:15:04 INFO - 'HOME': '/home/cltbld', 13:15:04 INFO - 'LANG': 'en_US.UTF-8', 13:15:04 INFO - 'LANGUAGE': 'en_US:en', 13:15:04 INFO - 'LOGNAME': 'cltbld', 13:15:04 INFO - 'MAIL': '/var/mail/cltbld', 13:15:04 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 13:15:04 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 13:15:04 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:15:04 INFO - 'MOZ_NO_REMOTE': '1', 13:15:04 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 13:15:04 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:15:04 INFO - 'NO_EM_RESTART': '1', 13:15:04 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:15:04 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:15:04 INFO - 'PWD': '/builds/slave/test', 13:15:04 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 13:15:04 INFO - 'SHELL': '/bin/bash', 13:15:04 INFO - 'SHLVL': '1', 13:15:04 INFO - 'TERM': 'linux', 13:15:04 INFO - 'TMOUT': '86400', 13:15:04 INFO - 'USER': 'cltbld', 13:15:04 INFO - 'XDG_SESSION_COOKIE': '1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600', 13:15:04 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:15:04 INFO - '_': '/tools/buildbot/bin/python'} 13:15:04 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-027', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 13:15:04 INFO - mozversion application_buildid: 20161120101722 13:15:04 INFO - mozversion application_changeset: 3929c921fc44d50a7b7b85557520188f455cf816 13:15:04 INFO - mozversion application_display_name: FirefoxDeveloperEdition 13:15:04 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 13:15:04 INFO - mozversion application_name: Firefox 13:15:04 INFO - mozversion application_remotingname: firefox-dev 13:15:04 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 13:15:04 INFO - mozversion application_vendor: Mozilla 13:15:04 INFO - mozversion application_version: 52.0a2 13:15:04 INFO - mozversion platform_buildid: 20161120101722 13:15:04 INFO - mozversion platform_changeset: 3929c921fc44d50a7b7b85557520188f455cf816 13:15:04 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 13:15:04 INFO - mozversion platform_version: 52.0a2 13:15:04 INFO - using testdate: 1479676504 13:15:04 INFO - actual date: 1479676504 13:15:04 INFO - starting webserver on 'localhost:46537' 13:15:04 INFO - SUITE-START | Running 2 tests 13:15:04 INFO - TEST-START | dromaeo_css 13:15:04 INFO - operating with platform_type : linux_ 13:15:04 INFO - Initialising browser for dromaeo_css test... 13:15:04 INFO - TEST-INFO | started process 14199 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpjF53Op/profile http://localhost:46537/getInfo.html) 13:15:07 ERROR - PROCESS | 14199 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 5373: TypeError: parent.firstChild is null 13:15:08 INFO - PROCESS | 14199 | __metrics Screen width/height:1600/1200 13:15:08 INFO - PROCESS | 14199 | colorDepth:24 13:15:08 INFO - PROCESS | 14199 | Browser inner width/height: 1024/697 13:15:08 INFO - PROCESS | 14199 | __metrics 13:15:08 INFO - PROCESS | 14199 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 13:15:08 INFO - PROCESS | 14199 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 13:15:09 INFO - PROCESS | 14199 | console.error: PushService: 13:15:09 INFO - PROCESS | 14199 | stateChangeProcessEnqueue: Error transitioning state 13:15:09 INFO - PROCESS | 14199 | UnknownError 13:15:09 INFO - TEST-INFO | 14199: exit 0 13:15:09 INFO - Browser initialized. 13:15:09 INFO - Running cycle 1/1 for dromaeo_css test... 13:15:09 INFO - TEST-INFO | started process 14291 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpjF53Op/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:15:21 INFO - PROCESS | 14291 | RSS: Main: 144818176 13:15:21 INFO - PROCESS | 14291 | 13:16:13 INFO - PROCESS | 14291 | 1479676573023 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] 13:18:23 INFO - PROCESS | 14291 | Cycle 1(1): loaded http://localhost:46537/tests/dromaeo/cssquery-dojo.html (next: http://localhost:46537/tests/dromaeo/cssquery-ext.html) 13:18:24 INFO - PROCESS | 14291 | RSS: Main: 243879936 13:18:24 INFO - PROCESS | 14291 | 13:21:27 INFO - PROCESS | 14291 | Cycle 1(1): loaded http://localhost:46537/tests/dromaeo/cssquery-ext.html (next: http://localhost:46537/tests/dromaeo/cssquery-jquery.html) 13:21:27 INFO - PROCESS | 14291 | RSS: Main: 224501760 13:21:27 INFO - PROCESS | 14291 | 13:24:29 INFO - PROCESS | 14291 | Cycle 1(1): loaded http://localhost:46537/tests/dromaeo/cssquery-jquery.html (next: http://localhost:46537/tests/dromaeo/cssquery-mootools.html) 13:24:30 INFO - PROCESS | 14291 | RSS: Main: 205971456 13:24:30 INFO - PROCESS | 14291 | 13:27:31 INFO - PROCESS | 14291 | Cycle 1(1): loaded http://localhost:46537/tests/dromaeo/cssquery-mootools.html (next: http://localhost:46537/tests/dromaeo/cssquery-prototype.html) 13:27:32 INFO - PROCESS | 14291 | RSS: Main: 220340224 13:27:32 INFO - PROCESS | 14291 | 13:30:35 INFO - PROCESS | 14291 | Cycle 1(1): loaded http://localhost:46537/tests/dromaeo/cssquery-prototype.html (next: http://localhost:46537/tests/dromaeo/cssquery-yui.html) 13:30:35 INFO - PROCESS | 14291 | RSS: Main: 177139712 13:30:35 INFO - PROCESS | 14291 | 13:33:38 INFO - PROCESS | 14291 | Cycle 1(1): loaded http://localhost:46537/tests/dromaeo/cssquery-yui.html (next: http://localhost:46537/tests/dromaeo/cssquery-dojo.html) 13:33:38 INFO - PROCESS | 14291 | RSS: Main: 269803520 13:33:38 INFO - PROCESS | 14291 | 13:33:38 INFO - PROCESS | 14291 | __start_tp_report 13:33:38 INFO - PROCESS | 14291 | _x_x_mozilla_page_load 13:33:38 INFO - PROCESS | 14291 | _x_x_mozilla_page_load_details 13:33:38 INFO - PROCESS | 14291 | |i|pagename|runs| 13:33:38 INFO - PROCESS | 14291 | |0;dojo.html;3201.5517827504145;3221.5006673965545;3240.5301231321446;3259.853306601203;3278.3443311337724;5585.357683866351;5648.039833228351;5657.886842263162;5662.348829884564;5667.291588551426;5660.575456840743;5717.371089180187;5719.19931209631;5720.856978575527;5745.827625171241;5116.488351164881;5176.637635365526;5195.506426889458;5217;5265.420803711589;5052.469490703478;5279.604029697769;5292.603054770889;5292.841214763544;5305.973470132644;5044.4955504449445;5083;5138.306328645623;5139.563137133329;5193.402758682762;5119.950410165926;5159.819406320798;5163.302954101186;5227.529522343008;5243.134882744343;5085.771140298695;5125.794968201268;5190.766415511273;5217.243499692523;5236.973815130938;5437.293151890269;5439.211314359396;5480.616356855022;5494.148406996882;5501.119820828688;5961.493273071794;5970.492508136814;5991.940080599225;6094.146819445281;6104.511639068864;6139.2325959255095;6155.846103847395;6159.445649891486;6166.044263139176;6168.506519478476;5524.889502209933;5525.419830917736;5561.721913904288;5583.916241256344;5650.519705824969;6106.786262480792;6130.6628135452975;6138.969305153446;6139.017757158833;6141.324454310023;5871.266091738533;5877.764889404461;5880.382559831241;5880.529557635379;5885.588008839341;5804.970975145182;5865.266841644794;5967.761289548456;6018.849528761816;6030.125631783367;6067.393260673897;6070.180525629072;6072.36240194782;6093.2078829751845;6104.023356263066;6027.336992930774;6076.696165191811;6087.269527656709;6087.391260873966;6098.481629061491;4483.125790470892;4512.368268442421;4554.316852472156;4561.475430325555;4674.719516828933;4106.753594784323;4112.506499220112;4133.256013917464;4144.233316836335;4170.603792639695;5574.219609254707;5574.442555744393;5586.24585680936;5592.5805564582815;5611.382747897728;5852.063669812809;5853.94146058534;5976.61152025117;6013.699315034319;6028.156058151862;5572.749226284827;5662.065759149694;5672.858178545487;5686.772529098873;5701.059325211294;5184.14461613837;5189;5194.480551944851;5197.090509160882;5208.406129885719;5787.102999035156;5912.881742365043;6078.422549857668;6081.604695694766;6105.542084343692;5991.101334799815;6031.819045428644;6060.515158787374;6142.191841058572;6143.481172719164;6083.756649733961;6089.908651370144;6089.939100608937;6093.268807743099;6108.389161083856;5726.942730572641;5987.161797348462;5990.161377407079;5993.400659933972;5998.160257563857;5814.94185058144;5988;6027.186329845415;6035.517158627212;6118.694065296806;5883.676397798162;5926.674032928058;5929.970350148222;5937.168796368425;5938.168656388023;5915.822525324247;5927.614705044159;5928.4960778334325;5929.377415371324;5931.673757943182;5617.43825617435;5742.16738572913;5758.712064396847;5818.854528636818;5831.854203644943;5985.6408615483215;5998.9100163496705;6001.189839371804;6004.789832355847;6016.368281330572;5659.179418984307;5702.258706368146;5840.415958404125;5855.7950471734985;5867.090600956859 13:33:38 INFO - PROCESS | 14291 | |1;ext.html;569.9401562835902;606.4693393280879;621.8321053315607;625.9374062593741;647.0908373734904;34379;45206.77396613017;46017.53982460174;46191.30713039307;46647.76676116619;46789;47268.29097563539;47293;47708.284375734394;47765;8270.917290827105;8422.368322375816;8939.553022348873;9093.909060909406;9104.271658267322;10614.57541698335;10852.186086043579;10854.24020318578;11139.498722557464;11140.888591114106;10899.346039237631;10984.670459886176;10990.725231869228;10991.230613857033;10999.670009899675;8367.372447066464;8469.83060338796;10633.73415664607;10716.35701857887;10814.188935829765;10761.246712730112;10804.18968577352;10829.133669306437;10832.295900766425;10846.349219046804;43025;43692;43729.781351093356;43732.78133609312;43743;3640.6359364063646;3806.54321481424;3848.9807550962346;3970.8014599269923;4178.582141785828;32763.50854737181;32925.34149317024;33016.6698333016;33100.66899331;33426.49860252098;4178.582141785828;4303.892402689927;4402.823887044515;4496.820127194941;4507.932381014288;369188;371249;372060;372720.99999999726;373764;66055.33944660588;66425;66702.66648666725;66971;67198.66400667965;39725;40728.59271407248;40926;42742.78628606837;42793;18834;18998.145083471278;19063.809361906482;19244.03779811004;19260.036998150037;13665.726685466236;13970.231637259845;14394.496192633207;14536.854631453762;14971.850281497263;20818.27136050231;21024.684629730567;21066.368008959755;21113.68329475059;21115.788842111382;7115.679794409264;7291;7315.561066336037;7345.3021962913435;7395.778126656209;972.2076507646387;993.7813680990171;994.1847684898314;1058.7988282226352;1087.0596933652334;30736.52706479305;32589;32987;33076;33576.83211583975;1013.3413281367023;1117.1068825144366;1138.2430683595483;1142.6686260984388;1200.2258543239561;16052.518424447286;17601.82398176002;17802.37691680785;18611.534711632048;19066.904665476584;523929;529275;531533;532578;533969;62814.685926570986;63558;63568.68215658892;63664;63699.6815015922;1287.2791236907362;1348.1237195822794;1362.536737509232;1408.1832537128441;1411.4072089722342;30009.549856751728;34514.482282765275;34653;34959.30081398409;35025.474617880245;54256.72871635616;55010.44989550213;55040.44959550353;55082.72458637681;55223.44776552344;412287;414796;414917;414917;417696;30577;31393.215169620944;31402.685973139975;31671.20821979469;33114.33771324512;50270.748646256536;50435.243471347225;50503.24245136399;50511.74744126256;51320.48679513157;41673.37489937714;41879;42723.3591496134;43252.78373608112;44255.336169956834;35761.64238357583;37534.10965065786;37541.624583753815;38385.23229535449;38461.230775383774;42736.30672535451;43206.783966079965;43223.56776432321;44027.11945761131;44090;31431.842840785648;33624.32751345008;33799.49300760441;33940.83029584836;34192.31615367629;29210.269743256587;29361.559576606796;29382.70617293885;29415.705842942152;29522.852385737933 13:33:38 INFO - PROCESS | 14291 | |2;jquery.html;386.2487461886632;424.4037127835388;427.1840784102365;430.38240125420015;443.1779049862505;14670.486532971348;19276.518087047814;19393.22427102916;20638.277660281892;20791.480212994684;19711.605767884634;19966.301179458722;20038.59922801543;20238.59522809543;20542;5543.833684989447;5807.651540907559;5808.303003639569;5808.332041815203;5811.128330750379;5487.286652735139;5607.327120745516;5728.16941543476;5745.023346031164;5749.540036797046;5722.484976352128;5722.599418040739;5723.742431590567;5726.112452569838;5727.856803579903;5457;5572.4148964358765;5576.86057848553;5601.467860553241;5603.7478313475995;4900.877478063041;5064.898702025976;5065.974670126662;5067.8986420271385;5069.771860266297;23862.284131476084;24252.393690157885;24475.632865507032;24628.753712463003;24924;2529.6584961030208;2656.774174195196;2731.934545527246;2816.5352716801704;2841.8579071046365;14924.179170145637;15145.394184232617;15258.618534536614;15400.22998850053;15794.763078553831;1931.8551108666907;1932.3526618582791;1938.4281636917144;1961.1665042356942;1995.6407846587608;80949;81074.59462702708;81420;81458.9999999994;81801;11016.559337626566;11092.889071109346;11115.944420278009;11404.714882128013;11409.42952852354;16100.436484722979;16315.51053468398;16330.836691633169;16368.83631163673;16380.180990950405;8825.161609647073;8920.420172688884;9008.909910900938;9144.81710365789;9212.53937303132;8859.557022148867;8863.911360886308;8871.157240062184;9004.774880627905;9099.727008189764;6781.660327187113;6972.1284839395075;7005;7023.859522809617;7065.1630576049565;1944.1542928826007;1980.63358278716;1992.2429476799014;1992.900354982245;2010.1155491583656;973.5181085362791;984.8276551603441;996.0338471682456;998.1166667499315;1028.598846449885;20015.799842001685;20616.484587885123;20648;20713.89643051775;20725;1021.9693409197736;1048.926575139733;1072.8015317166348;1078.320657985464;1083.8861919498497;10826.566937322576;10913.181511386678;11823.349715765544;11889.405529723479;11929;462101;486736;490144;491213;495484;91598.54200728954;94185.058149419;94185.52907235557;94436;95146.52426737822;1050.6742909698019;1083.5394957143183;1085.9674209773561;1128.7968165730247;1129.3619105205532;14286.785698214328;17949.910250448665;18269.17788699538;18329.633407332047;18564.907175464035;43487;43937.56062439334;43964.7801761002;44019.779901100286;44160.558394415646;53623.73188134035;56815.71592142178;56900.71549642225;57145.71427142838;57879;7604.5437273763755;7881.5665138417935;8035;8430.578471076544;8565.785855353417;12378.62864114078;12656.74686506283;12942.223466592035;13051.21692698441;13437.596872093853;11015.944920275348;11193.160512961724;11440.771184576428;11491.425428728697;11562.30626162433;10874.401907895142;11192.552297907992;11247.437628118725;11416.771664566828;11480.311181329147;11084.61203857861;11504.94247528757;11637.592684256011;11670.70823229392;12093;8028.839423211386;8136.389770767098;8184.2224988625985;8213;8240.299574536231;8531;10685.679429617125;10852.620158294421;10853.45732713377;11166.922538045445 13:33:38 INFO - PROCESS | 14291 | |3;mootools.html;1497.7154340675274;1515.4998850379375;1646.7447545630423;1787.785465744111;1814.192684255506;7873.37013038957;8443.451175673577;8450.197231263035;8455.70405035824;8458.407911446202;7519.887201691979;7709.3061624453785;7728.033995750531;7803.921960780391;8322.375821813357;2354.8587084774967;2401.819863510235;2403.098837935774;2406.42245860993;2408.3617841272076;2394.4013996500876;2411.2766170148884;2467.962980555293;2470.17249221511;2477.2568229531157;2399.4361325088676;2410.0600765701392;2423.9757602424015;2431.878406079689;2434.586120359534;2336.6144586143437;2352.470694093832;2358.9764102358927;2365.184011516041;2371.8102551795814;2331.720193576765;2335.241046659842;2354.835161538693;2357.0218359380838;2358.3868194269444;8067.435279530435;8225.465344752633;8336.416450848443;8343.95828020862;8345.916540834574;5177.119889618773;5316.734163291859;5324.467553244684;5331.333583302087;5332.760025798849;3333.96666033339;3338.2989572189626;3387.915302117442;3402.5406570112964;3415.4023045966856;1120.1934607082887;1127.7913585986619;1150.4765331774022;1170.8887655672697;1170.9238899471507;10907.291026083358;10923.344599323986;10949.83575246372;10951.34291942478;10954.233203675745;4313.2883074292395;4338.869833904988;4421.270490369053;4448.488423831301;4480.507144214133;8955.596998135099;8958.193762561401;9044.773880653036;9057.77355566103;9058.139476749699;5027.245913113063;5030.37120359955;5040.168372218616;5048.570871475892;5048.873778155576;4278.122984788111;4395.560443955643;4743.193657078305;4821.445533763592;4842.927356089662;3784.6593806556994;3797.8290976906105;3810.8666196682984;3862.7102967277565;3882.6699730522655;1128.3060917535656;1144.6794897428733;1157.9421028948518;1159.0611604600133;1161.1117495116243;972.9610815567439;982.8967958364411;994.3039872089422;1000.3047881722133;1011.7925825205815;5620.241267428926;5655.3779084300695;5703.40114288002;5707.229524014205;5722.656640601577;450.62372918613323;459.1757794758417;470.60469205867236;483.01706028232377;483.30404217926076;3927.9018024549614;3968.6825053995613;4033.69747268956;4055.229506393776;4061.91876162481;9814.411135331902;10215.336003159771;10278.280520363653;10291.022352876615;10327.380357178594;10118;10120.139788118093;10126.54430550627;10129.442880641489;10144.13774829133;7500.174980752222;7745.457817952802;7872.56700881457;7874.173211812792;7886.72396466121;5879.059350503899;5924.7037648118285;5952.553558483044;5955.791547295824;5980.850478738066;9201.125893040151;9309.301802364715;9315.813683726152;9331.53342332867;9356.95321523388;9443.669471568463;9456.243500519804;9585.856212156963;9619.951900240454;9833.557489912828;6833.794986150423;6905.551139175937;7100.715971361088;7467.402607791472;7610.771676849703;7700.730474433368;8042.879356809535;8042.87935680977;8044.758657240292;8047.51714897108;7092.397146242627;7114.644267786486;7208;7247.9637601813765;7326.194118647051;6851.349121833618;6911.861762764817;6923.446124310144;7153.248908864494;7205.675744591401;6670.599764014175;6678.766243181465;6719.092922455406;6729.427998619976;6735.663216839236;4807.495213002724;4959.181735013683;4961.950380496149;4981.252812078217;5017.37282839645;4918.213085906238;4970.136198925403;5042.29407882904;5138.3833939927445;5147.150720131136 13:33:38 INFO - PROCESS | 14291 | |4;prototype.html;341.6481024544718;346.65680975833925;351.43594530778086;352.30716407661185;361.92761447710467;5250.133727934891;5328.174133009385;5392.757325920338;5394.406615272317;5427.945720542793;5330.706811125387;5357.785688572462;5367.436419175989;5397.325334333208;5397.730113494319;4012.4351502913887;4245.214635292473;4268.658507319423;4269.359596060584;4286.585426809145;3803.6386543278345;4129.132882094764;4136.66906647469;4142.689298302639;4186;4151.4395556599775;4162.375643653446;4174.436451079111;4193.412922190896;4200.894977625553;4189.8477918572335;4190.224808410454;4192.748435093874;4193.287141186006;4205.789710514493;3535.7524973251884;3581.7850928944085;3642.1440961374055;3716.2381711749026;3724.2737666155112;5208.687478751287;5227.764750586232;5237.764300606482;5244.501772331622;5244.842654720364;4781.832635857763;4798.49615790344;4807.9038419231765;4812.181929072066;4814;5377.4084850666395;5510.6969116698565;5542.63972841764;5594.496495315441;5603.831885043455;4054.7567145971334;4057.959420405817;4069.7354671946227;4074.2666320062376;4075.5924407559305;5536.446355364472;5627;5679.687617181054;5805.82582522525;5806.970965145148;4107.486564179478;4107.774072425986;4123.319652257344;4123.340445412692;4140.834366625361;4146.274401979642;4151.252774500558;4157.251694694924;4172.77049762266;4185.769782661982;4542.977285113553;4749.24012158053;4751.192297309466;4767.451743049524;4768.284757286435;5607.327120745536;5610.242617246619;5623.465770751772;5626.915596266059;5634.549236061105;1396.6997095624286;1404.848024619802;1404.9789253161211;1410.1398147130242;1417.985820141806;928.6099838068028;966.1304825656965;967.3373738988674;969.9563519641633;983.4836710726782;5158.226266060121;5173.3533308336455;5202.3497062867145;5206.947930520722;5207.71357575337;5535.501804837503;5544.22380866679;5544.77820887168;5563.582731295169;5575.832725018256;4997.725125118153;5170.276161337416;5177.767000484987;5182.238039066736;5196.4803519648485;2944.941101178007;2948.557716342523;2953.7784666150123;2954.4386566552284;2969.302213979713;5530.557555395559;5545.863098064887;5558.805441809517;5560.388357280696;5566.693831839207;5392.0294347017125;5625.09998400254;5647.971760141173;5653.265075540236;5682.54539636828;5494.670319780826;5511.145772405283;5537.833864984057;5539.473749993744;5553.500184983371;5423.566114710735;5574.442555744393;5589;5609.719514024201;5618.2415373924;5356.143017117242;5404.78380864761;5452.047265732313;5472.5621950243085;5493.395726470165;5526.50261476469;5564.777408903598;5627.268455100811;5684;5702.45826646468;4104.583918548096;4116.156187981516;4140.213359461693;4149.937750933678;4152.2525945330135;5593.713445907545;5711.8000869969355;5751.424857514216;5759.337676167294;5777.480026797609;5553.250311207935;5613.550915926634;5625.987322281865;5627.803026894203;5631.6902570359025;5598.468145526169;5599.944000560105;5610.943890561205;5622.437756224344;5626;5407.891842163213;5562.360328562268;5572.60991730575;5580.302462192226;5580.330360356783;5615.298087739033;5624.85937851557;5644.238027866186;5645.435456454322;5659.207710920557;5310.522053015247;5550.862073274888;5556.972215138899;5564.944350556442;5565.888682226414 13:33:38 INFO - PROCESS | 14291 | |5;yui.html;767.2212704105334;770.4260326057089;789.8894154818327;792.5918152151642;801.53911500887;13153.605391838237;13242.139260948032;13748.175109493437;14017.229052402126;14595.270236488173;13114.082014259006;13193.010524210698;13214.471421143167;13222.20666759995;13230.933845330785;824.7649419915325;837.1042984007099;843.8565443874526;852.8550146475114;854.2866706300216;855.1533981358473;856.8372009318241;856.9614367353485;858.0518527027638;858.0818524179131;902.8284625921054;907.2469850024464;908.1554154636186;908.1644886704215;908.27791905435;901.603294550399;902.3007169443669;902.4359775140537;903.250302249135;903.4759839293259;665.1419668627465;665.2549144957678;666.1872515531045;666.3436515032689;666.3969107957306;12831;12920;12923.935380323132;12936.641652626528;12950.417231224523;12614.495420183182;12660.68348291291;12877.806832897513;13116.6720831979;13207.40566674502;11854.525818967231;11970.640880773592;12030.218035827731;12073.637790866289;12167.14829961903;3725.124595720031;3769.512121999467;3786.6970642348547;3795.9240815183543;3838.0788610733503;64081.35918640801;65529.672351638415;66912.6654366725;68365.65817170883;68524.6573767128;10081.243906706879;10189.796204076025;10248.64129755455;10388.740281493023;10524.31591946521;17441.215145318492;18164.818351816313;18239.635207296044;18308.816911830712;18348.357807476674;7968.282854543119;8177.5502347370275;8292.212239837207;8327.541985190872;8349.499030058216;4446.244138496463;4453.665975051884;4509.413776209072;4513.323001549794;4678.883027924329;3477.3045390921916;3557.4308110702164;3559.5728512578658;3561.6438356164695;3564.1446052947626;642.4828013449124;666.776629829003;672.3982036077781;678.2166597579704;688.9931100689029;690.7478770248823;702.3362922038624;704.4258928972973;717.8636059148745;731.0678884422404;8835.558222089;9112.544372781467;9169.495677737788;9367.578458969363;9540.379875308083;492.1706923833352;513.4480433533965;527.3250239693199;527.5805734441052;562.3869981719945;4377.846775362847;4569.177548041384;4575.679702420799;4612.262038073892;4671.0891376182;84205.57897210475;85097.14902851016;85639;87224.5638771802;88236.5588172055;80092;82090.58954705189;82481;85184.57407713046;85738.57130714307;48781.75609122003;68756.31243687498;69722.30277697259;70377.29622703708;72964;8375.162483751576;8675.58561694927;8729.738107856774;8747.431416957877;8839.823203535765;48552;50024;50273.24590131224;50603.74698126633;51431.22853157281;63091;65783.67108164428;67223.66388168224;67450;68294;11101.666949991513;11239.55041798319;11265.887341126483;11450.599229026944;11472.082233421139;12464.688382790502;12638.620841374774;12701.93649031749;12790.168639038433;12845.486180552673;10852.131829453783;11365.261258018203;11461.770764584828;11917.582884598998;11963.401829908644;11211;11341.319520828776;11411.429428528374;11420.200585959235;11542.94228528852;11407.372594507382;11422.714432138931;11435;11590.362530060927;11626.302421854716;9529.809403812023;9543.236541076558;9742.659006934724;9773.267004974514;9813.55838987233;9394.201492873182;9842.11420972116;9901.059190031152;9926.305158639116;9975.102240798364 13:33:38 INFO - PROCESS | 14291 | __end_tp_report 13:33:38 INFO - PROCESS | 14291 | __start_cc_report 13:33:38 INFO - PROCESS | 14291 | _x_x_mozilla_cycle_collect,1032 13:33:38 INFO - PROCESS | 14291 | __end_cc_report 13:33:38 INFO - PROCESS | 14291 | __startTimestamp1479677618460__endTimestamp 13:33:38 INFO - PROCESS | 14291 | 13:33:38 INFO - PROCESS | 14291 | ------- Summary: start ------- 13:33:38 INFO - PROCESS | 14291 | Number of tests: 6 13:33:38 INFO - PROCESS | 14291 | 13:33:38 INFO - PROCESS | 14291 | [#0] dojo.html Cycles:165 Average:5587.87 Median:5804.97 stddev:625.99 (10.8%) stddev-sans-first:599.26 13:33:38 INFO - PROCESS | 14291 | Values: 3201.6 3221.5 3240.5 3259.9 3278.3 5585.4 5648.0 5657.9 5662.3 5667.3 5660.6 5717.4 5719.2 5720.9 5745.8 5116.5 5176.6 5195.5 5217.0 5265.4 5052.5 5279.6 5292.6 5292.8 5306.0 5044.5 5083.0 5138.3 5139.6 5193.4 5120.0 5159.8 5163.3 5227.5 5243.1 5085.8 5125.8 5190.8 5217.2 5237.0 5437.3 5439.2 5480.6 5494.1 5501.1 5961.5 5970.5 5991.9 6094.1 6104.5 6139.2 6155.8 6159.4 6166.0 6168.5 5524.9 5525.4 5561.7 5583.9 5650.5 6106.8 6130.7 6139.0 6139.0 6141.3 5871.3 5877.8 5880.4 5880.5 5885.6 5805.0 5865.3 5967.8 6018.8 6030.1 6067.4 6070.2 6072.4 6093.2 6104.0 6027.3 6076.7 6087.3 6087.4 6098.5 4483.1 4512.4 4554.3 4561.5 4674.7 4106.8 4112.5 4133.3 4144.2 4170.6 5574.2 5574.4 5586.2 5592.6 5611.4 5852.1 5853.9 5976.6 6013.7 6028.2 5572.7 5662.1 5672.9 5686.8 5701.1 5184.1 5189.0 5194.5 5197.1 5208.4 5787.1 5912.9 6078.4 6081.6 6105.5 5991.1 6031.8 6060.5 6142.2 6143.5 6083.8 6089.9 6089.9 6093.3 6108.4 5726.9 5987.2 5990.2 5993.4 5998.2 5814.9 5988.0 6027.2 6035.5 6118.7 5883.7 5926.7 5930.0 5937.2 5938.2 5915.8 5927.6 5928.5 5929.4 5931.7 5617.4 5742.2 5758.7 5818.9 5831.9 5985.6 5998.9 6001.2 6004.8 6016.4 5659.2 5702.3 5840.4 5855.8 5867.1 13:33:38 INFO - PROCESS | 14291 | 13:33:38 INFO - PROCESS | 14291 | [#1] ext.html Cycles:180 Average:60819.10 Median:21095.89 stddev:117423.95 (556.6%) stddev-sans-first:117666.23 13:33:38 INFO - PROCESS | 14291 | Values: 569.9 606.5 621.8 625.9 647.1 34379.0 45206.8 46017.5 46191.3 46647.8 46789.0 47268.3 47293.0 47708.3 47765.0 8270.9 8422.4 8939.6 9093.9 9104.3 10614.6 10852.2 10854.2 11139.5 11140.9 10899.3 10984.7 10990.7 10991.2 10999.7 8367.4 8469.8 10633.7 10716.4 10814.2 10761.2 10804.2 10829.1 10832.3 10846.3 43025.0 43692.0 43729.8 43732.8 43743.0 3640.6 3806.5 3849.0 3970.8 4178.6 32763.5 32925.3 33016.7 33100.7 33426.5 4178.6 4303.9 4402.8 4496.8 4507.9 369188.0 371249.0 372060.0 372721.0 373764.0 66055.3 66425.0 66702.7 66971.0 67198.7 39725.0 40728.6 40926.0 42742.8 42793.0 18834.0 18998.1 19063.8 19244.0 19260.0 13665.7 13970.2 14394.5 14536.9 14971.9 20818.3 21024.7 21066.4 21113.7 21115.8 7115.7 7291.0 7315.6 7345.3 7395.8 972.2 993.8 994.2 1058.8 1087.1 30736.5 32589.0 32987.0 33076.0 33576.8 1013.3 1117.1 1138.2 1142.7 1200.2 16052.5 17601.8 17802.4 18611.5 19066.9 523929.0 529275.0 531533.0 532578.0 533969.0 62814.7 63558.0 63568.7 63664.0 63699.7 1287.3 1348.1 1362.5 1408.2 1411.4 30009.5 34514.5 34653.0 34959.3 35025.5 54256.7 55010.4 55040.4 55082.7 55223.4 412287.0 414796.0 414917.0 414917.0 417696.0 30577.0 31393.2 31402.7 31671.2 33114.3 50270.7 50435.2 50503.2 50511.7 51320.5 41673.4 41879.0 42723.4 43252.8 44255.3 35761.6 37534.1 37541.6 38385.2 38461.2 42736.3 43206.8 43223.6 44027.1 44090.0 31431.8 33624.3 33799.5 33940.8 34192.3 29210.3 29361.6 29382.7 29415.7 29522.9 13:33:38 INFO - PROCESS | 14291 | 13:33:38 INFO - PROCESS | 14291 | [#2] jquery.html Cycles:180 Average:29256.18 Median:2593.22 stddev:80026.95 (3086.0%) stddev-sans-first:80222.09 13:33:38 INFO - PROCESS | 14291 | Values: 386.2 424.4 427.2 430.4 443.2 14670.5 19276.5 19393.2 20638.3 20791.5 19711.6 19966.3 20038.6 20238.6 20542.0 5543.8 5807.7 5808.3 5808.3 5811.1 5487.3 5607.3 5728.2 5745.0 5749.5 5722.5 5722.6 5723.7 5726.1 5727.9 5457.0 5572.4 5576.9 5601.5 5603.7 4900.9 5064.9 5066.0 5067.9 5069.8 23862.3 24252.4 24475.6 24628.8 24924.0 2529.7 2656.8 2731.9 2816.5 2841.9 14924.2 15145.4 15258.6 15400.2 15794.8 1931.9 1932.4 1938.4 1961.2 1995.6 80949.0 81074.6 81420.0 81459.0 81801.0 11016.6 11092.9 11115.9 11404.7 11409.4 16100.4 16315.5 16330.8 16368.8 16380.2 8825.2 8920.4 9008.9 9144.8 9212.5 8859.6 8863.9 8871.2 9004.8 9099.7 6781.7 6972.1 7005.0 7023.9 7065.2 1944.2 1980.6 1992.2 1992.9 2010.1 973.5 984.8 996.0 998.1 1028.6 20015.8 20616.5 20648.0 20713.9 20725.0 1022.0 1048.9 1072.8 1078.3 1083.9 10826.6 10913.2 11823.3 11889.4 11929.0 462101.0 486736.0 490144.0 491213.0 495484.0 91598.5 94185.1 94185.5 94436.0 95146.5 1050.7 1083.5 1086.0 1128.8 1129.4 14286.8 17949.9 18269.2 18329.6 18564.9 43487.0 43937.6 43964.8 44019.8 44160.6 53623.7 56815.7 56900.7 57145.7 57879.0 7604.5 7881.6 8035.0 8430.6 8565.8 12378.6 12656.7 12942.2 13051.2 13437.6 11015.9 11193.2 11440.8 11491.4 11562.3 10874.4 11192.6 11247.4 11416.8 11480.3 11084.6 11504.9 11637.6 11670.7 12093.0 8028.8 8136.4 8184.2 8213.0 8240.3 8531.0 10685.7 10852.6 10853.5 11166.9 13:33:38 INFO - PROCESS | 14291 | 13:33:38 INFO - PROCESS | 14291 | [#3] mootools.html Cycles:180 Average:5471.44 Median:4975.69 stddev:2979.41 (59.9%) stddev-sans-first:2972.80 13:33:38 INFO - PROCESS | 14291 | Values: 1497.7 1515.5 1646.7 1787.8 1814.2 7873.4 8443.5 8450.2 8455.7 8458.4 7519.9 7709.3 7728.0 7803.9 8322.4 2354.9 2401.8 2403.1 2406.4 2408.4 2394.4 2411.3 2468.0 2470.2 2477.3 2399.4 2410.1 2424.0 2431.9 2434.6 2336.6 2352.5 2359.0 2365.2 2371.8 2331.7 2335.2 2354.8 2357.0 2358.4 8067.4 8225.5 8336.4 8344.0 8345.9 5177.1 5316.7 5324.5 5331.3 5332.8 3334.0 3338.3 3387.9 3402.5 3415.4 1120.2 1127.8 1150.5 1170.9 1170.9 10907.3 10923.3 10949.8 10951.3 10954.2 4313.3 4338.9 4421.3 4448.5 4480.5 8955.6 8958.2 9044.8 9057.8 9058.1 5027.2 5030.4 5040.2 5048.6 5048.9 4278.1 4395.6 4743.2 4821.4 4842.9 3784.7 3797.8 3810.9 3862.7 3882.7 1128.3 1144.7 1157.9 1159.1 1161.1 973.0 982.9 994.3 1000.3 1011.8 5620.2 5655.4 5703.4 5707.2 5722.7 450.6 459.2 470.6 483.0 483.3 3927.9 3968.7 4033.7 4055.2 4061.9 9814.4 10215.3 10278.3 10291.0 10327.4 10118.0 10120.1 10126.5 10129.4 10144.1 7500.2 7745.5 7872.6 7874.2 7886.7 5879.1 5924.7 5952.6 5955.8 5980.9 9201.1 9309.3 9315.8 9331.5 9357.0 9443.7 9456.2 9585.9 9620.0 9833.6 6833.8 6905.6 7100.7 7467.4 7610.8 7700.7 8042.9 8042.9 8044.8 8047.5 7092.4 7114.6 7208.0 7248.0 7326.2 6851.3 6911.9 6923.4 7153.2 7205.7 6670.6 6678.8 6719.1 6729.4 6735.7 4807.5 4959.2 4962.0 4981.3 5017.4 4918.2 4970.1 5042.3 5138.4 5147.2 13:33:38 INFO - PROCESS | 14291 | 13:33:38 INFO - PROCESS | 14291 | [#4] prototype.html Cycles:180 Average:4655.51 Median:5362.61 stddev:1343.18 (25.0%) stddev-sans-first:1307.34 13:33:38 INFO - PROCESS | 14291 | Values: 341.6 346.7 351.4 352.3 361.9 5250.1 5328.2 5392.8 5394.4 5427.9 5330.7 5357.8 5367.4 5397.3 5397.7 4012.4 4245.2 4268.7 4269.4 4286.6 3803.6 4129.1 4136.7 4142.7 4186.0 4151.4 4162.4 4174.4 4193.4 4200.9 4189.8 4190.2 4192.7 4193.3 4205.8 3535.8 3581.8 3642.1 3716.2 3724.3 5208.7 5227.8 5237.8 5244.5 5244.8 4781.8 4798.5 4807.9 4812.2 4814.0 5377.4 5510.7 5542.6 5594.5 5603.8 4054.8 4058.0 4069.7 4074.3 4075.6 5536.4 5627.0 5679.7 5805.8 5807.0 4107.5 4107.8 4123.3 4123.3 4140.8 4146.3 4151.3 4157.3 4172.8 4185.8 4543.0 4749.2 4751.2 4767.5 4768.3 5607.3 5610.2 5623.5 5626.9 5634.5 1396.7 1404.8 1405.0 1410.1 1418.0 928.6 966.1 967.3 970.0 983.5 5158.2 5173.4 5202.3 5206.9 5207.7 5535.5 5544.2 5544.8 5563.6 5575.8 4997.7 5170.3 5177.8 5182.2 5196.5 2944.9 2948.6 2953.8 2954.4 2969.3 5530.6 5545.9 5558.8 5560.4 5566.7 5392.0 5625.1 5648.0 5653.3 5682.5 5494.7 5511.1 5537.8 5539.5 5553.5 5423.6 5574.4 5589.0 5609.7 5618.2 5356.1 5404.8 5452.0 5472.6 5493.4 5526.5 5564.8 5627.3 5684.0 5702.5 4104.6 4116.2 4140.2 4149.9 4152.3 5593.7 5711.8 5751.4 5759.3 5777.5 5553.3 5613.6 5626.0 5627.8 5631.7 5598.5 5599.9 5610.9 5622.4 5626.0 5407.9 5562.4 5572.6 5580.3 5580.3 5615.3 5624.9 5644.2 5645.4 5659.2 5310.5 5550.9 5557.0 5564.9 5565.9 13:33:38 INFO - PROCESS | 14291 | 13:33:38 INFO - PROCESS | 14291 | [#5] yui.html Cycles:180 Average:17748.78 Median:31826.69 stddev:24368.24 (76.6%) stddev-sans-first:24403.24 13:33:38 INFO - PROCESS | 14291 | Values: 767.2 770.4 789.9 792.6 801.5 13153.6 13242.1 13748.2 14017.2 14595.3 13114.1 13193.0 13214.5 13222.2 13230.9 824.8 837.1 843.9 852.9 854.3 855.2 856.8 857.0 858.1 858.1 902.8 907.2 908.2 908.2 908.3 901.6 902.3 902.4 903.3 903.5 665.1 665.3 666.2 666.3 666.4 12831.0 12920.0 12923.9 12936.6 12950.4 12614.5 12660.7 12877.8 13116.7 13207.4 11854.5 11970.6 12030.2 12073.6 12167.1 3725.1 3769.5 3786.7 3795.9 3838.1 64081.4 65529.7 66912.7 68365.7 68524.7 10081.2 10189.8 10248.6 10388.7 10524.3 17441.2 18164.8 18239.6 18308.8 18348.4 7968.3 8177.6 8292.2 8327.5 8349.5 4446.2 4453.7 4509.4 4513.3 4678.9 3477.3 3557.4 3559.6 3561.6 3564.1 642.5 666.8 672.4 678.2 689.0 690.7 702.3 704.4 717.9 731.1 8835.6 9112.5 9169.5 9367.6 9540.4 492.2 513.4 527.3 527.6 562.4 4377.8 4569.2 4575.7 4612.3 4671.1 84205.6 85097.1 85639.0 87224.6 88236.6 80092.0 82090.6 82481.0 85184.6 85738.6 48781.8 68756.3 69722.3 70377.3 72964.0 8375.2 8675.6 8729.7 8747.4 8839.8 48552.0 50024.0 50273.2 50603.7 51431.2 63091.0 65783.7 67223.7 67450.0 68294.0 11101.7 11239.6 11265.9 11450.6 11472.1 12464.7 12638.6 12701.9 12790.2 12845.5 10852.1 11365.3 11461.8 11917.6 11963.4 11211.0 11341.3 11411.4 11420.2 11542.9 11407.4 11422.7 11435.0 11590.4 11626.3 9529.8 9543.2 9742.7 9773.3 9813.6 9394.2 9842.1 9901.1 9926.3 9975.1 13:33:38 INFO - PROCESS | 14291 | -------- Summary: end -------- 13:33:38 INFO - PROCESS | 14291 | 13:33:39 INFO - TEST-INFO | 14291: exit 0 13:33:39 INFO - TEST-OK | dromaeo_css | took 1115071ms 13:33:39 INFO - TEST-START | kraken 13:33:39 INFO - operating with platform_type : linux_ 13:33:39 INFO - Initialising browser for kraken test... 13:33:39 INFO - TEST-INFO | started process 14613 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpN2BZab/profile http://localhost:46537/getInfo.html) 13:33:42 ERROR - PROCESS | 14613 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 5373: TypeError: parent.firstChild is null 13:33:43 INFO - PROCESS | 14613 | __metrics Screen width/height:1600/1200 13:33:43 INFO - PROCESS | 14613 | colorDepth:24 13:33:43 INFO - PROCESS | 14613 | Browser inner width/height: 1024/697 13:33:43 INFO - PROCESS | 14613 | __metrics 13:33:43 INFO - PROCESS | 14613 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 13:33:43 INFO - PROCESS | 14613 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 211: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 13:33:44 INFO - PROCESS | 14613 | console.error: PushService: 13:33:44 INFO - PROCESS | 14613 | stateChangeProcessEnqueue: Error transitioning state 13:33:44 INFO - PROCESS | 14613 | UnknownError 13:33:44 INFO - TEST-INFO | 14613: exit 0 13:33:44 INFO - Browser initialized. 13:33:44 INFO - Running cycle 1/1 for kraken test... 13:33:44 INFO - TEST-INFO | started process 14705 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpN2BZab/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:33:56 INFO - PROCESS | 14705 | RSS: Main: 144326656 13:33:56 INFO - PROCESS | 14705 | 13:33:59 INFO - PROCESS | 14705 | Cycle 1(1): loaded http://localhost:46537/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:46537/tests/kraken/driver.html?testName=audio-beat-detection) 13:33:59 INFO - PROCESS | 14705 | RSS: Main: 186507264 13:33:59 INFO - PROCESS | 14705 | 13:34:02 INFO - PROCESS | 14705 | Cycle 1(1): loaded http://localhost:46537/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:46537/tests/kraken/driver.html?testName=audio-dft) 13:34:03 INFO - PROCESS | 14705 | RSS: Main: 175693824 13:34:03 INFO - PROCESS | 14705 | 13:34:05 INFO - PROCESS | 14705 | Cycle 1(1): loaded http://localhost:46537/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:46537/tests/kraken/driver.html?testName=audio-fft) 13:34:06 INFO - PROCESS | 14705 | RSS: Main: 266776576 13:34:06 INFO - PROCESS | 14705 | 13:34:08 INFO - PROCESS | 14705 | Cycle 1(1): loaded http://localhost:46537/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:46537/tests/kraken/driver.html?testName=audio-oscillator) 13:34:09 INFO - PROCESS | 14705 | RSS: Main: 172818432 13:34:09 INFO - PROCESS | 14705 | 13:34:11 INFO - PROCESS | 14705 | Cycle 1(1): loaded http://localhost:46537/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:46537/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:34:11 INFO - PROCESS | 14705 | RSS: Main: 175128576 13:34:11 INFO - PROCESS | 14705 | 13:34:14 INFO - PROCESS | 14705 | Cycle 1(1): loaded http://localhost:46537/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:46537/tests/kraken/driver.html?testName=imaging-darkroom) 13:34:15 INFO - PROCESS | 14705 | RSS: Main: 214687744 13:34:15 INFO - PROCESS | 14705 | 13:34:18 INFO - PROCESS | 14705 | Cycle 1(1): loaded http://localhost:46537/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:46537/tests/kraken/driver.html?testName=imaging-desaturate) 13:34:19 INFO - PROCESS | 14705 | RSS: Main: 213159936 13:34:19 INFO - PROCESS | 14705 | 13:34:21 INFO - PROCESS | 14705 | Cycle 1(1): loaded http://localhost:46537/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:46537/tests/kraken/driver.html?testName=json-parse-financial) 13:34:22 INFO - PROCESS | 14705 | RSS: Main: 212488192 13:34:22 INFO - PROCESS | 14705 | 13:34:23 INFO - PROCESS | 14705 | Cycle 1(1): loaded http://localhost:46537/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:46537/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:34:24 INFO - PROCESS | 14705 | RSS: Main: 174182400 13:34:24 INFO - PROCESS | 14705 | 13:34:26 INFO - PROCESS | 14705 | Cycle 1(1): loaded http://localhost:46537/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:46537/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:34:26 INFO - PROCESS | 14705 | RSS: Main: 181301248 13:34:26 INFO - PROCESS | 14705 | 13:34:28 INFO - PROCESS | 14705 | Cycle 1(1): loaded http://localhost:46537/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:46537/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:34:29 INFO - PROCESS | 14705 | RSS: Main: 190607360 13:34:29 INFO - PROCESS | 14705 | 13:34:31 INFO - PROCESS | 14705 | Cycle 1(1): loaded http://localhost:46537/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:46537/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:34:32 INFO - PROCESS | 14705 | RSS: Main: 199073792 13:34:32 INFO - PROCESS | 14705 | 13:34:35 INFO - PROCESS | 14705 | Cycle 1(1): loaded http://localhost:46537/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:46537/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:34:35 INFO - PROCESS | 14705 | RSS: Main: 195403776 13:34:35 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | Cycle 1(1): loaded http://localhost:46537/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:46537/tests/kraken/driver.html?testName=ai-astar) 13:34:37 INFO - PROCESS | 14705 | RSS: Main: 246136832 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | __start_tp_report 13:34:37 INFO - PROCESS | 14705 | _x_x_mozilla_page_load 13:34:37 INFO - PROCESS | 14705 | _x_x_mozilla_page_load_details 13:34:37 INFO - PROCESS | 14705 | |i|pagename|runs| 13:34:37 INFO - PROCESS | 14705 | |0;ai-astar;102;112;111;110;111;112;111;110;111;111 13:34:37 INFO - PROCESS | 14705 | |1;audio-beat-detection;145;120;124;159;121;127;120;120;152;122 13:34:37 INFO - PROCESS | 14705 | |2;audio-dft;160;159;160;161;159;161;159;161;159;160 13:34:37 INFO - PROCESS | 14705 | |3;audio-fft;76;76;76;107;76;76;76;76;98;75 13:34:37 INFO - PROCESS | 14705 | |4;audio-oscillator;81;81;111;82;82;82;99;82;82;108 13:34:37 INFO - PROCESS | 14705 | |5;imaging-gaussian-blur;117;117;119;117;117;117;116;117;117;117 13:34:37 INFO - PROCESS | 14705 | |6;imaging-darkroom;146;146;146;146;145;146;146;146;145;145 13:34:37 INFO - PROCESS | 14705 | |7;imaging-desaturate;84;84;84;85;84;85;85;85;85;85 13:34:37 INFO - PROCESS | 14705 | |8;json-parse-financial;50;50;49;51;50;49;49;50;50;50 13:34:37 INFO - PROCESS | 14705 | |9;json-stringify-tinderbox;58;60;59;59;59;59;58;59;59;59 13:34:37 INFO - PROCESS | 14705 | |10;stanford-crypto-aes;75;74;75;75;74;75;81;73;80;74 13:34:37 INFO - PROCESS | 14705 | |11;stanford-crypto-ccm;138;132;127;127;127;126;124;134;163;140 13:34:37 INFO - PROCESS | 14705 | |12;stanford-crypto-pbkdf2;153;155;153;155;153;154;154;154;155;152 13:34:37 INFO - PROCESS | 14705 | |13;stanford-crypto-sha256-iterative;65;61;64;61;61;62;60;62;60;63 13:34:37 INFO - PROCESS | 14705 | __end_tp_report 13:34:37 INFO - PROCESS | 14705 | __start_cc_report 13:34:37 INFO - PROCESS | 14705 | _x_x_mozilla_cycle_collect,1610 13:34:37 INFO - PROCESS | 14705 | __end_cc_report 13:34:37 INFO - PROCESS | 14705 | __startTimestamp1479677677823__endTimestamp 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | ------- Summary: start ------- 13:34:37 INFO - PROCESS | 14705 | Number of tests: 14 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | [#0] ai-astar Cycles:10 Average:110.10 Median:111.00 stddev:2.92 (2.6%) stddev-sans-first:0.71 13:34:37 INFO - PROCESS | 14705 | Values: 102.0 112.0 111.0 110.0 111.0 112.0 111.0 110.0 111.0 111.0 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | [#1] audio-beat-detection Cycles:10 Average:131.00 Median:125.50 stddev:15.02 (12.0%) stddev-sans-first:15.05 13:34:37 INFO - PROCESS | 14705 | Values: 145.0 120.0 124.0 159.0 121.0 127.0 120.0 120.0 152.0 122.0 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | [#2] audio-dft Cycles:10 Average:159.90 Median:160.00 stddev:0.88 (0.5%) stddev-sans-first:0.93 13:34:37 INFO - PROCESS | 14705 | Values: 160.0 159.0 160.0 161.0 159.0 161.0 159.0 161.0 159.0 160.0 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | [#3] audio-fft Cycles:10 Average:81.20 Median:76.00 stddev:11.43 (15.0%) stddev-sans-first:11.97 13:34:37 INFO - PROCESS | 14705 | Values: 76.0 76.0 76.0 107.0 76.0 76.0 76.0 76.0 98.0 75.0 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | [#4] audio-oscillator Cycles:10 Average:89.00 Median:82.00 stddev:12.10 (14.8%) stddev-sans-first:12.48 13:34:37 INFO - PROCESS | 14705 | Values: 81.0 81.0 111.0 82.0 82.0 82.0 99.0 82.0 82.0 108.0 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | [#5] imaging-gaussian-blur Cycles:10 Average:117.10 Median:117.00 stddev:0.74 (0.6%) stddev-sans-first:0.78 13:34:37 INFO - PROCESS | 14705 | Values: 117.0 117.0 119.0 117.0 117.0 117.0 116.0 117.0 117.0 117.0 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | [#6] imaging-darkroom Cycles:10 Average:145.70 Median:146.00 stddev:0.48 (0.3%) stddev-sans-first:0.50 13:34:37 INFO - PROCESS | 14705 | Values: 146.0 146.0 146.0 146.0 145.0 146.0 146.0 146.0 145.0 145.0 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | [#7] imaging-desaturate Cycles:10 Average:84.60 Median:85.00 stddev:0.52 (0.6%) stddev-sans-first:0.50 13:34:37 INFO - PROCESS | 14705 | Values: 84.0 84.0 84.0 85.0 84.0 85.0 85.0 85.0 85.0 85.0 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | [#8] json-parse-financial Cycles:10 Average:49.80 Median:50.00 stddev:0.63 (1.3%) stddev-sans-first:0.67 13:34:37 INFO - PROCESS | 14705 | Values: 50.0 50.0 49.0 51.0 50.0 49.0 49.0 50.0 50.0 50.0 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | [#9] json-stringify-tinderbox Cycles:10 Average:58.90 Median:59.00 stddev:0.57 (1.0%) stddev-sans-first:0.50 13:34:37 INFO - PROCESS | 14705 | Values: 58.0 60.0 59.0 59.0 59.0 59.0 58.0 59.0 59.0 59.0 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | [#10] stanford-crypto-aes Cycles:10 Average:75.60 Median:75.00 stddev:2.67 (3.6%) stddev-sans-first:2.83 13:34:37 INFO - PROCESS | 14705 | Values: 75.0 74.0 75.0 75.0 74.0 75.0 81.0 73.0 80.0 74.0 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | [#11] stanford-crypto-ccm Cycles:10 Average:133.80 Median:133.00 stddev:11.58 (8.7%) stddev-sans-first:12.19 13:34:37 INFO - PROCESS | 14705 | Values: 138.0 132.0 127.0 127.0 127.0 126.0 124.0 134.0 163.0 140.0 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:153.80 Median:154.00 stddev:1.03 (0.7%) stddev-sans-first:1.05 13:34:37 INFO - PROCESS | 14705 | Values: 153.0 155.0 153.0 155.0 153.0 154.0 154.0 154.0 155.0 152.0 13:34:37 INFO - PROCESS | 14705 | 13:34:37 INFO - PROCESS | 14705 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:61.90 Median:62.00 stddev:1.66 (2.7%) stddev-sans-first:1.33 13:34:37 INFO - PROCESS | 14705 | Values: 65.0 61.0 64.0 61.0 61.0 62.0 60.0 62.0 60.0 63.0 13:34:37 INFO - PROCESS | 14705 | -------- Summary: end -------- 13:34:37 INFO - PROCESS | 14705 | 13:34:39 INFO - TEST-INFO | 14705: exit 0 13:34:39 INFO - TEST-OK | kraken | took 59781ms 13:34:39 INFO - SUITE-END | took 1174s 13:34:39 INFO - Completed test suite (00:19:35) 13:34:39 INFO - javascript benchmark 13:34:39 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3201.5517827504145, 3221.5006673965545, 3240.5301231321446, 3259.853306601203, 3278.3443311337724, 5585.357683866351, 5648.039833228351, 5657.886842263162, 5662.348829884564, 5667.291588551426, 5660.575456840743, 5717.371089180187, 5719.19931209631, 5720.856978575527, 5745.827625171241, 5116.488351164881, 5176.637635365526, 5195.506426889458, 5217.0, 5265.420803711589, 5052.469490703478, 5279.604029697769, 5292.603054770889, 5292.841214763544, 5305.973470132644, 5044.4955504449445, 5083.0, 5138.306328645623, 5139.563137133329, 5193.402758682762, 5119.950410165926, 5159.819406320798, 5163.302954101186, 5227.529522343008, 5243.134882744343, 5085.771140298695, 5125.794968201268, 5190.766415511273, 5217.243499692523, 5236.973815130938, 5437.293151890269, 5439.211314359396, 5480.616356855022, 5494.148406996882, 5501.119820828688, 5961.493273071794, 5970.492508136814, 5991.940080599225, 6094.146819445281, 6104.511639068864, 6139.2325959255095, 6155.846103847395, 6159.445649891486, 6166.044263139176, 6168.506519478476, 5524.889502209933, 5525.419830917736, 5561.721913904288, 5583.916241256344, 5650.519705824969, 6106.786262480792, 6130.6628135452975, 6138.969305153446, 6139.017757158833, 6141.324454310023, 5871.266091738533, 5877.764889404461, 5880.382559831241, 5880.529557635379, 5885.588008839341, 5804.970975145182, 5865.266841644794, 5967.761289548456, 6018.849528761816, 6030.125631783367, 6067.393260673897, 6070.180525629072, 6072.36240194782, 6093.2078829751845, 6104.023356263066, 6027.336992930774, 6076.696165191811, 6087.269527656709, 6087.391260873966, 6098.481629061491, 4483.125790470892, 4512.368268442421, 4554.316852472156, 4561.475430325555, 4674.719516828933, 4106.753594784323, 4112.506499220112, 4133.256013917464, 4144.233316836335, 4170.603792639695, 5574.219609254707, 5574.442555744393, 5586.24585680936, 5592.5805564582815, 5611.382747897728, 5852.063669812809, 5853.94146058534, 5976.61152025117, 6013.699315034319, 6028.156058151862, 5572.749226284827, 5662.065759149694, 5672.858178545487, 5686.772529098873, 5701.059325211294, 5184.14461613837, 5189.0, 5194.480551944851, 5197.090509160882, 5208.406129885719, 5787.102999035156, 5912.881742365043, 6078.422549857668, 6081.604695694766, 6105.542084343692, 5991.101334799815, 6031.819045428644, 6060.515158787374, 6142.191841058572, 6143.481172719164, 6083.756649733961, 6089.908651370144, 6089.939100608937, 6093.268807743099, 6108.389161083856, 5726.942730572641, 5987.161797348462, 5990.161377407079, 5993.400659933972, 5998.160257563857, 5814.94185058144, 5988.0, 6027.186329845415, 6035.517158627212, 6118.694065296806, 5883.676397798162, 5926.674032928058, 5929.970350148222, 5937.168796368425, 5938.168656388023, 5915.822525324247, 5927.614705044159, 5928.4960778334325, 5929.377415371324, 5931.673757943182, 5617.43825617435, 5742.16738572913, 5758.712064396847, 5818.854528636818, 5831.854203644943, 5985.6408615483215, 5998.9100163496705, 6001.189839371804, 6004.789832355847, 6016.368281330572, 5659.179418984307, 5702.258706368146, 5840.415958404125, 5855.7950471734985, 5867.090600956859], "value": 5545.906861814889, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [569.9401562835902, 606.4693393280879, 621.8321053315607, 625.9374062593741, 647.0908373734904, 34379.0, 45206.77396613017, 46017.53982460174, 46191.30713039307, 46647.76676116619, 46789.0, 47268.29097563539, 47293.0, 47708.284375734394, 47765.0, 8270.917290827105, 8422.368322375816, 8939.553022348873, 9093.909060909406, 9104.271658267322, 10614.57541698335, 10852.186086043579, 10854.24020318578, 11139.498722557464, 11140.888591114106, 10899.346039237631, 10984.670459886176, 10990.725231869228, 10991.230613857033, 10999.670009899675, 8367.372447066464, 8469.83060338796, 10633.73415664607, 10716.35701857887, 10814.188935829765, 10761.246712730112, 10804.18968577352, 10829.133669306437, 10832.295900766425, 10846.349219046804, 43025.0, 43692.0, 43729.781351093356, 43732.78133609312, 43743.0, 3640.6359364063646, 3806.54321481424, 3848.9807550962346, 3970.8014599269923, 4178.582141785828, 32763.50854737181, 32925.34149317024, 33016.6698333016, 33100.66899331, 33426.49860252098, 4178.582141785828, 4303.892402689927, 4402.823887044515, 4496.820127194941, 4507.932381014288, 369188.0, 371249.0, 372060.0, 372720.99999999726, 373764.0, 66055.33944660588, 66425.0, 66702.66648666725, 66971.0, 67198.66400667965, 39725.0, 40728.59271407248, 40926.0, 42742.78628606837, 42793.0, 18834.0, 18998.145083471278, 19063.809361906482, 19244.03779811004, 19260.036998150037, 13665.726685466236, 13970.231637259845, 14394.496192633207, 14536.854631453762, 14971.850281497263, 20818.27136050231, 21024.684629730567, 21066.368008959755, 21113.68329475059, 21115.788842111382, 7115.679794409264, 7291.0, 7315.561066336037, 7345.3021962913435, 7395.778126656209, 972.2076507646387, 993.7813680990171, 994.1847684898314, 1058.7988282226352, 1087.0596933652334, 30736.52706479305, 32589.0, 32987.0, 33076.0, 33576.83211583975, 1013.3413281367023, 1117.1068825144366, 1138.2430683595483, 1142.6686260984388, 1200.2258543239561, 16052.518424447286, 17601.82398176002, 17802.37691680785, 18611.534711632048, 19066.904665476584, 523929.0, 529275.0, 531533.0, 532578.0, 533969.0, 62814.685926570986, 63558.0, 63568.68215658892, 63664.0, 63699.6815015922, 1287.2791236907362, 1348.1237195822794, 1362.536737509232, 1408.1832537128441, 1411.4072089722342, 30009.549856751728, 34514.482282765275, 34653.0, 34959.30081398409, 35025.474617880245, 54256.72871635616, 55010.44989550213, 55040.44959550353, 55082.72458637681, 55223.44776552344, 412287.0, 414796.0, 414917.0, 414917.0, 417696.0, 30577.0, 31393.215169620944, 31402.685973139975, 31671.20821979469, 33114.33771324512, 50270.748646256536, 50435.243471347225, 50503.24245136399, 50511.74744126256, 51320.48679513157, 41673.37489937714, 41879.0, 42723.3591496134, 43252.78373608112, 44255.336169956834, 35761.64238357583, 37534.10965065786, 37541.624583753815, 38385.23229535449, 38461.230775383774, 42736.30672535451, 43206.783966079965, 43223.56776432321, 44027.11945761131, 44090.0, 31431.842840785648, 33624.32751345008, 33799.49300760441, 33940.83029584836, 34192.31615367629, 29210.269743256587, 29361.559576606796, 29382.70617293885, 29415.705842942152, 29522.852385737933], "value": 20982.528051339348, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [386.2487461886632, 424.4037127835388, 427.1840784102365, 430.38240125420015, 443.1779049862505, 14670.486532971348, 19276.518087047814, 19393.22427102916, 20638.277660281892, 20791.480212994684, 19711.605767884634, 19966.301179458722, 20038.59922801543, 20238.59522809543, 20542.0, 5543.833684989447, 5807.651540907559, 5808.303003639569, 5808.332041815203, 5811.128330750379, 5487.286652735139, 5607.327120745516, 5728.16941543476, 5745.023346031164, 5749.540036797046, 5722.484976352128, 5722.599418040739, 5723.742431590567, 5726.112452569838, 5727.856803579903, 5457.0, 5572.4148964358765, 5576.86057848553, 5601.467860553241, 5603.7478313475995, 4900.877478063041, 5064.898702025976, 5065.974670126662, 5067.8986420271385, 5069.771860266297, 23862.284131476084, 24252.393690157885, 24475.632865507032, 24628.753712463003, 24924.0, 2529.6584961030208, 2656.774174195196, 2731.934545527246, 2816.5352716801704, 2841.8579071046365, 14924.179170145637, 15145.394184232617, 15258.618534536614, 15400.22998850053, 15794.763078553831, 1931.8551108666907, 1932.3526618582791, 1938.4281636917144, 1961.1665042356942, 1995.6407846587608, 80949.0, 81074.59462702708, 81420.0, 81458.9999999994, 81801.0, 11016.559337626566, 11092.889071109346, 11115.944420278009, 11404.714882128013, 11409.42952852354, 16100.436484722979, 16315.51053468398, 16330.836691633169, 16368.83631163673, 16380.180990950405, 8825.161609647073, 8920.420172688884, 9008.909910900938, 9144.81710365789, 9212.53937303132, 8859.557022148867, 8863.911360886308, 8871.157240062184, 9004.774880627905, 9099.727008189764, 6781.660327187113, 6972.1284839395075, 7005.0, 7023.859522809617, 7065.1630576049565, 1944.1542928826007, 1980.63358278716, 1992.2429476799014, 1992.900354982245, 2010.1155491583656, 973.5181085362791, 984.8276551603441, 996.0338471682456, 998.1166667499315, 1028.598846449885, 20015.799842001685, 20616.484587885123, 20648.0, 20713.89643051775, 20725.0, 1021.9693409197736, 1048.926575139733, 1072.8015317166348, 1078.320657985464, 1083.8861919498497, 10826.566937322576, 10913.181511386678, 11823.349715765544, 11889.405529723479, 11929.0, 462101.0, 486736.0, 490144.0, 491213.0, 495484.0, 91598.54200728954, 94185.058149419, 94185.52907235557, 94436.0, 95146.52426737822, 1050.6742909698019, 1083.5394957143183, 1085.9674209773561, 1128.7968165730247, 1129.3619105205532, 14286.785698214328, 17949.910250448665, 18269.17788699538, 18329.633407332047, 18564.907175464035, 43487.0, 43937.56062439334, 43964.7801761002, 44019.779901100286, 44160.558394415646, 53623.73188134035, 56815.71592142178, 56900.71549642225, 57145.71427142838, 57879.0, 7604.5437273763755, 7881.5665138417935, 8035.0, 8430.578471076544, 8565.785855353417, 12378.62864114078, 12656.74686506283, 12942.223466592035, 13051.21692698441, 13437.596872093853, 11015.944920275348, 11193.160512961724, 11440.771184576428, 11491.425428728697, 11562.30626162433, 10874.401907895142, 11192.552297907992, 11247.437628118725, 11416.771664566828, 11480.311181329147, 11084.61203857861, 11504.94247528757, 11637.592684256011, 11670.70823229392, 12093.0, 8028.839423211386, 8136.389770767098, 8184.2224988625985, 8213.0, 8240.299574536231, 8531.0, 10685.679429617125, 10852.620158294421, 10853.45732713377, 11166.922538045445], "value": 9558.247196634768, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1497.7154340675274, 1515.4998850379375, 1646.7447545630423, 1787.785465744111, 1814.192684255506, 7873.37013038957, 8443.451175673577, 8450.197231263035, 8455.70405035824, 8458.407911446202, 7519.887201691979, 7709.3061624453785, 7728.033995750531, 7803.921960780391, 8322.375821813357, 2354.8587084774967, 2401.819863510235, 2403.098837935774, 2406.42245860993, 2408.3617841272076, 2394.4013996500876, 2411.2766170148884, 2467.962980555293, 2470.17249221511, 2477.2568229531157, 2399.4361325088676, 2410.0600765701392, 2423.9757602424015, 2431.878406079689, 2434.586120359534, 2336.6144586143437, 2352.470694093832, 2358.9764102358927, 2365.184011516041, 2371.8102551795814, 2331.720193576765, 2335.241046659842, 2354.835161538693, 2357.0218359380838, 2358.3868194269444, 8067.435279530435, 8225.465344752633, 8336.416450848443, 8343.95828020862, 8345.916540834574, 5177.119889618773, 5316.734163291859, 5324.467553244684, 5331.333583302087, 5332.760025798849, 3333.96666033339, 3338.2989572189626, 3387.915302117442, 3402.5406570112964, 3415.4023045966856, 1120.1934607082887, 1127.7913585986619, 1150.4765331774022, 1170.8887655672697, 1170.9238899471507, 10907.291026083358, 10923.344599323986, 10949.83575246372, 10951.34291942478, 10954.233203675745, 4313.2883074292395, 4338.869833904988, 4421.270490369053, 4448.488423831301, 4480.507144214133, 8955.596998135099, 8958.193762561401, 9044.773880653036, 9057.77355566103, 9058.139476749699, 5027.245913113063, 5030.37120359955, 5040.168372218616, 5048.570871475892, 5048.873778155576, 4278.122984788111, 4395.560443955643, 4743.193657078305, 4821.445533763592, 4842.927356089662, 3784.6593806556994, 3797.8290976906105, 3810.8666196682984, 3862.7102967277565, 3882.6699730522655, 1128.3060917535656, 1144.6794897428733, 1157.9421028948518, 1159.0611604600133, 1161.1117495116243, 972.9610815567439, 982.8967958364411, 994.3039872089422, 1000.3047881722133, 1011.7925825205815, 5620.241267428926, 5655.3779084300695, 5703.40114288002, 5707.229524014205, 5722.656640601577, 450.62372918613323, 459.1757794758417, 470.60469205867236, 483.01706028232377, 483.30404217926076, 3927.9018024549614, 3968.6825053995613, 4033.69747268956, 4055.229506393776, 4061.91876162481, 9814.411135331902, 10215.336003159771, 10278.280520363653, 10291.022352876615, 10327.380357178594, 10118.0, 10120.139788118093, 10126.54430550627, 10129.442880641489, 10144.13774829133, 7500.174980752222, 7745.457817952802, 7872.56700881457, 7874.173211812792, 7886.72396466121, 5879.059350503899, 5924.7037648118285, 5952.553558483044, 5955.791547295824, 5980.850478738066, 9201.125893040151, 9309.301802364715, 9315.813683726152, 9331.53342332867, 9356.95321523388, 9443.669471568463, 9456.243500519804, 9585.856212156963, 9619.951900240454, 9833.557489912828, 6833.794986150423, 6905.551139175937, 7100.715971361088, 7467.402607791472, 7610.771676849703, 7700.730474433368, 8042.879356809535, 8042.87935680977, 8044.758657240292, 8047.51714897108, 7092.397146242627, 7114.644267786486, 7208.0, 7247.9637601813765, 7326.194118647051, 6851.349121833618, 6911.861762764817, 6923.446124310144, 7153.248908864494, 7205.675744591401, 6670.599764014175, 6678.766243181465, 6719.092922455406, 6729.427998619976, 6735.663216839236, 4807.495213002724, 4959.181735013683, 4961.950380496149, 4981.252812078217, 5017.37282839645, 4918.213085906238, 4970.136198925403, 5042.29407882904, 5138.3833939927445, 5147.150720131136], "value": 4394.151963250267, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [341.6481024544718, 346.65680975833925, 351.43594530778086, 352.30716407661185, 361.92761447710467, 5250.133727934891, 5328.174133009385, 5392.757325920338, 5394.406615272317, 5427.945720542793, 5330.706811125387, 5357.785688572462, 5367.436419175989, 5397.325334333208, 5397.730113494319, 4012.4351502913887, 4245.214635292473, 4268.658507319423, 4269.359596060584, 4286.585426809145, 3803.6386543278345, 4129.132882094764, 4136.66906647469, 4142.689298302639, 4186.0, 4151.4395556599775, 4162.375643653446, 4174.436451079111, 4193.412922190896, 4200.894977625553, 4189.8477918572335, 4190.224808410454, 4192.748435093874, 4193.287141186006, 4205.789710514493, 3535.7524973251884, 3581.7850928944085, 3642.1440961374055, 3716.2381711749026, 3724.2737666155112, 5208.687478751287, 5227.764750586232, 5237.764300606482, 5244.501772331622, 5244.842654720364, 4781.832635857763, 4798.49615790344, 4807.9038419231765, 4812.181929072066, 4814.0, 5377.4084850666395, 5510.6969116698565, 5542.63972841764, 5594.496495315441, 5603.831885043455, 4054.7567145971334, 4057.959420405817, 4069.7354671946227, 4074.2666320062376, 4075.5924407559305, 5536.446355364472, 5627.0, 5679.687617181054, 5805.82582522525, 5806.970965145148, 4107.486564179478, 4107.774072425986, 4123.319652257344, 4123.340445412692, 4140.834366625361, 4146.274401979642, 4151.252774500558, 4157.251694694924, 4172.77049762266, 4185.769782661982, 4542.977285113553, 4749.24012158053, 4751.192297309466, 4767.451743049524, 4768.284757286435, 5607.327120745536, 5610.242617246619, 5623.465770751772, 5626.915596266059, 5634.549236061105, 1396.6997095624286, 1404.848024619802, 1404.9789253161211, 1410.1398147130242, 1417.985820141806, 928.6099838068028, 966.1304825656965, 967.3373738988674, 969.9563519641633, 983.4836710726782, 5158.226266060121, 5173.3533308336455, 5202.3497062867145, 5206.947930520722, 5207.71357575337, 5535.501804837503, 5544.22380866679, 5544.77820887168, 5563.582731295169, 5575.832725018256, 4997.725125118153, 5170.276161337416, 5177.767000484987, 5182.238039066736, 5196.4803519648485, 2944.941101178007, 2948.557716342523, 2953.7784666150123, 2954.4386566552284, 2969.302213979713, 5530.557555395559, 5545.863098064887, 5558.805441809517, 5560.388357280696, 5566.693831839207, 5392.0294347017125, 5625.09998400254, 5647.971760141173, 5653.265075540236, 5682.54539636828, 5494.670319780826, 5511.145772405283, 5537.833864984057, 5539.473749993744, 5553.500184983371, 5423.566114710735, 5574.442555744393, 5589.0, 5609.719514024201, 5618.2415373924, 5356.143017117242, 5404.78380864761, 5452.047265732313, 5472.5621950243085, 5493.395726470165, 5526.50261476469, 5564.777408903598, 5627.268455100811, 5684.0, 5702.45826646468, 4104.583918548096, 4116.156187981516, 4140.213359461693, 4149.937750933678, 4152.2525945330135, 5593.713445907545, 5711.8000869969355, 5751.424857514216, 5759.337676167294, 5777.480026797609, 5553.250311207935, 5613.550915926634, 5625.987322281865, 5627.803026894203, 5631.6902570359025, 5598.468145526169, 5599.944000560105, 5610.943890561205, 5622.437756224344, 5626.0, 5407.891842163213, 5562.360328562268, 5572.60991730575, 5580.302462192226, 5580.330360356783, 5615.298087739033, 5624.85937851557, 5644.238027866186, 5645.435456454322, 5659.207710920557, 5310.522053015247, 5550.862073274888, 5556.972215138899, 5564.944350556442, 5565.888682226414], "value": 4232.268482676232, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [767.2212704105334, 770.4260326057089, 789.8894154818327, 792.5918152151642, 801.53911500887, 13153.605391838237, 13242.139260948032, 13748.175109493437, 14017.229052402126, 14595.270236488173, 13114.082014259006, 13193.010524210698, 13214.471421143167, 13222.20666759995, 13230.933845330785, 824.7649419915325, 837.1042984007099, 843.8565443874526, 852.8550146475114, 854.2866706300216, 855.1533981358473, 856.8372009318241, 856.9614367353485, 858.0518527027638, 858.0818524179131, 902.8284625921054, 907.2469850024464, 908.1554154636186, 908.1644886704215, 908.27791905435, 901.603294550399, 902.3007169443669, 902.4359775140537, 903.250302249135, 903.4759839293259, 665.1419668627465, 665.2549144957678, 666.1872515531045, 666.3436515032689, 666.3969107957306, 12831.0, 12920.0, 12923.935380323132, 12936.641652626528, 12950.417231224523, 12614.495420183182, 12660.68348291291, 12877.806832897513, 13116.6720831979, 13207.40566674502, 11854.525818967231, 11970.640880773592, 12030.218035827731, 12073.637790866289, 12167.14829961903, 3725.124595720031, 3769.512121999467, 3786.6970642348547, 3795.9240815183543, 3838.0788610733503, 64081.35918640801, 65529.672351638415, 66912.6654366725, 68365.65817170883, 68524.6573767128, 10081.243906706879, 10189.796204076025, 10248.64129755455, 10388.740281493023, 10524.31591946521, 17441.215145318492, 18164.818351816313, 18239.635207296044, 18308.816911830712, 18348.357807476674, 7968.282854543119, 8177.5502347370275, 8292.212239837207, 8327.541985190872, 8349.499030058216, 4446.244138496463, 4453.665975051884, 4509.413776209072, 4513.323001549794, 4678.883027924329, 3477.3045390921916, 3557.4308110702164, 3559.5728512578658, 3561.6438356164695, 3564.1446052947626, 642.4828013449124, 666.776629829003, 672.3982036077781, 678.2166597579704, 688.9931100689029, 690.7478770248823, 702.3362922038624, 704.4258928972973, 717.8636059148745, 731.0678884422404, 8835.558222089, 9112.544372781467, 9169.495677737788, 9367.578458969363, 9540.379875308083, 492.1706923833352, 513.4480433533965, 527.3250239693199, 527.5805734441052, 562.3869981719945, 4377.846775362847, 4569.177548041384, 4575.679702420799, 4612.262038073892, 4671.0891376182, 84205.57897210475, 85097.14902851016, 85639.0, 87224.5638771802, 88236.5588172055, 80092.0, 82090.58954705189, 82481.0, 85184.57407713046, 85738.57130714307, 48781.75609122003, 68756.31243687498, 69722.30277697259, 70377.29622703708, 72964.0, 8375.162483751576, 8675.58561694927, 8729.738107856774, 8747.431416957877, 8839.823203535765, 48552.0, 50024.0, 50273.24590131224, 50603.74698126633, 51431.22853157281, 63091.0, 65783.67108164428, 67223.66388168224, 67450.0, 68294.0, 11101.666949991513, 11239.55041798319, 11265.887341126483, 11450.599229026944, 11472.082233421139, 12464.688382790502, 12638.620841374774, 12701.93649031749, 12790.168639038433, 12845.486180552673, 10852.131829453783, 11365.261258018203, 11461.770764584828, 11917.582884598998, 11963.401829908644, 11211.0, 11341.319520828776, 11411.429428528374, 11420.200585959235, 11542.94228528852, 11407.372594507382, 11422.714432138931, 11435.0, 11590.362530060927, 11626.302421854716, 9529.809403812023, 9543.236541076558, 9742.659006934724, 9773.267004974514, 9813.55838987233, 9394.201492873182, 9842.11420972116, 9901.059190031152, 9926.305158639116, 9975.102240798364], "value": 6950.598014758097, "unit": "score"}], "name": "dromaeo_css", "value": 7238.044380626917, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [102.0, 112.0, 111.0, 110.0, 111.0, 112.0, 111.0, 110.0, 111.0, 111.0], "value": 110.1, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 120.0, 124.0, 159.0, 121.0, 127.0, 120.0, 120.0, 152.0, 122.0], "value": 131.0, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 159.0, 160.0, 161.0, 159.0, 161.0, 159.0, 161.0, 159.0, 160.0], "value": 159.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 76.0, 76.0, 107.0, 76.0, 76.0, 76.0, 76.0, 98.0, 75.0], "value": 81.2, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [81.0, 81.0, 111.0, 82.0, 82.0, 82.0, 99.0, 82.0, 82.0, 108.0], "value": 89.0, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 117.0, 119.0, 117.0, 117.0, 117.0, 116.0, 117.0, 117.0, 117.0], "value": 117.1, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 146.0, 146.0, 145.0, 146.0, 146.0, 146.0, 145.0, 145.0], "value": 145.7, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 84.0, 84.0, 85.0, 84.0, 85.0, 85.0, 85.0, 85.0, 85.0], "value": 84.6, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [50.0, 50.0, 49.0, 51.0, 50.0, 49.0, 49.0, 50.0, 50.0, 50.0], "value": 49.8, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [58.0, 60.0, 59.0, 59.0, 59.0, 59.0, 58.0, 59.0, 59.0, 59.0], "value": 58.9, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 74.0, 75.0, 75.0, 74.0, 75.0, 81.0, 73.0, 80.0, 74.0], "value": 75.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [138.0, 132.0, 127.0, 127.0, 127.0, 126.0, 124.0, 134.0, 163.0, 140.0], "value": 133.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [153.0, 155.0, 153.0, 155.0, 153.0, 154.0, 154.0, 154.0, 155.0, 152.0], "value": 153.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 61.0, 64.0, 61.0, 61.0, 62.0, 60.0, 62.0, 60.0, 63.0], "value": 61.9, "unit": "score"}], "name": "kraken", "value": 1452.3999999999999, "alertThreshold": 2.0}]} 13:34:39 INFO - Return code: 0 13:34:39 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 13:34:39 ERROR - # TBPL SUCCESS # 13:34:39 INFO - Running post-action listener: _resource_record_post_action 13:34:39 INFO - [mozharness: 2016-11-20 21:34:39.619252Z] Finished run-tests step (success) 13:34:39 INFO - Running post-run listener: _resource_record_post_run 13:34:39 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 4096; Write bytes: 356945920; Read time: 12; Write time: 201284 13:34:39 INFO - TinderboxPrint: CPU usage
13.0% 13:34:39 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 12 13:34:39 INFO - TinderboxPrint: I/O write bytes / time
356,945,920 / 201,284 13:34:39 INFO - TinderboxPrint: CPU idle
8,271.3 (87.0%) 13:34:39 INFO - TinderboxPrint: CPU user
1,189.2 (12.5%) 13:34:39 INFO - TinderboxPrint: Swap in / out
0 / 0 13:34:39 INFO - install - Wall time: 16s; CPU: 13.0%; Read bytes: 0; Write bytes: 108023808; Read time: 0; Write time: 72816 13:34:39 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 0; Write bytes: 248922112; Read time: 0; Write time: 128468 13:34:40 INFO - Running post-run listener: _upload_blobber_files 13:34:40 INFO - Blob upload gear active. 13:34:40 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 13:34:40 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 13:34:40 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'] 13:34:40 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 13:34:40 INFO - (blobuploader) - INFO - Open directory for files ... 13:34:40 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 13:34:40 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:34:40 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:34:44 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 13:34:44 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:34:44 INFO - (blobuploader) - INFO - Done attempting. 13:34:44 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 13:34:44 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:34:44 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:34:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 13:34:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:34:45 INFO - (blobuploader) - INFO - Done attempting. 13:34:45 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 13:34:45 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:34:45 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:34:45 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 13:34:45 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:34:45 INFO - (blobuploader) - INFO - Done attempting. 13:34:45 INFO - (blobuploader) - INFO - Iteration through files over. 13:34:45 INFO - Return code: 0 13:34:45 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 13:34:45 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 13:34:45 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3894eb2287d32ffef0cda82202de3e81898be3ef595990c150ac2f09e106e8b2ea9ec453040d155eaa14922eb88b0b23c4668bc244894ce1c4058d66308e96e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/bb9c6c8ec469eb8c538935be0e4a724d1e9178ea430a26ec9bfd96cdadd15f41693c60f9ceff9b2c0d7b433a6b47ffd6b69d6b34566a7bee8f60960e7f0daeb0", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/952d080a198ce014fbcad9bf7ebef70b63e3ddd0d13a375203d18f4f5128fa421c3eb899e47d3eb91914a7c65567540469f9c2f55598df1e66d86390eaa70e58"} 13:34:45 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 13:34:45 INFO - Writing to file /builds/slave/test/properties/blobber_files 13:34:45 INFO - Contents: 13:34:45 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3894eb2287d32ffef0cda82202de3e81898be3ef595990c150ac2f09e106e8b2ea9ec453040d155eaa14922eb88b0b23c4668bc244894ce1c4058d66308e96e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/bb9c6c8ec469eb8c538935be0e4a724d1e9178ea430a26ec9bfd96cdadd15f41693c60f9ceff9b2c0d7b433a6b47ffd6b69d6b34566a7bee8f60960e7f0daeb0", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/952d080a198ce014fbcad9bf7ebef70b63e3ddd0d13a375203d18f4f5128fa421c3eb899e47d3eb91914a7c65567540469f9c2f55598df1e66d86390eaa70e58"} 13:34:45 INFO - Running post-run listener: copy_logs_to_upload_dir 13:34:45 INFO - Copying logs to upload dir... 13:34:45 INFO - mkdir: /builds/slave/test/build/upload/logs 13:34:45 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1237.929721 ========= master_lag: 0.18 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-11-20 13:34:45.487893) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-11-20 13:34:45.495515) ========= 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=1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3894eb2287d32ffef0cda82202de3e81898be3ef595990c150ac2f09e106e8b2ea9ec453040d155eaa14922eb88b0b23c4668bc244894ce1c4058d66308e96e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/bb9c6c8ec469eb8c538935be0e4a724d1e9178ea430a26ec9bfd96cdadd15f41693c60f9ceff9b2c0d7b433a6b47ffd6b69d6b34566a7bee8f60960e7f0daeb0", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/952d080a198ce014fbcad9bf7ebef70b63e3ddd0d13a375203d18f4f5128fa421c3eb899e47d3eb91914a7c65567540469f9c2f55598df1e66d86390eaa70e58"} build_url:https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011328 build_url: 'https://queue.taskcluster.net/v1/task/LW0SlSa3R1yDd4GjV886Bw/artifacts/public/build/firefox-52.0a2.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/3894eb2287d32ffef0cda82202de3e81898be3ef595990c150ac2f09e106e8b2ea9ec453040d155eaa14922eb88b0b23c4668bc244894ce1c4058d66308e96e4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/bb9c6c8ec469eb8c538935be0e4a724d1e9178ea430a26ec9bfd96cdadd15f41693c60f9ceff9b2c0d7b433a6b47ffd6b69d6b34566a7bee8f60960e7f0daeb0", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/952d080a198ce014fbcad9bf7ebef70b63e3ddd0d13a375203d18f4f5128fa421c3eb899e47d3eb91914a7c65567540469f9c2f55598df1e66d86390eaa70e58"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-11-20 13:34:45.523117) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-20 13:34:45.523463) ========= 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=1f5564757af27664ca02d71f000001b0-1479675762.749089-1258545600 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004558 ========= master_lag: 0.04 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-11-20 13:34:45.572624) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-11-20 13:34:45.572930) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-11-20 13:34:45.576223) ========= ========= Total master_lag: 0.34 =========