builder: mozilla-central_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-001 starttime: 1471637571.42 results: success (0) buildid: 20160819103015 builduid: 6e74271d22b74512a2ea0704b585a2e6 revision: 8ef9629d8f90d6507b1bad01146b14101de79174 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-08-19 13:12:51.419970) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-08-19 13:12:51.420642) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-19 13:12:51.421123) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-08-19 13:12:51.442087) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-19 13:12:51.442581) ========= 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=8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-08-19 13:12:51-- 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: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 221M=0s 2016-08-19 13:12:51 (221 MB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.171958 ========= master_lag: 0.03 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-19 13:12:51.641759) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-19 13:12:51.642109) ========= 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=8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.019754 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-08-19 13:12:51.703222) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-19 13:12:51.703572) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 8ef9629d8f90d6507b1bad01146b14101de79174 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 8ef9629d8f90d6507b1bad01146b14101de79174 --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=8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-08-19 13:12:52,112 truncating revision to first 12 chars 2016-08-19 13:12:52,113 Setting DEBUG logging. 2016-08-19 13:12:52,113 attempt 1/10 2016-08-19 13:12:52,113 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/8ef9629d8f90?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-08-19 13:12:52,424 unpacking tar archive at: mozilla-central-8ef9629d8f90/testing/mozharness/ program finished with exit code 0 elapsedTime=0.671813 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-08-19 13:12:52.391796) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-19 13:12:52.392187) ========= script_repo_revision: 8ef9629d8f90d6507b1bad01146b14101de79174 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-08-19 13:12:52.392630) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-19 13:12:52.392912) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-08-19 13:12:52.403696) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-08-19 13:12:52.404115) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 13:12:52 INFO - MultiFileLogger online at 20160819 13:12:52 in /builds/slave/test 13:12:52 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 13:12:52 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 13:12:52 INFO - {'append_to_log': False, 13:12:52 INFO - 'base_work_dir': '/builds/slave/test', 13:12:52 INFO - 'blob_upload_branch': 'Firefox', 13:12:52 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 13:12:52 INFO - 'branch': 'Firefox', 13:12:52 INFO - 'buildbot_json_path': 'buildprops.json', 13:12:52 INFO - 'config_files': ('talos/linux_config.py',), 13:12:52 INFO - 'default_actions': ('clobber', 13:12:52 INFO - 'read-buildbot-config', 13:12:52 INFO - 'download-and-extract', 13:12:52 INFO - 'populate-webroot', 13:12:52 INFO - 'create-virtualenv', 13:12:52 INFO - 'install', 13:12:52 INFO - 'run-tests'), 13:12:52 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 13:12:52 INFO - 'download_minidump_stackwalk': True, 13:12:52 INFO - 'download_symbols': 'ondemand', 13:12:52 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 13:12:52 INFO - 'tooltool.py': '/tools/tooltool.py', 13:12:52 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 13:12:52 INFO - '/tools/misc-python/virtualenv.py')}, 13:12:52 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 13:12:52 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 13:12:52 INFO - 'installer_path': 'installer.exe', 13:12:52 INFO - 'log_level': 'info', 13:12:52 INFO - 'log_name': 'talos', 13:12:52 INFO - 'log_to_console': True, 13:12:52 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 13:12:52 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 13:12:52 INFO - 'opt_config_files': (), 13:12:52 INFO - 'pip_index': False, 13:12:52 INFO - 'sps_profile': False, 13:12:52 INFO - 'sps_profile_interval': 0, 13:12:52 INFO - 'suite': 'dromaeojs', 13:12:52 INFO - 'system_bits': '32', 13:12:52 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 13:12:52 INFO - 'title': 'talos-linux64-ix-001', 13:12:52 INFO - 'tooltool_cache': '/builds/tooltool_cache', 13:12:52 INFO - 'use_talos_json': True, 13:12:52 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 13:12:52 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 13:12:52 INFO - 'work_dir': 'build'} 13:12:52 INFO - [mozharness: 2016-08-19 20:12:52.902545Z] Running clobber step. 13:12:52 INFO - Running pre-action listener: _resource_record_pre_action 13:12:52 INFO - Running main action method: clobber 13:12:52 INFO - rmtree: /builds/slave/test/build 13:12:52 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 13:12:53 INFO - Running post-action listener: _resource_record_post_action 13:12:53 INFO - [mozharness: 2016-08-19 20:12:53.362619Z] Finished clobber step (success) 13:12:53 INFO - [mozharness: 2016-08-19 20:12:53.362718Z] Running read-buildbot-config step. 13:12:53 INFO - Running pre-action listener: _resource_record_pre_action 13:12:53 INFO - Running main action method: read_buildbot_config 13:12:53 INFO - Using buildbot properties: 13:12:53 INFO - { 13:12:53 INFO - "project": "", 13:12:53 INFO - "product": "firefox", 13:12:53 INFO - "script_repo_revision": "production", 13:12:53 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs", 13:12:53 INFO - "repository": "", 13:12:53 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs", 13:12:53 INFO - "buildid": "20160819103015", 13:12:53 INFO - "pgo_build": "True", 13:12:53 INFO - "basedir": "/builds/slave/test", 13:12:53 INFO - "buildnumber": 535, 13:12:53 INFO - "slavename": "talos-linux64-ix-001", 13:12:53 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 13:12:53 INFO - "platform": "ubuntu64_hw", 13:12:53 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 13:12:53 INFO - "branch": "mozilla-central", 13:12:53 INFO - "repo_path": "mozilla-central", 13:12:53 INFO - "revision": "8ef9629d8f90d6507b1bad01146b14101de79174", 13:12:53 INFO - "stage_platform": "linux64-pgo", 13:12:53 INFO - "builduid": "6e74271d22b74512a2ea0704b585a2e6", 13:12:53 INFO - "slavebuilddir": "test" 13:12:53 INFO - } 13:12:53 INFO - Found installer url https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2. 13:12:53 INFO - Running post-action listener: _resource_record_post_action 13:12:53 INFO - [mozharness: 2016-08-19 20:12:53.365117Z] Finished read-buildbot-config step (success) 13:12:53 INFO - [mozharness: 2016-08-19 20:12:53.365205Z] Running download-and-extract step. 13:12:53 INFO - Running pre-action listener: _resource_record_pre_action 13:12:53 INFO - Running main action method: download_and_extract 13:12:53 INFO - mkdir: /builds/slave/test/build/tests 13:12:53 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:12:53 INFO - trying https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 13:12:53 INFO - Downloading https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 13:12:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 13:12:53 INFO - Downloaded 1361 bytes. 13:12:53 INFO - Reading from file /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.test_packages.json 13:12:53 INFO - Using the following test package requirements: 13:12:53 INFO - {u'common': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 13:12:53 INFO - u'cppunittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 13:12:53 INFO - u'firefox-51.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 13:12:53 INFO - u'gtest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 13:12:53 INFO - u'firefox-51.0a1.en-US.linux-x86_64.gtest.tests.zip'], 13:12:53 INFO - u'jittest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 13:12:53 INFO - u'jsshell-linux-x86_64.zip'], 13:12:53 INFO - u'mochitest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 13:12:53 INFO - u'firefox-51.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 13:12:53 INFO - u'mozbase': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'], 13:12:53 INFO - u'reftest': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 13:12:53 INFO - u'firefox-51.0a1.en-US.linux-x86_64.reftest.tests.zip'], 13:12:53 INFO - u'talos': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 13:12:53 INFO - u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'], 13:12:53 INFO - u'web-platform': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 13:12:53 INFO - u'firefox-51.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 13:12:53 INFO - u'xpcshell': [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 13:12:53 INFO - u'firefox-51.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 13:12:53 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 13:12:53 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:12:53 INFO - trying https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 13:12:53 INFO - Downloading https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 13:12:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 13:12:54 INFO - Downloaded 21917549 bytes. 13:12:54 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/tests 13:12:59 INFO - Downloading packages: [u'firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 13:12:59 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:12:59 INFO - trying https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 13:12:59 INFO - Downloading https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip 13:12:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 13:12:59 INFO - Downloaded 21917549 bytes. 13:12:59 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.common.tests.zip to /builds/slave/test/build/tests 13:13:04 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:13:04 INFO - trying https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 13:13:04 INFO - Downloading https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip 13:13:04 INFO - retry: Calling _download_file with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip', 'file_name': u'/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 13:13:05 INFO - Downloaded 14413981 bytes. 13:13:05 INFO - Using ZipFile to extract /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.talos.tests.zip to /builds/slave/test/build/tests 13:13:05 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:13:05 INFO - trying https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 13:13:05 INFO - Downloading https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 13:13:05 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 13:13:06 INFO - Downloaded 59606763 bytes. 13:13:06 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 13:13:06 INFO - mkdir: /builds/slave/test/properties 13:13:06 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 13:13:06 INFO - Writing to file /builds/slave/test/properties/build_url 13:13:06 INFO - Contents: 13:13:06 INFO - build_url:https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 13:13:07 INFO - Running post-action listener: _resource_record_post_action 13:13:07 INFO - Running post-action listener: set_extra_try_arguments 13:13:07 INFO - [mozharness: 2016-08-19 20:13:07.602213Z] Finished download-and-extract step (success) 13:13:07 INFO - [mozharness: 2016-08-19 20:13:07.602437Z] Running populate-webroot step. 13:13:07 INFO - Running pre-action listener: _resource_record_pre_action 13:13:07 INFO - Running main action method: populate_webroot 13:13:07 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 13:13:07 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 13:13:07 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 13:13:07 INFO - '--tppagecycles', 13:13:07 INFO - '7'], 13:13:07 INFO - 'tests': ['tsvgm']}}, 13:13:07 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 13:13:07 INFO - 'tests': ['tresize', 'tcanvasmark']}, 13:13:07 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 13:13:07 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 13:13:07 INFO - 'tests': ['dromaeo_css', 'kraken']}, 13:13:07 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 13:13:07 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:13:07 INFO - 'talos_options': ['--disable-e10s'], 13:13:07 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:13:07 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:13:07 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 13:13:07 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:13:07 INFO - 'talos_options': ['--disable-e10s'], 13:13:07 INFO - 'tests': ['damp', 'tps']}, 13:13:07 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:13:07 INFO - 'tests': ['damp', 'tps']}, 13:13:07 INFO - 'g3': {'talos_options': ['--disable-e10s'], 13:13:07 INFO - 'tests': ['dromaeo_dom']}, 13:13:07 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 13:13:07 INFO - 'g4': {'talos_options': ['--disable-e10s'], 13:13:07 INFO - 'tests': ['basic_compositor_video']}, 13:13:07 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 13:13:07 INFO - 'other': {'talos_options': ['--disable-e10s'], 13:13:07 INFO - 'tests': ['a11yr', 13:13:07 INFO - 'ts_paint', 13:13:07 INFO - 'tpaint', 13:13:07 INFO - 'sessionrestore', 13:13:07 INFO - 'sessionrestore_no_auto_restore', 13:13:07 INFO - 'tabpaint']}, 13:13:07 INFO - 'other-e10s': {'tests': ['a11yr', 13:13:07 INFO - 'ts_paint', 13:13:07 INFO - 'tpaint', 13:13:07 INFO - 'sessionrestore', 13:13:07 INFO - 'sessionrestore_no_auto_restore', 13:13:07 INFO - 'tabpaint']}, 13:13:07 INFO - 'other-e10s_l64': {'tests': ['a11yr', 13:13:07 INFO - 'ts_paint', 13:13:07 INFO - 'tpaint', 13:13:07 INFO - 'sessionrestore', 13:13:07 INFO - 'sessionrestore_no_auto_restore', 13:13:07 INFO - 'tabpaint']}, 13:13:07 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 13:13:07 INFO - 'ts_paint', 13:13:07 INFO - 'tpaint', 13:13:07 INFO - 'sessionrestore', 13:13:07 INFO - 'sessionrestore_no_auto_restore', 13:13:07 INFO - 'tabpaint']}, 13:13:07 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 13:13:07 INFO - 'tests': ['a11yr', 13:13:07 INFO - 'ts_paint', 13:13:07 INFO - 'tpaint', 13:13:07 INFO - 'sessionrestore', 13:13:07 INFO - 'sessionrestore_no_auto_restore', 13:13:07 INFO - 'tabpaint']}, 13:13:07 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 13:13:07 INFO - 'tests': ['a11yr', 13:13:07 INFO - 'ts_paint', 13:13:07 INFO - 'tpaint', 13:13:07 INFO - 'sessionrestore', 13:13:07 INFO - 'sessionrestore_no_auto_restore', 13:13:07 INFO - 'tabpaint']}, 13:13:07 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 13:13:07 INFO - 'tests': ['tsvgx', 13:13:07 INFO - 'tsvgr_opacity', 13:13:07 INFO - 'tart', 13:13:07 INFO - 'tscrollx', 13:13:07 INFO - 'cart']}, 13:13:07 INFO - 'svgr-e10s': {'tests': ['tsvgx', 13:13:07 INFO - 'tsvgr_opacity', 13:13:07 INFO - 'tart', 13:13:07 INFO - 'tscrollx', 13:13:07 INFO - 'cart']}, 13:13:07 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:13:07 INFO - 'talos_options': ['--disable-e10s'], 13:13:07 INFO - 'tests': ['tp5o']}, 13:13:07 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:13:07 INFO - 'tests': ['tp5o']}, 13:13:07 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:13:07 INFO - 'talos_options': ['--disable-e10s', 13:13:07 INFO - '--xperf_path', 13:13:07 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:13:07 INFO - 'tests': ['tp5n']}, 13:13:07 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 13:13:07 INFO - 'talos_options': ['--xperf_path', 13:13:07 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 13:13:07 INFO - 'tests': ['tp5n']}}, 13:13:07 INFO - 'talos.zip': {'path': '', 13:13:07 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 13:13:07 INFO - Running post-action listener: _resource_record_post_action 13:13:07 INFO - [mozharness: 2016-08-19 20:13:07.622540Z] Finished populate-webroot step (success) 13:13:07 INFO - [mozharness: 2016-08-19 20:13:07.622627Z] Running create-virtualenv step. 13:13:07 INFO - Running pre-action listener: _resource_record_pre_action 13:13:07 INFO - Running main action method: create_virtualenv 13:13:07 INFO - Creating virtualenv /builds/slave/test/build/venv 13:13:07 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:13:07 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 13:13:07 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 13:13:07 INFO - Using real prefix '/usr' 13:13:07 INFO - New python executable in /builds/slave/test/build/venv/bin/python 13:13:08 INFO - Installing distribute.............................................................................................................................................................................................done. 13:13:10 INFO - Installing pip.................done. 13:13:10 INFO - Return code: 0 13:13:10 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 13:13:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:13:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:13:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:13:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:13:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:10 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 0x7fb377fc7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a95850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a90370>, '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 0x2a938f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a93d80>, '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': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', '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:13:10 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:13:10 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:13:10 INFO - Using env: {'DISPLAY': ':0', 13:13:10 INFO - 'HOME': '/home/cltbld', 13:13:10 INFO - 'LANG': 'en_US.UTF-8', 13:13:10 INFO - 'LANGUAGE': 'en_US:en', 13:13:10 INFO - 'LOGNAME': 'cltbld', 13:13:10 INFO - 'MAIL': '/var/mail/cltbld', 13:13:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:13:10 INFO - 'MOZ_NO_REMOTE': '1', 13:13:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:13:10 INFO - 'NO_EM_RESTART': '1', 13:13:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:13:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:13:10 INFO - 'PWD': '/builds/slave/test', 13:13:10 INFO - 'SHELL': '/bin/bash', 13:13:10 INFO - 'SHLVL': '1', 13:13:10 INFO - 'TERM': 'linux', 13:13:10 INFO - 'TMOUT': '86400', 13:13:10 INFO - 'USER': 'cltbld', 13:13:10 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', 13:13:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:13:10 INFO - '_': '/tools/buildbot/bin/python'} 13:13:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:13:10 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:13:10 INFO - Cleaning up... 13:13:10 INFO - Return code: 0 13:13:10 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 13:13:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:13:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:13:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:13:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:13:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:10 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 0x7fb377fc7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a95850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a90370>, '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 0x2a938f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a93d80>, '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': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', '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:13:10 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:13:10 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:13:10 INFO - Using env: {'DISPLAY': ':0', 13:13:10 INFO - 'HOME': '/home/cltbld', 13:13:10 INFO - 'LANG': 'en_US.UTF-8', 13:13:10 INFO - 'LANGUAGE': 'en_US:en', 13:13:10 INFO - 'LOGNAME': 'cltbld', 13:13:10 INFO - 'MAIL': '/var/mail/cltbld', 13:13:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:13:10 INFO - 'MOZ_NO_REMOTE': '1', 13:13:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:13:10 INFO - 'NO_EM_RESTART': '1', 13:13:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:13:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:13:10 INFO - 'PWD': '/builds/slave/test', 13:13:10 INFO - 'SHELL': '/bin/bash', 13:13:10 INFO - 'SHLVL': '1', 13:13:10 INFO - 'TERM': 'linux', 13:13:10 INFO - 'TMOUT': '86400', 13:13:10 INFO - 'USER': 'cltbld', 13:13:10 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', 13:13:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:13:10 INFO - '_': '/tools/buildbot/bin/python'} 13:13:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:13:10 INFO - Downloading/unpacking psutil>=3.1.1 13:13:10 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:13:10 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:13:10 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:13:10 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:13:10 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:13:10 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:13:12 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 13:13:12 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:13:12 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:13:12 INFO - Installing collected packages: psutil 13:13:12 INFO - Running setup.py install for psutil 13:13:12 INFO - building 'psutil._psutil_linux' extension 13:13:12 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:13:12 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:13:12 INFO - building 'psutil._psutil_posix' extension 13:13:12 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:13:13 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:13:13 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 13:13:13 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 13:13:13 INFO - Successfully installed psutil 13:13:13 INFO - Cleaning up... 13:13:13 INFO - Return code: 0 13:13:13 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 13:13:13 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:13:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:13:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:13 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:13:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:13:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:13 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 0x7fb377fc7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a95850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a90370>, '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 0x2a938f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a93d80>, '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': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', '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:13:13 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:13:13 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:13:13 INFO - Using env: {'DISPLAY': ':0', 13:13:13 INFO - 'HOME': '/home/cltbld', 13:13:13 INFO - 'LANG': 'en_US.UTF-8', 13:13:13 INFO - 'LANGUAGE': 'en_US:en', 13:13:13 INFO - 'LOGNAME': 'cltbld', 13:13:13 INFO - 'MAIL': '/var/mail/cltbld', 13:13:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:13:13 INFO - 'MOZ_NO_REMOTE': '1', 13:13:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:13:13 INFO - 'NO_EM_RESTART': '1', 13:13:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:13:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:13:13 INFO - 'PWD': '/builds/slave/test', 13:13:13 INFO - 'SHELL': '/bin/bash', 13:13:13 INFO - 'SHLVL': '1', 13:13:13 INFO - 'TERM': 'linux', 13:13:13 INFO - 'TMOUT': '86400', 13:13:13 INFO - 'USER': 'cltbld', 13:13:13 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', 13:13:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:13:13 INFO - '_': '/tools/buildbot/bin/python'} 13:13:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:13:13 INFO - Downloading/unpacking mozsystemmonitor==0.3 13:13:13 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:13:13 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:13:13 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:13:13 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:13:13 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:13:13 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:13:15 INFO - Downloading mozsystemmonitor-0.3.tar.gz 13:13:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 13:13:15 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 13:13:15 INFO - Installing collected packages: mozsystemmonitor 13:13:15 INFO - Running setup.py install for mozsystemmonitor 13:13:15 INFO - Successfully installed mozsystemmonitor 13:13:15 INFO - Cleaning up... 13:13:15 INFO - Return code: 0 13:13:15 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 13:13:15 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:13:15 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:13:15 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:15 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:13:15 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:13:15 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:15 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 0x7fb377fc7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a95850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a90370>, '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 0x2a938f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a93d80>, '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': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', '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:13:15 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:13:15 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:13:15 INFO - Using env: {'DISPLAY': ':0', 13:13:15 INFO - 'HOME': '/home/cltbld', 13:13:15 INFO - 'LANG': 'en_US.UTF-8', 13:13:15 INFO - 'LANGUAGE': 'en_US:en', 13:13:15 INFO - 'LOGNAME': 'cltbld', 13:13:15 INFO - 'MAIL': '/var/mail/cltbld', 13:13:15 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:13:15 INFO - 'MOZ_NO_REMOTE': '1', 13:13:15 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:13:15 INFO - 'NO_EM_RESTART': '1', 13:13:15 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:13:15 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:13:15 INFO - 'PWD': '/builds/slave/test', 13:13:15 INFO - 'SHELL': '/bin/bash', 13:13:15 INFO - 'SHLVL': '1', 13:13:15 INFO - 'TERM': 'linux', 13:13:15 INFO - 'TMOUT': '86400', 13:13:15 INFO - 'USER': 'cltbld', 13:13:15 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', 13:13:15 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:13:15 INFO - '_': '/tools/buildbot/bin/python'} 13:13:16 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:13:16 INFO - Downloading/unpacking jsonschema==2.5.1 13:13:16 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:13:16 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:13:16 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:13:16 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:13:16 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:13:16 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:13:17 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 13:13:17 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 13:13:17 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:13:17 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:13:17 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:13:17 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:13:17 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:13:17 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:13:18 INFO - Downloading functools32-3.2.3-2.tar.gz 13:13:18 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 13:13:18 INFO - warning: no files found matching '*.txt' 13:13:18 INFO - no previously-included directories found matching 'build' 13:13:18 INFO - no previously-included directories found matching 'dist' 13:13:18 INFO - no previously-included directories found matching '.git*' 13:13:18 INFO - Installing collected packages: jsonschema, functools32 13:13:18 INFO - Running setup.py install for functools32 13:13:18 INFO - warning: no files found matching '*.txt' 13:13:18 INFO - no previously-included directories found matching 'build' 13:13:18 INFO - no previously-included directories found matching 'dist' 13:13:18 INFO - no previously-included directories found matching '.git*' 13:13:18 INFO - Successfully installed jsonschema functools32 13:13:18 INFO - Cleaning up... 13:13:18 INFO - Return code: 0 13:13:18 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 13:13:18 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:13:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:13:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:18 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:13:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:13:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:18 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 0x7fb377fc7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a95850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a90370>, '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 0x2a938f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a93d80>, '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': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', '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:13:18 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:13:18 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:13:18 INFO - Using env: {'DISPLAY': ':0', 13:13:18 INFO - 'HOME': '/home/cltbld', 13:13:18 INFO - 'LANG': 'en_US.UTF-8', 13:13:18 INFO - 'LANGUAGE': 'en_US:en', 13:13:18 INFO - 'LOGNAME': 'cltbld', 13:13:18 INFO - 'MAIL': '/var/mail/cltbld', 13:13:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:13:18 INFO - 'MOZ_NO_REMOTE': '1', 13:13:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:13:18 INFO - 'NO_EM_RESTART': '1', 13:13:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:13:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:13:18 INFO - 'PWD': '/builds/slave/test', 13:13:18 INFO - 'SHELL': '/bin/bash', 13:13:18 INFO - 'SHLVL': '1', 13:13:18 INFO - 'TERM': 'linux', 13:13:18 INFO - 'TMOUT': '86400', 13:13:18 INFO - 'USER': 'cltbld', 13:13:18 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', 13:13:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:13:18 INFO - '_': '/tools/buildbot/bin/python'} 13:13:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:13:18 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 13:13:18 INFO - Cleaning up... 13:13:18 INFO - Return code: 0 13:13:18 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 13:13:18 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:13:18 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:13:18 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:18 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:13:18 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:13:18 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:18 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 0x7fb377fc7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a95850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a90370>, '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 0x2a938f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a93d80>, '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': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', '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:13:18 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:13:18 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:13:18 INFO - Using env: {'DISPLAY': ':0', 13:13:18 INFO - 'HOME': '/home/cltbld', 13:13:18 INFO - 'LANG': 'en_US.UTF-8', 13:13:18 INFO - 'LANGUAGE': 'en_US:en', 13:13:18 INFO - 'LOGNAME': 'cltbld', 13:13:18 INFO - 'MAIL': '/var/mail/cltbld', 13:13:18 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:13:18 INFO - 'MOZ_NO_REMOTE': '1', 13:13:18 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:13:18 INFO - 'NO_EM_RESTART': '1', 13:13:18 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:13:18 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:13:18 INFO - 'PWD': '/builds/slave/test', 13:13:18 INFO - 'SHELL': '/bin/bash', 13:13:18 INFO - 'SHLVL': '1', 13:13:18 INFO - 'TERM': 'linux', 13:13:18 INFO - 'TMOUT': '86400', 13:13:18 INFO - 'USER': 'cltbld', 13:13:18 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', 13:13:18 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:13:18 INFO - '_': '/tools/buildbot/bin/python'} 13:13:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:13:18 INFO - Downloading/unpacking blobuploader==1.2.4 13:13:18 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:13:18 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:13:18 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:13:18 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:13:18 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:13:18 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:13:20 INFO - Downloading blobuploader-1.2.4.tar.gz 13:13:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 13:13:20 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 13:13:20 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:13:20 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:13:20 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:13:20 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:13:20 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:13:20 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:13:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 13:13:21 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 13:13:21 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:13:21 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:13:21 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:13:21 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:13:21 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:13:21 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:13:21 INFO - Downloading docopt-0.6.1.tar.gz 13:13:21 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 13:13:21 INFO - Installing collected packages: blobuploader, requests, docopt 13:13:21 INFO - Running setup.py install for blobuploader 13:13:21 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 13:13:21 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 13:13:21 INFO - Running setup.py install for requests 13:13:21 INFO - Running setup.py install for docopt 13:13:22 INFO - Successfully installed blobuploader requests docopt 13:13:22 INFO - Cleaning up... 13:13:22 INFO - Return code: 0 13:13:22 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:13:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:13:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:13:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:13:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:13:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:22 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 0x7fb377fc7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a95850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a90370>, '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 0x2a938f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a93d80>, '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': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', '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:13:22 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:13:22 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:13:22 INFO - Using env: {'DISPLAY': ':0', 13:13:22 INFO - 'HOME': '/home/cltbld', 13:13:22 INFO - 'LANG': 'en_US.UTF-8', 13:13:22 INFO - 'LANGUAGE': 'en_US:en', 13:13:22 INFO - 'LOGNAME': 'cltbld', 13:13:22 INFO - 'MAIL': '/var/mail/cltbld', 13:13:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:13:22 INFO - 'MOZ_NO_REMOTE': '1', 13:13:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:13:22 INFO - 'NO_EM_RESTART': '1', 13:13:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:13:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:13:22 INFO - 'PWD': '/builds/slave/test', 13:13:22 INFO - 'SHELL': '/bin/bash', 13:13:22 INFO - 'SHLVL': '1', 13:13:22 INFO - 'TERM': 'linux', 13:13:22 INFO - 'TMOUT': '86400', 13:13:22 INFO - 'USER': 'cltbld', 13:13:22 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', 13:13:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:13:22 INFO - '_': '/tools/buildbot/bin/python'} 13:13:22 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:13:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:13:22 INFO - Running setup.py (path:/tmp/pip-RoMhrh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:13:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:13:22 INFO - Running setup.py (path:/tmp/pip-fXiCzt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:13:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:13:22 INFO - Running setup.py (path:/tmp/pip-X_aeQn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:13:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:13:22 INFO - Running setup.py (path:/tmp/pip-UtCLMQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:13:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:13:22 INFO - Running setup.py (path:/tmp/pip-bLh01L-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:13:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:13:22 INFO - Running setup.py (path:/tmp/pip-r8DFgp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:13:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:13:22 INFO - Running setup.py (path:/tmp/pip-62ePwg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:13:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:13:22 INFO - Running setup.py (path:/tmp/pip-fGAHHR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:13:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:13:22 INFO - Running setup.py (path:/tmp/pip-Xmy4jy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:13:22 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:13:22 INFO - Running setup.py (path:/tmp/pip-F4c358-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:13:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:13:23 INFO - Running setup.py (path:/tmp/pip-Aq3eaa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:13:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:13:23 INFO - Running setup.py (path:/tmp/pip-IVrzug-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:13:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:13:23 INFO - Running setup.py (path:/tmp/pip-hT2nhm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:13:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:13:23 INFO - Running setup.py (path:/tmp/pip-15DEPa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:13:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:13:23 INFO - Running setup.py (path:/tmp/pip-GOqpns-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:13:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:13:23 INFO - Running setup.py (path:/tmp/pip-F61uNU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:13:23 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:13:23 INFO - Running setup.py (path:/tmp/pip-icw8xL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:13:23 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 13:13:23 INFO - Running setup.py install for manifestparser 13:13:23 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 13:13:23 INFO - Running setup.py install for mozcrash 13:13:23 INFO - Running setup.py install for mozdebug 13:13:23 INFO - Running setup.py install for mozdevice 13:13:23 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 13:13:23 INFO - Installing dm script to /builds/slave/test/build/venv/bin 13:13:23 INFO - Running setup.py install for mozfile 13:13:24 INFO - Running setup.py install for mozhttpd 13:13:24 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 13:13:24 INFO - Running setup.py install for mozinfo 13:13:24 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 13:13:24 INFO - Running setup.py install for mozInstall 13:13:24 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 13:13:24 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 13:13:24 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 13:13:24 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 13:13:24 INFO - Running setup.py install for mozleak 13:13:24 INFO - Running setup.py install for mozlog 13:13:24 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 13:13:24 INFO - Running setup.py install for moznetwork 13:13:24 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 13:13:24 INFO - Running setup.py install for mozprocess 13:13:24 INFO - Running setup.py install for mozprofile 13:13:24 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 13:13:24 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 13:13:24 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 13:13:24 INFO - Running setup.py install for mozrunner 13:13:25 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 13:13:25 INFO - Running setup.py install for mozscreenshot 13:13:25 INFO - Running setup.py install for moztest 13:13:25 INFO - Running setup.py install for mozversion 13:13:25 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 13:13:25 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 13:13:25 INFO - Cleaning up... 13:13:25 INFO - Return code: 0 13:13:25 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:13:25 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:13:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:13:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:25 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:13:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:13:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:25 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 0x7fb377fc7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a95850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a90370>, '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 0x2a938f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a93d80>, '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': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', '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:13:25 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:13:25 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:13:25 INFO - Using env: {'DISPLAY': ':0', 13:13:25 INFO - 'HOME': '/home/cltbld', 13:13:25 INFO - 'LANG': 'en_US.UTF-8', 13:13:25 INFO - 'LANGUAGE': 'en_US:en', 13:13:25 INFO - 'LOGNAME': 'cltbld', 13:13:25 INFO - 'MAIL': '/var/mail/cltbld', 13:13:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:13:25 INFO - 'MOZ_NO_REMOTE': '1', 13:13:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:13:25 INFO - 'NO_EM_RESTART': '1', 13:13:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:13:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:13:25 INFO - 'PWD': '/builds/slave/test', 13:13:25 INFO - 'SHELL': '/bin/bash', 13:13:25 INFO - 'SHLVL': '1', 13:13:25 INFO - 'TERM': 'linux', 13:13:25 INFO - 'TMOUT': '86400', 13:13:25 INFO - 'USER': 'cltbld', 13:13:25 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', 13:13:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:13:25 INFO - '_': '/tools/buildbot/bin/python'} 13:13:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:13:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 13:13:25 INFO - Running setup.py (path:/tmp/pip-bCcsJZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 13:13:25 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:13:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 13:13:25 INFO - Running setup.py (path:/tmp/pip-xkbxGC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 13:13:25 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==0.17 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:13:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 13:13:25 INFO - Running setup.py (path:/tmp/pip-VcAiYg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 13:13:25 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:13:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 13:13:25 INFO - Running setup.py (path:/tmp/pip-sCyIvm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 13:13:25 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:13:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 13:13:25 INFO - Running setup.py (path:/tmp/pip-tHT9xP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 13:13:25 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:13:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 13:13:25 INFO - Running setup.py (path:/tmp/pip-Y1T2TA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 13:13:25 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:13:25 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 13:13:25 INFO - Running setup.py (path:/tmp/pip-i8U9oh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 13:13:26 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:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 13:13:26 INFO - Running setup.py (path:/tmp/pip-PJdoWN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 13:13:26 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:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 13:13:26 INFO - Running setup.py (path:/tmp/pip-K4ztjB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 13:13:26 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:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 13:13:26 INFO - Running setup.py (path:/tmp/pip-R5Q5eI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 13:13:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.3 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:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 13:13:26 INFO - Running setup.py (path:/tmp/pip-OAG42b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 13:13:26 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:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 13:13:26 INFO - Running setup.py (path:/tmp/pip-Cg37JJ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 13:13:26 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:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 13:13:26 INFO - Running setup.py (path:/tmp/pip-j6nUF6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 13:13:26 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:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 13:13:26 INFO - Running setup.py (path:/tmp/pip-1dKEsd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 13:13:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.12 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:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 13:13:26 INFO - Running setup.py (path:/tmp/pip-vM4dwt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 13:13:26 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:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 13:13:26 INFO - Running setup.py (path:/tmp/pip-HzZNKN-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 13:13:26 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:13:26 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 13:13:26 INFO - Running setup.py (path:/tmp/pip-2FIzfp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 13:13:26 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:13:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 13:13:26 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==0.17->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 13:13:26 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:13:26 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:13:26 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:13:26 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.3->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 13:13:26 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:13:26 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:13:26 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:13:26 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:13:26 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:13:26 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:13:28 INFO - Downloading blessings-1.6.tar.gz 13:13:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 13:13:28 INFO - Installing collected packages: blessings 13:13:28 INFO - Running setup.py install for blessings 13:13:28 INFO - Successfully installed blessings 13:13:28 INFO - Cleaning up... 13:13:28 INFO - Return code: 0 13:13:28 INFO - Done creating virtualenv /builds/slave/test/build/venv. 13:13:28 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:13:28 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:13:29 INFO - Reading from file tmpfile_stdout 13:13:29 INFO - Current package versions: 13:13:29 INFO - argparse == 1.2.1 13:13:29 INFO - blessings == 1.6 13:13:29 INFO - blobuploader == 1.2.4 13:13:29 INFO - docopt == 0.6.1 13:13:29 INFO - functools32 == 3.2.3-2 13:13:29 INFO - jsonschema == 2.5.1 13:13:29 INFO - manifestparser == 1.1 13:13:29 INFO - mozInstall == 1.12 13:13:29 INFO - mozcrash == 0.17 13:13:29 INFO - mozdebug == 0.1 13:13:29 INFO - mozdevice == 0.48 13:13:29 INFO - mozfile == 1.2 13:13:29 INFO - mozhttpd == 0.7 13:13:29 INFO - mozinfo == 0.9 13:13:29 INFO - mozleak == 0.1 13:13:29 INFO - mozlog == 3.3 13:13:29 INFO - moznetwork == 0.27 13:13:29 INFO - mozprocess == 0.23 13:13:29 INFO - mozprofile == 0.28 13:13:29 INFO - mozrunner == 6.12 13:13:29 INFO - mozscreenshot == 0.1 13:13:29 INFO - mozsystemmonitor == 0.3 13:13:29 INFO - moztest == 0.7 13:13:29 INFO - mozversion == 1.4 13:13:29 INFO - psutil == 3.1.1 13:13:29 INFO - requests == 1.2.3 13:13:29 INFO - wsgiref == 0.1.2 13:13:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 13:13:29 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:13:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:13:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:29 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:13:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:13:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:29 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 0x7fb377fc7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a95850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a90370>, '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 0x2a938f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a93d80>, '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': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', '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:13:29 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:13:29 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:13:29 INFO - Using env: {'DISPLAY': ':0', 13:13:29 INFO - 'HOME': '/home/cltbld', 13:13:29 INFO - 'LANG': 'en_US.UTF-8', 13:13:29 INFO - 'LANGUAGE': 'en_US:en', 13:13:29 INFO - 'LOGNAME': 'cltbld', 13:13:29 INFO - 'MAIL': '/var/mail/cltbld', 13:13:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:13:29 INFO - 'MOZ_NO_REMOTE': '1', 13:13:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:13:29 INFO - 'NO_EM_RESTART': '1', 13:13:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:13:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:13:29 INFO - 'PWD': '/builds/slave/test', 13:13:29 INFO - 'SHELL': '/bin/bash', 13:13:29 INFO - 'SHLVL': '1', 13:13:29 INFO - 'TERM': 'linux', 13:13:29 INFO - 'TMOUT': '86400', 13:13:29 INFO - 'USER': 'cltbld', 13:13:29 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', 13:13:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:13:29 INFO - '_': '/tools/buildbot/bin/python'} 13:13:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:13:29 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:13:29 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:13:29 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:13:29 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:13:29 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:13:29 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:13:29 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:13:29 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:13:29 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:13:29 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:13:29 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:13:29 INFO - Cleaning up... 13:13:29 INFO - Return code: 0 13:13:29 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 13:13:29 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:13:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 13:13:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:29 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:13:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 13:13:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 13:13:29 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 0x7fb377fc7f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x29c88a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2a95850>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a90370>, '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 0x2a938f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a93d80>, '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': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', '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:13:29 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:13:29 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:13:29 INFO - Using env: {'DISPLAY': ':0', 13:13:29 INFO - 'HOME': '/home/cltbld', 13:13:29 INFO - 'LANG': 'en_US.UTF-8', 13:13:29 INFO - 'LANGUAGE': 'en_US:en', 13:13:29 INFO - 'LOGNAME': 'cltbld', 13:13:29 INFO - 'MAIL': '/var/mail/cltbld', 13:13:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:13:29 INFO - 'MOZ_NO_REMOTE': '1', 13:13:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:13:29 INFO - 'NO_EM_RESTART': '1', 13:13:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:13:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:13:29 INFO - 'PWD': '/builds/slave/test', 13:13:29 INFO - 'SHELL': '/bin/bash', 13:13:29 INFO - 'SHLVL': '1', 13:13:29 INFO - 'TERM': 'linux', 13:13:29 INFO - 'TMOUT': '86400', 13:13:29 INFO - 'USER': 'cltbld', 13:13:29 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', 13:13:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:13:29 INFO - '_': '/tools/buildbot/bin/python'} 13:13:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 13:13:29 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 13:13:29 INFO - Cleaning up... 13:13:29 INFO - Return code: 0 13:13:29 INFO - Running post-action listener: _resource_record_post_action 13:13:29 INFO - Running post-action listener: _start_resource_monitoring 13:13:29 INFO - Starting resource monitoring. 13:13:29 INFO - [mozharness: 2016-08-19 20:13:29.635824Z] Finished create-virtualenv step (success) 13:13:29 INFO - [mozharness: 2016-08-19 20:13:29.636335Z] Running install step. 13:13:29 INFO - Running pre-action listener: _resource_record_pre_action 13:13:29 INFO - Running main action method: install 13:13:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 13:13:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 13:13:29 INFO - Reading from file tmpfile_stdout 13:13:29 INFO - Detecting whether we're running mozinstall >=1.0... 13:13:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 13:13:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 13:13:29 INFO - Reading from file tmpfile_stdout 13:13:29 INFO - Output received: 13:13:29 INFO - Usage: mozinstall [options] installer 13:13:29 INFO - Options: 13:13:29 INFO - -h, --help show this help message and exit 13:13:29 INFO - -d DEST, --destination=DEST 13:13:29 INFO - Directory to install application into. [default: 13:13:29 INFO - "/builds/slave/test"] 13:13:29 INFO - --app=APP Application being installed. [default: firefox] 13:13:29 INFO - mkdir: /builds/slave/test/build/application 13:13:29 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 13:13:29 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 13:13:46 INFO - Reading from file tmpfile_stdout 13:13:46 INFO - Output received: 13:13:46 INFO - /builds/slave/test/build/application/firefox/firefox 13:13:46 INFO - Running post-action listener: _resource_record_post_action 13:13:46 INFO - [mozharness: 2016-08-19 20:13:46.918856Z] Finished install step (success) 13:13:46 INFO - [mozharness: 2016-08-19 20:13:46.919100Z] Running run-tests step. 13:13:46 INFO - Running pre-action listener: _resource_record_pre_action 13:13:46 INFO - Running main action method: run_tests 13:13:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 13:13:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 13:13:46 INFO - Python 2.7.3 13:13:46 INFO - Return code: 0 13:13:46 INFO - grabbing minidump binary from tooltool 13:13:46 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 13:13:46 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 0x2a90370>, '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 0x2a938f0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2a93d80>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 13:13:46 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:13:46 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:13:46 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:13:46 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 13:13:46 INFO - Return code: 0 13:13:46 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 13:13:46 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 13:13:46 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 13:13:46 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 13:13:46 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 13:13:46 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-001', '--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:13:46 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-001 --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:13:46 INFO - Using env: {'DISPLAY': ':0', 13:13:46 INFO - 'HOME': '/home/cltbld', 13:13:46 INFO - 'LANG': 'en_US.UTF-8', 13:13:47 INFO - 'LANGUAGE': 'en_US:en', 13:13:47 INFO - 'LOGNAME': 'cltbld', 13:13:47 INFO - 'MAIL': '/var/mail/cltbld', 13:13:47 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 13:13:47 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 13:13:47 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 13:13:47 INFO - 'MOZ_NO_REMOTE': '1', 13:13:47 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 13:13:47 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 13:13:47 INFO - 'NO_EM_RESTART': '1', 13:13:47 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 13:13:47 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 13:13:47 INFO - 'PWD': '/builds/slave/test', 13:13:47 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 13:13:47 INFO - 'SHELL': '/bin/bash', 13:13:47 INFO - 'SHLVL': '1', 13:13:47 INFO - 'TERM': 'linux', 13:13:47 INFO - 'TMOUT': '86400', 13:13:47 INFO - 'USER': 'cltbld', 13:13:47 INFO - 'XDG_SESSION_COOKIE': '8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929', 13:13:47 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 13:13:47 INFO - '_': '/tools/buildbot/bin/python'} 13:13:47 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-001', '--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:13:47 INFO - mozversion application_buildid: 20160819103015 13:13:47 INFO - mozversion application_changeset: 8ef9629d8f90d6507b1bad01146b14101de79174 13:13:47 INFO - mozversion application_display_name: Nightly 13:13:47 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 13:13:47 INFO - mozversion application_name: Firefox 13:13:47 INFO - mozversion application_remotingname: firefox 13:13:47 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 13:13:47 INFO - mozversion application_vendor: Mozilla 13:13:47 INFO - mozversion application_version: 51.0a1 13:13:47 INFO - mozversion platform_buildid: 20160819103015 13:13:47 INFO - mozversion platform_changeset: 8ef9629d8f90d6507b1bad01146b14101de79174 13:13:47 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 13:13:47 INFO - mozversion platform_version: 51.0a1 13:13:47 INFO - using testdate: 1471637627 13:13:47 INFO - actual date: 1471637627 13:13:47 INFO - starting webserver on 'localhost:33059' 13:13:47 INFO - SUITE-START | Running 2 tests 13:13:47 INFO - TEST-START | dromaeo_css 13:13:47 INFO - operating with platform_type : linux_ 13:13:47 INFO - Initialising browser for dromaeo_css test... 13:13:47 INFO - TEST-INFO | started process 20817 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpYEyNyQ/profile http://localhost:33059/getInfo.html) 13:13:51 INFO - PROCESS | 20817 | __metrics Screen width/height:1600/1200 13:13:51 INFO - PROCESS | 20817 | colorDepth:24 13:13:51 INFO - PROCESS | 20817 | Browser inner width/height: 1024/697 13:13:51 INFO - PROCESS | 20817 | __metrics 13:13:51 INFO - PROCESS | 20817 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 13:13:51 INFO - PROCESS | 20817 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 13:13:52 INFO - PROCESS | 20817 | console.error: PushService: 13:13:52 INFO - PROCESS | 20817 | stateChangeProcessEnqueue: Error transitioning state 13:13:52 INFO - PROCESS | 20817 | UnknownError 13:13:53 INFO - TEST-INFO | 20817: exit 0 13:13:53 INFO - Browser initialized. 13:13:53 INFO - Running cycle 1/1 for dromaeo_css test... 13:13:53 INFO - TEST-INFO | started process 20895 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpYEyNyQ/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:14:04 INFO - PROCESS | 20895 | RSS: Main: 156094464 13:14:04 INFO - PROCESS | 20895 | 13:14:56 INFO - PROCESS | 20895 | 1471637696179 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:17:05 INFO - PROCESS | 20895 | Cycle 1(1): loaded http://localhost:33059/tests/dromaeo/cssquery-dojo.html (next: http://localhost:33059/tests/dromaeo/cssquery-ext.html) 13:17:06 INFO - PROCESS | 20895 | RSS: Main: 245342208 13:17:06 INFO - PROCESS | 20895 | 13:20:08 INFO - PROCESS | 20895 | Cycle 1(1): loaded http://localhost:33059/tests/dromaeo/cssquery-ext.html (next: http://localhost:33059/tests/dromaeo/cssquery-jquery.html) 13:20:09 INFO - PROCESS | 20895 | RSS: Main: 237752320 13:20:09 INFO - PROCESS | 20895 | 13:23:11 INFO - PROCESS | 20895 | Cycle 1(1): loaded http://localhost:33059/tests/dromaeo/cssquery-jquery.html (next: http://localhost:33059/tests/dromaeo/cssquery-mootools.html) 13:23:11 INFO - PROCESS | 20895 | RSS: Main: 215359488 13:23:11 INFO - PROCESS | 20895 | 13:26:14 INFO - PROCESS | 20895 | Cycle 1(1): loaded http://localhost:33059/tests/dromaeo/cssquery-mootools.html (next: http://localhost:33059/tests/dromaeo/cssquery-prototype.html) 13:26:14 INFO - PROCESS | 20895 | RSS: Main: 215642112 13:26:14 INFO - PROCESS | 20895 | 13:29:17 INFO - PROCESS | 20895 | Cycle 1(1): loaded http://localhost:33059/tests/dromaeo/cssquery-prototype.html (next: http://localhost:33059/tests/dromaeo/cssquery-yui.html) 13:29:17 INFO - PROCESS | 20895 | RSS: Main: 185659392 13:29:17 INFO - PROCESS | 20895 | 13:32:20 INFO - PROCESS | 20895 | Cycle 1(1): loaded http://localhost:33059/tests/dromaeo/cssquery-yui.html (next: http://localhost:33059/tests/dromaeo/cssquery-dojo.html) 13:32:21 INFO - PROCESS | 20895 | RSS: Main: 276500480 13:32:21 INFO - PROCESS | 20895 | 13:32:21 INFO - PROCESS | 20895 | __start_tp_report 13:32:21 INFO - PROCESS | 20895 | _x_x_mozilla_page_load 13:32:21 INFO - PROCESS | 20895 | _x_x_mozilla_page_load_details 13:32:21 INFO - PROCESS | 20895 | |i|pagename|runs| 13:32:21 INFO - PROCESS | 20895 | |0;dojo.html;3011.668716441191;3062.540618907164;3067.0492147434284;3069.094617087959;3085.506318988962;5145.485451454852;5286.788528458862;5291.1798671205925;5339.385970613381;5364.329458817648;5312.548433383167;5324.227986941891;5328.813491527797;5358.3569971603365;5474.589405794572;4818.084563932842;4857.854264372075;4935.629827762914;4955.430125535556;4974.502549745032;4988.800447982095;4992.875178120558;5018.172001619729;5020.573251273646;5022.59819214462;4746.786394612251;4794.352762377104;4807;4869.51304869512;4879.463259041502;4757.024809913959;4822.937434728972;4830.686005409637;4865.902681946377;4872.123017856784;4765.070811191819;4797.112534181153;4808.735519546423;4818.469968303484;4888.853334399973;5383.515483606494;5398.703071331075;5401.9736250112355;5406.324209473816;5409.24270602116;5541.168824676331;5624.775008999676;5635.887282254373;5658.773649054033;5771.163181338724;5741.19623252745;5783.045797443417;5814.825555233349;5815.21494598228;5818.505427038707;5406.783728650888;5412.7293635318865;5416.620836541444;5421.566274698054;5426.104692725696;5595.580331475156;5724.713764311851;5785.161151633074;5798.072308430631;5898.970505147447;5648.293963254593;5650.011248031578;5656.490915817596;5659.236003139606;5659.490645841894;5742.827715168552;5747.3677895431465;5752.188060760847;5756.539476841843;5756.740946657411;5414.35027796667;5620.887582248414;5671.461211184931;5677;5776.913346299809;5773.076307790733;5781.768729250867;5785.958527465096;5788.102844059177;5796.1305804129715;4423.690341676116;4456.264716321835;4461.933071003938;4465.933011004838;4472.08322293929;3814.275287695329;3835.9232815343535;3859.842047385773;3907.7459965102175;3926.155876486569;5354.223637572608;5354.303940487712;5360.705161216092;5361.35663720356;5362.785488580413;5695.345035320908;5735.225744524436;5739.655620662774;5752.28096487939;5756.971215143897;5167.22491626259;5265;5269;5289.3652761668845;5359.276497672842;5005.124103281911;5015.27278544609;5019.14674505335;5019.47295533971;5040.6219533534395;5942.138389933435;5947.959107156144;5957.731902064417;5960.970195149083;5961.076033214858;5505.862353441196;5716.114002329646;5771;5786.479216870502;5870.324912634931;6040.667763272886;6080.3919608040615;6082.3613520581475;6085.421884920926;6087.57386982907;5733.397993210653;5733.541316694738;5738.1679656450415;5738.942610574008;5740.483356497935;5489.890202196014;5620.269364982526;5662.85842853932;5668.093105103164;5754.05058165398;5607.411221821813;5639.041362968223;5640.32316122068;5640.464155905182;5640.746166422603;5554.833354999357;5599.580031497735;5603.35561410443;5611.859703507445;5615.522680572197;5409.729513524387;5491.588130890119;5523.8066667666435;5539.362973258127;5643.322801263875;5658.9151162733415;5660.575456840836;5666.4333566644655;5668.291463567054;5671.376148623731;5513.58648101386;5540.889182216414;5550.0564903965615;5555.194496798023;5558.24963629921 13:32:21 INFO - PROCESS | 20895 | |1;ext.html;555.8057003974882;576.8240686590593;578.199194116149;586.3491524407908;607.6718571971135;43928;45099.54900450994;45140.774296128475;45222.32166517505;48576;46321.76839115808;46445.30332045013;46782.766086169606;46961.53038469614;47069.29396059062;8922.464652120878;9060.320475964296;9063.229625481841;9066.637334506611;9072.8639070414;8917.68788092417;8998.955005224965;9014.68448604299;9017;9024.548772561378;8841.867371989425;8870.911290887105;8878.067802880701;8878.689245876396;8881.911180888206;8818.603162857655;8855.424397414148;8855.778605534848;8860.556972151368;8867.024627290994;8983.191512763817;9054.909450905472;9062.04848490912;9063.09369063095;9067.591958361823;43306.35040474396;44069;44076.3388549172;44161.558384416065;44359;3121.4693502104697;3228.1445416964525;3297.66638113299;3309.6855798699085;3346.4478361070396;32691.346173076643;32716.83641581801;32742.6725732742;32943.34113317744;33041.173970650685;4141.192467468844;4157.183888055181;4226.682998775073;4239.130978149472;4413.867583972486;257604;258213;258526;258531;258812.705936471;58978.11532827011;59529.40470595325;59839.40160598338;60010.69994649999;60269;36537.451938220416;62887.371126289065;62897.371026290064;62992;63024.68487657624;15629.296681649354;16477.58806029859;16494.6701065978;16722.498325050266;16894.563962063115;13078;13196.14225075367;13254.469821207236;13279.203247805162;13300.534481293109;18441.07794610264;18505.81494185041;18606.255749769858;18613.81386186148;18760.34338798163;6969.2682268362105;7104.325089116525;7112.110986126734;7124.501284910007;7406.629668516553;884.91150884911;992.6228033347281;1018.5536538115894;1049.879263884663;1057.619257067455;32617;32878.3424331512;32896;33013.86368295008;33740;983.4050399508194;1146.2262972493534;1147.3861484105964;1166.5916929074756;1189.4766302826729;16584.585385365463;17115.657686846444;17303.480895573153;17326.220320085627;17566.648667026588;152629;152933;153813;154313;154610.22694886453;59288;59927.40072599305;60002.699986499785;60032.79442494786;60058.69970650119;1091.2633972068822;1289.6711338608782;1343.8857697095661;1368.8015237790464;1393.052724147569;31013.689863101983;33177.83411082929;34333;34412.48381274333;34724.30551389009;43380;55215.72392138014;56868.431315687965;56933.43066569281;62724.68637656783;517139;519005;522594;523507;524932;37198.25603487861;37495;41219.38170927498;41603.7919810399;41728;47084.29373559468;47364.52635473739;47668.52331476779;48124.75937620289;48248.75875620599;36182;36598.26803463969;36688.26623467569;37148.81425592855;37261.441078384385;39836.601633983286;39868.2026359477;40343.596564033985;41210;41442.37836432516;40498.39252411275;40790;40825.1834963305;41078.58921410867;41446;34772.20019450907;35926.640733593376;36493.63506365009;37312.067198320256;37445.625543744216;27638.723612763613;27881.442371152058;28044.57933130964;28472.857635711687;28530.429391412472 13:32:21 INFO - PROCESS | 20895 | |2;jquery.html;384.1337783298661;385.64327996603146;390.4455672944417;392.88606304171793;429.6648614081018;13514.121582097157;15965.441209557668;18756.43730688078;20487.69268460974;20507.692384614224;14033.859661403383;16831.663366732657;17761.82238177618;18378.632427351444;18548.81451185488;5554.444555544454;5745.482906538411;5747.482726554609;5750.482456578907;5752.712364381785;5566.610337276392;5677.403872593381;5697.914531282014;5706.28671416073;5712.086066229404;5698.230738850244;5761.423857614247;5770.874679437511;5775.27809023872;5775.451332123442;5492.917606235909;5658.943410565924;5754.798582049629;5762.07806750922;5764.740586673589;5094.847154585368;5098.719570423626;5100.9489905100845;5102.209157580581;5102.438731739506;23568.29295121149;23585;23773.881130594236;24163.516729665484;24257.757422425726;2305.3890718959487;2407.2176542623542;2472.462160234557;2516.094206085808;2605.1403036997744;13467.393967271399;14538.418463261456;14681.265936703228;15070.623234419118;15384.461543845911;1907.637548865711;1915.7317975483443;1915.904204789769;1979.2379933725476;2050.1696812790697;86306;86746.56626716889;87139;87444.56277718571;87604.56197719034;9904.207663386911;9996.950015249877;10078.647247346307;10179.84730229047;10213.74465638365;13626.386812593457;13688.65778355529;13736.65658358549;13749.587512374645;13752.587422377344;8022.836688680225;8139.755807325671;8264.173582641808;8348.66605335792;8595.742127736177;8168.7957801055445;8237.958810205912;8281.792955176168;8495.95752021236;8556.486610803371;5726.427357264323;6229.034499652561;6336.58812177207;6540.084388185658;6609.942409214599;1876.47458711561;1900.8954507501944;1922.4424916773978;1923.6633589121848;1971.8028197180454;909.60432211988;938.1650331205233;967.3228739882111;994.6369575105034;1040.1834559870465;18252.45242642723;18395.90802046008;19661.410157695293;19673.21307147727;20225.29211477591;980.0885176785658;997.4264797741328;1009.8586197932295;1014.9137323327452;1041.8228901086834;10626;10981.945090274497;11053.613123540797;11123.221374503708;11206.775864482664;487668;492217;494336;513932;514177;99448.63754648682;99506;99506.50246748865;103746.48126759469;105024;961.3222678011984;1027.075631931268;1040.0899213188309;1044.9791004179874;1065.4406436620836;16673.749893751847;16939.830601694317;17299.394521191698;17505.21226544783;17899;43023.56976430196;43787.562124378346;43805.780971094944;44179.558204417546;44717.10565788601;61597;61711;61959;62091;62521.68739156275;7816.296533312029;8141.267285944294;8534.487930724177;8606.397552171287;8891.333150013645;11923.284602923852;12419;12882.67793305175;12920.806187907378;12969.805452918403;10916.672499824701;11188.21682482251;11239.494222759831;11244.156688248251;11660.825087623523;11227.27022743519;11272.887271127183;11363.488643010918;11399.373034483184;11573.768524629628;10672.545314577847;10767.515461804081;11417.1437142213;11937.880621193677;12246.510139594317;7546.434017448603;7844.450888437755;7903.170167132598;8509.957450212709;8785.692500762443;8289.295409889986;10622.415767132881;11202.15983801202;11203.159763017644;11521.711957201138 13:32:21 INFO - PROCESS | 20895 | |3;mootools.html;1302.303267751753;1331.8268625078742;1332.3737843213692;1345.4147445861045;1443.4298452111423;8184.754457366281;8456.154384561549;8541.743747687564;8555.871661925075;8791.384603077788;8327.125651806564;8463;8613.698520551781;8623.094575069606;8623.525706086162;2164.491344534033;2413.9758602414013;2425.6482809992494;2472.8887200076038;2477.5044991001782;2510.134003768697;2541.796656267494;2542.33899186212;2547.5287071891757;2551.7958563314983;2419.6733440985417;2441.2554170977933;2451.3871532116973;2499.6250562415603;2499.9250022499264;2399.4241382068353;2431.7932975697;2439.292605144497;2440.475297810979;2485.5898776702;2448.865312407817;2457.201409541888;2475.257422773179;2477.0834791127218;2487.328421326232;8945.776355591097;8991.28069754418;9016.954915225382;9023.368364214508;9044.547772611342;5300.178472336794;5415.187721841755;5418.864528386783;5432.456754324576;5433.701146436944;3484.564429446319;3512.262424890776;3552.662497062775;3570.732195085379;3578.0160455874843;1138.5901075612774;1155.4338374196668;1182.2788099259444;1207.2454715802623;1992.85053620979;12392.504299827997;12907.741845163138;12912.096153269275;12928.676783080498;12929.288889111094;4711.882202944954;4890.828820991248;5019.447860735316;5027.974860125676;5052.873678158002;10407.94796026015;10408.271421000458;10416.531256093494;10419.479026048668;10458.163346932228;5534.893021395737;5538.086215774432;5538.086215774432;5540.36285827135;5546.4453554644215;4292.313229883203;4603.608693261043;4987.600991920638;5060.746962651852;5076.517730815566;4108.815103320358;4123.505179378494;4207.305794543927;4254.893627659333;4266.701330906869;1269.2955409747494;1341.4768240386063;1365.0444688717937;1368.5962641020922;1375.9449622015206;831.2839873921923;836.5566249887569;885.4775682347446;901.396064636695;920.1672486399818;5962.731677074542;6101.237345331833;6127.693615319216;6240.063990401476;6311.933871207192;944.5230158769915;1009.2632378363688;1011.944343061124;1025.3591505309182;1034.2004911454017;4240.406343111967;4327.156204540147;4396.912061758747;4403.691741578059;4493.977530112328;11229.66311010671;11433.771324573461;11531.423428828524;11562.537498499965;11582.6525204244;11457.255278406878;11473.598424055119;11508.712282192844;11514.827277590843;11520.251183673034;7699.26856948589;8003.159668234868;8027.678892844221;8185.672573097128;8208.302294304931;5956.195913551615;6052.636841789506;6284.214473190851;6296.779612713533;6391.009393544008;10445.791084178425;10455;10567.94716026415;10672.252942293964;10690.786184276116;10254.948725256327;10317.793644127225;10547.419891905713;10724.356538607708;10747.516361763583;6972.09362782835;7594.468387212842;7751.302382785577;8083.3533317333295;8198.262156405952;8652.697155599524;8716.128387161232;8742.38803283764;8742.431741936754;8748.825023499367;7722.266384693445;7771.106322772954;7778.261065198797;7893.829196970879;8029.638666259915;7788.221177882167;7827.295543401121;7828.765137045898;7947.086085100056;7983.121856595886;7185.2814718527725;7232.74685386009;7313.744018959311;7320.341169294789;7327.37717294036;5251.107311756934;5382.865428364165;5412.161115027177;5440.211169380497;5547.472990065938;4994.925076123788;5067.037262920034;5101.158308878993;5259.579233661374;5527.309086364205 13:32:21 INFO - PROCESS | 20895 | |4;prototype.html;298.7729325712459;314.69631805307887;316.7038818704513;330.1548037025215;331.4547569248586;5029.862308518883;5117.283580298761;5185.092608793456;5185.9222111668305;5210.713410762407;5126.001289245795;5135.743212839352;5146.794128234876;5153.561947234481;5162.870928226786;4105.876823695294;4108.979455102721;4118.217538667644;4119.105211602667;4123.278426275405;3910.6284902934176;4049.230646177217;4123.134141830219;4124.422580838685;4141.896452588694;4012.3379642358977;4019.829292182218;4022.537408198051;4026.1947610477873;4037.919241615166;4000.119973605802;4004.979975100135;4012.919741605166;4014.2372949139863;4028.738132021409;3328.2012317043977;3428.074419906636;3458.15275257561;3461.809600471973;3582.283543291352;4990.750462476862;5000.874978125576;5007.471227030326;5009.524095210949;5045.798168073273;4467.955320446787;4474.485434175079;4494.348319493655;4495.348174514677;4495.550444955478;5106.489351064901;5294.470552944713;5297.655652382621;5317.8404647860625;5378.2470454136455;3894.240623078501;3906.4726261954556;3908.8436462541463;3909.7458665186673;3913.3542965410675;5582.609217354787;5599.076152434844;5606.915896261559;5619.185218143346;5620.213170156181;3822.8853134406013;3920.5099362579676;3926.391409331558;3945.8951493581844;3949.763014219156;3967.3652215645357;3968.4245784361683;3969.3450580654444;3993.2612466693754;4005.35914253718;4567.429071366079;4574.4739354973935;4576.908461830745;4582.862514124582;4585.931211031837;5295.947040529545;5350.250964864922;5444.537214336747;5457.5633949283965;5462.180672899018;1351.6688411339285;1378.3108445777111;1381.2679279981626;1384.349355802771;1385.5981765287954;855.5294587976588;887.4453466583385;888.9066648001867;905.42053086025;906.1618003346878;4623.86128416148;4626.467956185014;4630.212863813093;4631.907361852744;4639;4810.975945120322;4851.684640498356;4852.733099679552;4870.829520966749;4891.358666320148;4423.248047831877;4597.678162528591;4605.861824145281;4617.653675974316;4631.768411579407;2576.2786419802487;2611.2557920992426;2621.2791482342127;2627.8423294602003;2637.604359346075;5076.106619227079;5093.7909117255895;5095.770690318945;5105.259737338065;5107.9489205107475;5006.699598024057;5013.89972200554;5022.347094877716;5030.070530879759;5264.309730815859;5694.914576281276;5749.798757043483;5755.5683323750045;5759.94240057594;5813.82558523245;5487.890242195213;5502.724863756876;5521.861953451196;5578.525825304894;5578.86052848682;5376.462353764592;5450.071542091066;5494.36814766307;5533.280673512418;5533.446655334435;5649.180868774087;5738.426157384228;5765.308163020464;5790.247267855152;5799.188113664006;3828.8468461261236;3925.705572082048;3997.4403583498915;4015.3976903464713;4028.8388464461095;5452.400235973961;5461.453854614507;5518.172274158908;5527.281453411191;5536.695481748381;5396.487333703292;5420.701861397661;5443.8094666686475;5444.401115877171;5461.863453413696;5226.346706661668;5405.189301563244;5428.158635411518;5431.2667789847865;5437.673739575638;5424.318461276859;5427.240186373831;5429.592780541554;5432;5437.673739575638;5172.922406163835;5419.810306639249;5421.159720243369;5432.619716619957;5471.619845367278;5296.087152066425;5334.386545547157;5372.919406208832;5373.596980226421;5374.140137577969 13:32:21 INFO - PROCESS | 20895 | |5;yui.html;669.5647828911207;677.6069879469907;679.6126109193069;730.6492883415958;733.9633018349081;13466.12470189437;13878.99649825904;14442.783358249635;14460.638484037905;14486.2756862157;13769.518066867662;13796.241206733626;13796.310184490785;13856.861431385683;13886.513972010982;807.4146243973116;833.0461621443444;833.8624127019065;834.3283656656389;835.0980940584154;819.115355416152;822.481836443043;822.7243873302451;823.2097186700775;825.5376988886213;680.7379159023786;832.2967092806568;865.2429124516049;865.7316231968078;871.8082021955191;863.6372723456163;863.8142799298149;864.4251572704144;864.5029108262711;864.7146441674264;632.1118828046602;633.6736580660963;633.832034510855;634.3719717479662;634.9396807303299;10154.796904061952;13068.934655326757;13597.04820662554;13629.931850340685;13677.042607017513;14034.438622455089;14429.35067921946;14661.92669036648;14668.413263469554;14706.234413965087;11355.659330220107;11402.664379018133;11467.31196128235;11559.711007224887;11572.247803892804;3840.9423858642144;3877.2827027000094;3896.47397601323;4035.414864844581;4055.574164712692;85275.99999999937;87517.56241218817;88054.55972720095;88916;92025.53987230088;9674.56464459101;9925.751856203653;9975.850362244428;10037.69886903394;10134.493275336352;19568.90215548913;19639.31262405809;19645.803541964684;19675.704864427044;19686.11412486413;8089.47418417801;8321.95839020801;8372.916270837335;8418.957905210435;8576.271016963628;4289.935650965238;4323.308270676676;4354.716943398669;4354.869353919387;4387.254166791653;3406.4379377402947;3491.458823882302;3512.2097528056493;3514.9121271967892;3538.2569660371096;578.2713780636428;584.1296468262259;585.4028890531633;592.7717828636006;611.2390074357364;630.4168644004278;634.4828964394004;646.0922404022356;647.2427260105687;654.3227759269133;9354.625814967325;9376;9557;9730.610775568897;9804.950975245078;582.8338923406809;610.6397225636896;648.6497291462651;656.0118659505996;669.3340126573993;4005.5794141615293;4390.2317094508335;4406.339049142654;4418.867433976986;4432.268675668543;123402.38298808449;123738;125741.37129314295;125997.74002260044;130928.34535827259;106606.46696766466;106929;107887;108177.45911270393;108519.45740271248;93740;94284.52857735667;94967;96894;98399.50800246096;8291.626876790438;8546.359023073419;8552.828943421222;8608.139186081593;8820.514871682119;56174;56250.718746406004;56828.71585642045;57522.7123864378;57660.13509797272;65791.34208657852;67566.9324800632;78551;80497;83502.58248708717;12003.879961200277;12210.87789122133;12322.199057061262;12604.936975315064;13141;14008.509702160783;14080.718385632024;14511.492097776527;14771.261436928326;14818;12675.429605667952;13036.41336139857;13162.736745265232;13827.377768000262;14149.504767333094;13639.659008524866;13784.310784460937;13971.161730295808;13993.580192594238;14496.420143194155;13158.671033224246;13274.269915154373;13613.79579306331;13719.519816806363;13846;10513;10563.419011954416;10704.625338113128;10892.891071089505;10979.615713449992;10839.187060970617;11028.669139925814;11168;11391.259568128045;11583.6524904253 13:32:21 INFO - PROCESS | 20895 | __end_tp_report 13:32:21 INFO - PROCESS | 20895 | __start_cc_report 13:32:21 INFO - PROCESS | 20895 | _x_x_mozilla_cycle_collect,925 13:32:21 INFO - PROCESS | 20895 | __end_cc_report 13:32:21 INFO - PROCESS | 20895 | __startTimestamp1471638741164__endTimestamp 13:32:21 INFO - PROCESS | 20895 | 13:32:21 INFO - PROCESS | 20895 | ------- Summary: start ------- 13:32:21 INFO - PROCESS | 20895 | Number of tests: 6 13:32:21 INFO - PROCESS | 20895 | 13:32:21 INFO - PROCESS | 20895 | [#0] dojo.html Cycles:165 Average:5325.22 Median:5539.36 stddev:612.00 (11.0%) stddev-sans-first:586.34 13:32:21 INFO - PROCESS | 20895 | Values: 3011.7 3062.5 3067.0 3069.1 3085.5 5145.5 5286.8 5291.2 5339.4 5364.3 5312.5 5324.2 5328.8 5358.4 5474.6 4818.1 4857.9 4935.6 4955.4 4974.5 4988.8 4992.9 5018.2 5020.6 5022.6 4746.8 4794.4 4807.0 4869.5 4879.5 4757.0 4822.9 4830.7 4865.9 4872.1 4765.1 4797.1 4808.7 4818.5 4888.9 5383.5 5398.7 5402.0 5406.3 5409.2 5541.2 5624.8 5635.9 5658.8 5771.2 5741.2 5783.0 5814.8 5815.2 5818.5 5406.8 5412.7 5416.6 5421.6 5426.1 5595.6 5724.7 5785.2 5798.1 5899.0 5648.3 5650.0 5656.5 5659.2 5659.5 5742.8 5747.4 5752.2 5756.5 5756.7 5414.4 5620.9 5671.5 5677.0 5776.9 5773.1 5781.8 5786.0 5788.1 5796.1 4423.7 4456.3 4461.9 4465.9 4472.1 3814.3 3835.9 3859.8 3907.7 3926.2 5354.2 5354.3 5360.7 5361.4 5362.8 5695.3 5735.2 5739.7 5752.3 5757.0 5167.2 5265.0 5269.0 5289.4 5359.3 5005.1 5015.3 5019.1 5019.5 5040.6 5942.1 5948.0 5957.7 5961.0 5961.1 5505.9 5716.1 5771.0 5786.5 5870.3 6040.7 6080.4 6082.4 6085.4 6087.6 5733.4 5733.5 5738.2 5738.9 5740.5 5489.9 5620.3 5662.9 5668.1 5754.1 5607.4 5639.0 5640.3 5640.5 5640.7 5554.8 5599.6 5603.4 5611.9 5615.5 5409.7 5491.6 5523.8 5539.4 5643.3 5658.9 5660.6 5666.4 5668.3 5671.4 5513.6 5540.9 5550.1 5555.2 5558.2 13:32:21 INFO - PROCESS | 20895 | 13:32:21 INFO - PROCESS | 20895 | [#1] ext.html Cycles:180 Average:50015.93 Median:41444.19 stddev:92689.93 (223.7%) stddev-sans-first:92875.56 13:32:21 INFO - PROCESS | 20895 | Values: 555.8 576.8 578.2 586.3 607.7 43928.0 45099.5 45140.8 45222.3 48576.0 46321.8 46445.3 46782.8 46961.5 47069.3 8922.5 9060.3 9063.2 9066.6 9072.9 8917.7 8999.0 9014.7 9017.0 9024.5 8841.9 8870.9 8878.1 8878.7 8881.9 8818.6 8855.4 8855.8 8860.6 8867.0 8983.2 9054.9 9062.0 9063.1 9067.6 43306.4 44069.0 44076.3 44161.6 44359.0 3121.5 3228.1 3297.7 3309.7 3346.4 32691.3 32716.8 32742.7 32943.3 33041.2 4141.2 4157.2 4226.7 4239.1 4413.9 257604.0 258213.0 258526.0 258531.0 258812.7 58978.1 59529.4 59839.4 60010.7 60269.0 36537.5 62887.4 62897.4 62992.0 63024.7 15629.3 16477.6 16494.7 16722.5 16894.6 13078.0 13196.1 13254.5 13279.2 13300.5 18441.1 18505.8 18606.3 18613.8 18760.3 6969.3 7104.3 7112.1 7124.5 7406.6 884.9 992.6 1018.6 1049.9 1057.6 32617.0 32878.3 32896.0 33013.9 33740.0 983.4 1146.2 1147.4 1166.6 1189.5 16584.6 17115.7 17303.5 17326.2 17566.6 152629.0 152933.0 153813.0 154313.0 154610.2 59288.0 59927.4 60002.7 60032.8 60058.7 1091.3 1289.7 1343.9 1368.8 1393.1 31013.7 33177.8 34333.0 34412.5 34724.3 43380.0 55215.7 56868.4 56933.4 62724.7 517139.0 519005.0 522594.0 523507.0 524932.0 37198.3 37495.0 41219.4 41603.8 41728.0 47084.3 47364.5 47668.5 48124.8 48248.8 36182.0 36598.3 36688.3 37148.8 37261.4 39836.6 39868.2 40343.6 41210.0 41442.4 40498.4 40790.0 40825.2 41078.6 41446.0 34772.2 35926.6 36493.6 37312.1 37445.6 27638.7 27881.4 28044.6 28472.9 28530.4 13:32:21 INFO - PROCESS | 20895 | 13:32:21 INFO - PROCESS | 20895 | [#2] jquery.html Cycles:180 Average:29830.24 Median:2560.62 stddev:82866.80 (3236.2%) stddev-sans-first:83069.77 13:32:21 INFO - PROCESS | 20895 | Values: 384.1 385.6 390.4 392.9 429.7 13514.1 15965.4 18756.4 20487.7 20507.7 14033.9 16831.7 17761.8 18378.6 18548.8 5554.4 5745.5 5747.5 5750.5 5752.7 5566.6 5677.4 5697.9 5706.3 5712.1 5698.2 5761.4 5770.9 5775.3 5775.5 5492.9 5658.9 5754.8 5762.1 5764.7 5094.8 5098.7 5100.9 5102.2 5102.4 23568.3 23585.0 23773.9 24163.5 24257.8 2305.4 2407.2 2472.5 2516.1 2605.1 13467.4 14538.4 14681.3 15070.6 15384.5 1907.6 1915.7 1915.9 1979.2 2050.2 86306.0 86746.6 87139.0 87444.6 87604.6 9904.2 9997.0 10078.6 10179.8 10213.7 13626.4 13688.7 13736.7 13749.6 13752.6 8022.8 8139.8 8264.2 8348.7 8595.7 8168.8 8238.0 8281.8 8496.0 8556.5 5726.4 6229.0 6336.6 6540.1 6609.9 1876.5 1900.9 1922.4 1923.7 1971.8 909.6 938.2 967.3 994.6 1040.2 18252.5 18395.9 19661.4 19673.2 20225.3 980.1 997.4 1009.9 1014.9 1041.8 10626.0 10981.9 11053.6 11123.2 11206.8 487668.0 492217.0 494336.0 513932.0 514177.0 99448.6 99506.0 99506.5 103746.5 105024.0 961.3 1027.1 1040.1 1045.0 1065.4 16673.7 16939.8 17299.4 17505.2 17899.0 43023.6 43787.6 43805.8 44179.6 44717.1 61597.0 61711.0 61959.0 62091.0 62521.7 7816.3 8141.3 8534.5 8606.4 8891.3 11923.3 12419.0 12882.7 12920.8 12969.8 10916.7 11188.2 11239.5 11244.2 11660.8 11227.3 11272.9 11363.5 11399.4 11573.8 10672.5 10767.5 11417.1 11937.9 12246.5 7546.4 7844.5 7903.2 8510.0 8785.7 8289.3 10622.4 11202.2 11203.2 11521.7 13:32:21 INFO - PROCESS | 20895 | 13:32:21 INFO - PROCESS | 20895 | [#3] mootools.html Cycles:180 Average:5964.46 Median:4657.75 stddev:3375.24 (72.5%) stddev-sans-first:3366.52 13:32:21 INFO - PROCESS | 20895 | Values: 1302.3 1331.8 1332.4 1345.4 1443.4 8184.8 8456.2 8541.7 8555.9 8791.4 8327.1 8463.0 8613.7 8623.1 8623.5 2164.5 2414.0 2425.6 2472.9 2477.5 2510.1 2541.8 2542.3 2547.5 2551.8 2419.7 2441.3 2451.4 2499.6 2499.9 2399.4 2431.8 2439.3 2440.5 2485.6 2448.9 2457.2 2475.3 2477.1 2487.3 8945.8 8991.3 9017.0 9023.4 9044.5 5300.2 5415.2 5418.9 5432.5 5433.7 3484.6 3512.3 3552.7 3570.7 3578.0 1138.6 1155.4 1182.3 1207.2 1992.9 12392.5 12907.7 12912.1 12928.7 12929.3 4711.9 4890.8 5019.4 5028.0 5052.9 10407.9 10408.3 10416.5 10419.5 10458.2 5534.9 5538.1 5538.1 5540.4 5546.4 4292.3 4603.6 4987.6 5060.7 5076.5 4108.8 4123.5 4207.3 4254.9 4266.7 1269.3 1341.5 1365.0 1368.6 1375.9 831.3 836.6 885.5 901.4 920.2 5962.7 6101.2 6127.7 6240.1 6311.9 944.5 1009.3 1011.9 1025.4 1034.2 4240.4 4327.2 4396.9 4403.7 4494.0 11229.7 11433.8 11531.4 11562.5 11582.7 11457.3 11473.6 11508.7 11514.8 11520.3 7699.3 8003.2 8027.7 8185.7 8208.3 5956.2 6052.6 6284.2 6296.8 6391.0 10445.8 10455.0 10567.9 10672.3 10690.8 10254.9 10317.8 10547.4 10724.4 10747.5 6972.1 7594.5 7751.3 8083.4 8198.3 8652.7 8716.1 8742.4 8742.4 8748.8 7722.3 7771.1 7778.3 7893.8 8029.6 7788.2 7827.3 7828.8 7947.1 7983.1 7185.3 7232.7 7313.7 7320.3 7327.4 5251.1 5382.9 5412.2 5440.2 5547.5 4994.9 5067.0 5101.2 5259.6 5527.3 13:32:21 INFO - PROCESS | 20895 | 13:32:21 INFO - PROCESS | 20895 | [#4] prototype.html Cycles:180 Average:4458.42 Median:5018.12 stddev:1313.56 (26.2%) stddev-sans-first:1279.60 13:32:21 INFO - PROCESS | 20895 | Values: 298.8 314.7 316.7 330.2 331.5 5029.9 5117.3 5185.1 5185.9 5210.7 5126.0 5135.7 5146.8 5153.6 5162.9 4105.9 4109.0 4118.2 4119.1 4123.3 3910.6 4049.2 4123.1 4124.4 4141.9 4012.3 4019.8 4022.5 4026.2 4037.9 4000.1 4005.0 4012.9 4014.2 4028.7 3328.2 3428.1 3458.2 3461.8 3582.3 4990.8 5000.9 5007.5 5009.5 5045.8 4468.0 4474.5 4494.3 4495.3 4495.6 5106.5 5294.5 5297.7 5317.8 5378.2 3894.2 3906.5 3908.8 3909.7 3913.4 5582.6 5599.1 5606.9 5619.2 5620.2 3822.9 3920.5 3926.4 3945.9 3949.8 3967.4 3968.4 3969.3 3993.3 4005.4 4567.4 4574.5 4576.9 4582.9 4585.9 5295.9 5350.3 5444.5 5457.6 5462.2 1351.7 1378.3 1381.3 1384.3 1385.6 855.5 887.4 888.9 905.4 906.2 4623.9 4626.5 4630.2 4631.9 4639.0 4811.0 4851.7 4852.7 4870.8 4891.4 4423.2 4597.7 4605.9 4617.7 4631.8 2576.3 2611.3 2621.3 2627.8 2637.6 5076.1 5093.8 5095.8 5105.3 5107.9 5006.7 5013.9 5022.3 5030.1 5264.3 5694.9 5749.8 5755.6 5759.9 5813.8 5487.9 5502.7 5521.9 5578.5 5578.9 5376.5 5450.1 5494.4 5533.3 5533.4 5649.2 5738.4 5765.3 5790.2 5799.2 3828.8 3925.7 3997.4 4015.4 4028.8 5452.4 5461.5 5518.2 5527.3 5536.7 5396.5 5420.7 5443.8 5444.4 5461.9 5226.3 5405.2 5428.2 5431.3 5437.7 5424.3 5427.2 5429.6 5432.0 5437.7 5172.9 5419.8 5421.2 5432.6 5471.6 5296.1 5334.4 5372.9 5373.6 5374.1 13:32:21 INFO - PROCESS | 20895 | 13:32:21 INFO - PROCESS | 20895 | [#5] yui.html Cycles:180 Average:21801.47 Median:4354.79 stddev:33049.22 (758.9%) stddev-sans-first:33103.84 13:32:21 INFO - PROCESS | 20895 | Values: 669.6 677.6 679.6 730.6 734.0 13466.1 13879.0 14442.8 14460.6 14486.3 13769.5 13796.2 13796.3 13856.9 13886.5 807.4 833.0 833.9 834.3 835.1 819.1 822.5 822.7 823.2 825.5 680.7 832.3 865.2 865.7 871.8 863.6 863.8 864.4 864.5 864.7 632.1 633.7 633.8 634.4 634.9 10154.8 13068.9 13597.0 13629.9 13677.0 14034.4 14429.4 14661.9 14668.4 14706.2 11355.7 11402.7 11467.3 11559.7 11572.2 3840.9 3877.3 3896.5 4035.4 4055.6 85276.0 87517.6 88054.6 88916.0 92025.5 9674.6 9925.8 9975.9 10037.7 10134.5 19568.9 19639.3 19645.8 19675.7 19686.1 8089.5 8322.0 8372.9 8419.0 8576.3 4289.9 4323.3 4354.7 4354.9 4387.3 3406.4 3491.5 3512.2 3514.9 3538.3 578.3 584.1 585.4 592.8 611.2 630.4 634.5 646.1 647.2 654.3 9354.6 9376.0 9557.0 9730.6 9805.0 582.8 610.6 648.6 656.0 669.3 4005.6 4390.2 4406.3 4418.9 4432.3 123402.4 123738.0 125741.4 125997.7 130928.3 106606.5 106929.0 107887.0 108177.5 108519.5 93740.0 94284.5 94967.0 96894.0 98399.5 8291.6 8546.4 8552.8 8608.1 8820.5 56174.0 56250.7 56828.7 57522.7 57660.1 65791.3 67566.9 78551.0 80497.0 83502.6 12003.9 12210.9 12322.2 12604.9 13141.0 14008.5 14080.7 14511.5 14771.3 14818.0 12675.4 13036.4 13162.7 13827.4 14149.5 13639.7 13784.3 13971.2 13993.6 14496.4 13158.7 13274.3 13613.8 13719.5 13846.0 10513.0 10563.4 10704.6 10892.9 10979.6 10839.2 11028.7 11168.0 11391.3 11583.7 13:32:21 INFO - PROCESS | 20895 | -------- Summary: end -------- 13:32:21 INFO - PROCESS | 20895 | 13:32:21 INFO - TEST-INFO | 20895: exit 0 13:32:21 INFO - TEST-OK | dromaeo_css | took 1114774ms 13:32:21 INFO - TEST-START | kraken 13:32:21 INFO - operating with platform_type : linux_ 13:32:21 INFO - Initialising browser for kraken test... 13:32:21 INFO - TEST-INFO | started process 21204 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmQcdPk/profile http://localhost:33059/getInfo.html) 13:32:26 INFO - PROCESS | 21204 | __metrics Screen width/height:1600/1200 13:32:26 INFO - PROCESS | 21204 | colorDepth:24 13:32:26 INFO - PROCESS | 21204 | Browser inner width/height: 1024/697 13:32:26 INFO - PROCESS | 21204 | __metrics 13:32:26 INFO - PROCESS | 21204 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 693: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 13:32:26 INFO - PROCESS | 21204 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 155: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 13:32:27 INFO - PROCESS | 21204 | console.error: PushService: 13:32:27 INFO - PROCESS | 21204 | stateChangeProcessEnqueue: Error transitioning state 13:32:27 INFO - PROCESS | 21204 | UnknownError 13:32:27 INFO - TEST-INFO | 21204: exit 0 13:32:27 INFO - Browser initialized. 13:32:27 INFO - Running cycle 1/1 for kraken test... 13:32:27 INFO - TEST-INFO | started process 21284 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpmQcdPk/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 13:32:39 INFO - PROCESS | 21284 | RSS: Main: 155717632 13:32:39 INFO - PROCESS | 21284 | 13:32:42 INFO - PROCESS | 21284 | Cycle 1(1): loaded http://localhost:33059/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:33059/tests/kraken/driver.html?testName=audio-beat-detection) 13:32:42 INFO - PROCESS | 21284 | RSS: Main: 211697664 13:32:42 INFO - PROCESS | 21284 | 13:32:45 INFO - PROCESS | 21284 | Cycle 1(1): loaded http://localhost:33059/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:33059/tests/kraken/driver.html?testName=audio-dft) 13:32:46 INFO - PROCESS | 21284 | RSS: Main: 186273792 13:32:46 INFO - PROCESS | 21284 | 13:32:49 INFO - PROCESS | 21284 | Cycle 1(1): loaded http://localhost:33059/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:33059/tests/kraken/driver.html?testName=audio-fft) 13:32:49 INFO - PROCESS | 21284 | RSS: Main: 268730368 13:32:49 INFO - PROCESS | 21284 | 13:32:51 INFO - PROCESS | 21284 | Cycle 1(1): loaded http://localhost:33059/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:33059/tests/kraken/driver.html?testName=audio-oscillator) 13:32:52 INFO - PROCESS | 21284 | RSS: Main: 178970624 13:32:52 INFO - PROCESS | 21284 | 13:32:54 INFO - PROCESS | 21284 | Cycle 1(1): loaded http://localhost:33059/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:33059/tests/kraken/driver.html?testName=imaging-gaussian-blur) 13:32:55 INFO - PROCESS | 21284 | RSS: Main: 183611392 13:32:55 INFO - PROCESS | 21284 | 13:32:58 INFO - PROCESS | 21284 | Cycle 1(1): loaded http://localhost:33059/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:33059/tests/kraken/driver.html?testName=imaging-darkroom) 13:32:58 INFO - PROCESS | 21284 | RSS: Main: 218193920 13:32:58 INFO - PROCESS | 21284 | 13:33:02 INFO - PROCESS | 21284 | Cycle 1(1): loaded http://localhost:33059/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:33059/tests/kraken/driver.html?testName=imaging-desaturate) 13:33:02 INFO - PROCESS | 21284 | RSS: Main: 218505216 13:33:02 INFO - PROCESS | 21284 | 13:33:05 INFO - PROCESS | 21284 | Cycle 1(1): loaded http://localhost:33059/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:33059/tests/kraken/driver.html?testName=json-parse-financial) 13:33:06 INFO - PROCESS | 21284 | RSS: Main: 218980352 13:33:06 INFO - PROCESS | 21284 | 13:33:07 INFO - PROCESS | 21284 | Cycle 1(1): loaded http://localhost:33059/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:33059/tests/kraken/driver.html?testName=json-stringify-tinderbox) 13:33:08 INFO - PROCESS | 21284 | RSS: Main: 180740096 13:33:08 INFO - PROCESS | 21284 | 13:33:10 INFO - PROCESS | 21284 | Cycle 1(1): loaded http://localhost:33059/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:33059/tests/kraken/driver.html?testName=stanford-crypto-aes) 13:33:10 INFO - PROCESS | 21284 | RSS: Main: 189136896 13:33:10 INFO - PROCESS | 21284 | 13:33:12 INFO - PROCESS | 21284 | Cycle 1(1): loaded http://localhost:33059/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:33059/tests/kraken/driver.html?testName=stanford-crypto-ccm) 13:33:13 INFO - PROCESS | 21284 | RSS: Main: 193953792 13:33:13 INFO - PROCESS | 21284 | 13:33:15 INFO - PROCESS | 21284 | Cycle 1(1): loaded http://localhost:33059/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:33059/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 13:33:16 INFO - PROCESS | 21284 | RSS: Main: 187314176 13:33:16 INFO - PROCESS | 21284 | 13:33:19 INFO - PROCESS | 21284 | Cycle 1(1): loaded http://localhost:33059/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:33059/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 13:33:19 INFO - PROCESS | 21284 | RSS: Main: 191909888 13:33:19 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | Cycle 1(1): loaded http://localhost:33059/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:33059/tests/kraken/driver.html?testName=ai-astar) 13:33:21 INFO - PROCESS | 21284 | RSS: Main: 242946048 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | __start_tp_report 13:33:21 INFO - PROCESS | 21284 | _x_x_mozilla_page_load 13:33:21 INFO - PROCESS | 21284 | _x_x_mozilla_page_load_details 13:33:21 INFO - PROCESS | 21284 | |i|pagename|runs| 13:33:21 INFO - PROCESS | 21284 | |0;ai-astar;103;113;111;112;112;115;111;112;112;111 13:33:21 INFO - PROCESS | 21284 | |1;audio-beat-detection;145;116;123;178;119;120;146;123;164;118 13:33:21 INFO - PROCESS | 21284 | |2;audio-dft;160;160;159;160;159;159;161;161;160;160 13:33:21 INFO - PROCESS | 21284 | |3;audio-fft;73;75;75;103;74;77;74;74;109;75 13:33:21 INFO - PROCESS | 21284 | |4;audio-oscillator;84;85;120;84;85;85;126;84;86;135 13:33:21 INFO - PROCESS | 21284 | |5;imaging-gaussian-blur;117;116;117;116;116;116;117;117;117;117 13:33:21 INFO - PROCESS | 21284 | |6;imaging-darkroom;146;147;146;146;146;146;147;147;146;147 13:33:21 INFO - PROCESS | 21284 | |7;imaging-desaturate;95;95;95;94;96;96;95;95;95;95 13:33:21 INFO - PROCESS | 21284 | |8;json-parse-financial;49;51;50;50;50;52;51;51;50;50 13:33:21 INFO - PROCESS | 21284 | |9;json-stringify-tinderbox;62;62;62;62;63;62;63;61;62;62 13:33:21 INFO - PROCESS | 21284 | |10;stanford-crypto-aes;78;78;77;78;77;76;86;81;77;78 13:33:21 INFO - PROCESS | 21284 | |11;stanford-crypto-ccm;132;120;130;124;121;120;128;120;136;133 13:33:21 INFO - PROCESS | 21284 | |12;stanford-crypto-pbkdf2;163;162;166;164;161;161;160;161;160;161 13:33:21 INFO - PROCESS | 21284 | |13;stanford-crypto-sha256-iterative;65;64;63;64;64;64;67;62;65;63 13:33:21 INFO - PROCESS | 21284 | __end_tp_report 13:33:21 INFO - PROCESS | 21284 | __start_cc_report 13:33:21 INFO - PROCESS | 21284 | _x_x_mozilla_cycle_collect,1657 13:33:21 INFO - PROCESS | 21284 | __end_cc_report 13:33:21 INFO - PROCESS | 21284 | __startTimestamp1471638801868__endTimestamp 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | ------- Summary: start ------- 13:33:21 INFO - PROCESS | 21284 | Number of tests: 14 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | [#0] ai-astar Cycles:10 Average:111.20 Median:112.00 stddev:3.12 (2.8%) stddev-sans-first:1.27 13:33:21 INFO - PROCESS | 21284 | Values: 103.0 113.0 111.0 112.0 112.0 115.0 111.0 112.0 112.0 111.0 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | [#1] audio-beat-detection Cycles:10 Average:135.20 Median:134.00 stddev:21.93 (16.4%) stddev-sans-first:22.98 13:33:21 INFO - PROCESS | 21284 | Values: 145.0 116.0 123.0 178.0 119.0 120.0 146.0 123.0 164.0 118.0 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | [#2] audio-dft Cycles:10 Average:159.90 Median:160.00 stddev:0.74 (0.5%) stddev-sans-first:0.78 13:33:21 INFO - PROCESS | 21284 | Values: 160.0 160.0 159.0 160.0 159.0 159.0 161.0 161.0 160.0 160.0 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | [#3] audio-fft Cycles:10 Average:80.90 Median:74.50 stddev:13.35 (17.9%) stddev-sans-first:13.85 13:33:21 INFO - PROCESS | 21284 | Values: 73.0 75.0 75.0 103.0 74.0 77.0 74.0 74.0 109.0 75.0 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | [#4] audio-oscillator Cycles:10 Average:97.40 Median:84.50 stddev:20.74 (24.5%) stddev-sans-first:21.43 13:33:21 INFO - PROCESS | 21284 | Values: 84.0 85.0 120.0 84.0 85.0 85.0 126.0 84.0 86.0 135.0 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | [#5] imaging-gaussian-blur Cycles:10 Average:116.60 Median:117.00 stddev:0.52 (0.4%) stddev-sans-first:0.53 13:33:21 INFO - PROCESS | 21284 | Values: 117.0 116.0 117.0 116.0 116.0 116.0 117.0 117.0 117.0 117.0 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | [#6] imaging-darkroom Cycles:10 Average:146.40 Median:146.50 stddev:0.52 (0.4%) stddev-sans-first:0.53 13:33:21 INFO - PROCESS | 21284 | Values: 146.0 147.0 146.0 146.0 146.0 146.0 147.0 147.0 146.0 147.0 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | [#7] imaging-desaturate Cycles:10 Average:95.10 Median:95.00 stddev:0.57 (0.6%) stddev-sans-first:0.60 13:33:21 INFO - PROCESS | 21284 | Values: 95.0 95.0 95.0 94.0 96.0 96.0 95.0 95.0 95.0 95.0 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | [#8] json-parse-financial Cycles:10 Average:50.40 Median:50.50 stddev:0.84 (1.7%) stddev-sans-first:0.73 13:33:21 INFO - PROCESS | 21284 | Values: 49.0 51.0 50.0 50.0 50.0 52.0 51.0 51.0 50.0 50.0 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | [#9] json-stringify-tinderbox Cycles:10 Average:62.10 Median:62.00 stddev:0.57 (0.9%) stddev-sans-first:0.60 13:33:21 INFO - PROCESS | 21284 | Values: 62.0 62.0 62.0 62.0 63.0 62.0 63.0 61.0 62.0 62.0 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | [#10] stanford-crypto-aes Cycles:10 Average:78.60 Median:78.00 stddev:2.91 (3.7%) stddev-sans-first:3.08 13:33:21 INFO - PROCESS | 21284 | Values: 78.0 78.0 77.0 78.0 77.0 76.0 86.0 81.0 77.0 78.0 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | [#11] stanford-crypto-ccm Cycles:10 Average:126.40 Median:129.00 stddev:6.15 (4.8%) stddev-sans-first:6.18 13:33:21 INFO - PROCESS | 21284 | Values: 132.0 120.0 130.0 124.0 121.0 120.0 128.0 120.0 136.0 133.0 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:161.90 Median:161.50 stddev:1.91 (1.2%) stddev-sans-first:1.99 13:33:21 INFO - PROCESS | 21284 | Values: 163.0 162.0 166.0 164.0 161.0 161.0 160.0 161.0 160.0 161.0 13:33:21 INFO - PROCESS | 21284 | 13:33:21 INFO - PROCESS | 21284 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:64.10 Median:64.00 stddev:1.37 (2.1%) stddev-sans-first:1.41 13:33:21 INFO - PROCESS | 21284 | Values: 65.0 64.0 63.0 64.0 64.0 64.0 67.0 62.0 65.0 63.0 13:33:21 INFO - PROCESS | 21284 | -------- Summary: end -------- 13:33:21 INFO - PROCESS | 21284 | 13:33:22 INFO - TEST-INFO | 21284: exit 0 13:33:22 INFO - TEST-OK | kraken | took 60882ms 13:33:22 INFO - SUITE-END | took 1175s 13:33:23 INFO - Completed test suite (00:19:35) 13:33:23 INFO - javascript benchmark 13:33:23 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3011.668716441191, 3062.540618907164, 3067.0492147434284, 3069.094617087959, 3085.506318988962, 5145.485451454852, 5286.788528458862, 5291.1798671205925, 5339.385970613381, 5364.329458817648, 5312.548433383167, 5324.227986941891, 5328.813491527797, 5358.3569971603365, 5474.589405794572, 4818.084563932842, 4857.854264372075, 4935.629827762914, 4955.430125535556, 4974.502549745032, 4988.800447982095, 4992.875178120558, 5018.172001619729, 5020.573251273646, 5022.59819214462, 4746.786394612251, 4794.352762377104, 4807.0, 4869.51304869512, 4879.463259041502, 4757.024809913959, 4822.937434728972, 4830.686005409637, 4865.902681946377, 4872.123017856784, 4765.070811191819, 4797.112534181153, 4808.735519546423, 4818.469968303484, 4888.853334399973, 5383.515483606494, 5398.703071331075, 5401.9736250112355, 5406.324209473816, 5409.24270602116, 5541.168824676331, 5624.775008999676, 5635.887282254373, 5658.773649054033, 5771.163181338724, 5741.19623252745, 5783.045797443417, 5814.825555233349, 5815.21494598228, 5818.505427038707, 5406.783728650888, 5412.7293635318865, 5416.620836541444, 5421.566274698054, 5426.104692725696, 5595.580331475156, 5724.713764311851, 5785.161151633074, 5798.072308430631, 5898.970505147447, 5648.293963254593, 5650.011248031578, 5656.490915817596, 5659.236003139606, 5659.490645841894, 5742.827715168552, 5747.3677895431465, 5752.188060760847, 5756.539476841843, 5756.740946657411, 5414.35027796667, 5620.887582248414, 5671.461211184931, 5677.0, 5776.913346299809, 5773.076307790733, 5781.768729250867, 5785.958527465096, 5788.102844059177, 5796.1305804129715, 4423.690341676116, 4456.264716321835, 4461.933071003938, 4465.933011004838, 4472.08322293929, 3814.275287695329, 3835.9232815343535, 3859.842047385773, 3907.7459965102175, 3926.155876486569, 5354.223637572608, 5354.303940487712, 5360.705161216092, 5361.35663720356, 5362.785488580413, 5695.345035320908, 5735.225744524436, 5739.655620662774, 5752.28096487939, 5756.971215143897, 5167.22491626259, 5265.0, 5269.0, 5289.3652761668845, 5359.276497672842, 5005.124103281911, 5015.27278544609, 5019.14674505335, 5019.47295533971, 5040.6219533534395, 5942.138389933435, 5947.959107156144, 5957.731902064417, 5960.970195149083, 5961.076033214858, 5505.862353441196, 5716.114002329646, 5771.0, 5786.479216870502, 5870.324912634931, 6040.667763272886, 6080.3919608040615, 6082.3613520581475, 6085.421884920926, 6087.57386982907, 5733.397993210653, 5733.541316694738, 5738.1679656450415, 5738.942610574008, 5740.483356497935, 5489.890202196014, 5620.269364982526, 5662.85842853932, 5668.093105103164, 5754.05058165398, 5607.411221821813, 5639.041362968223, 5640.32316122068, 5640.464155905182, 5640.746166422603, 5554.833354999357, 5599.580031497735, 5603.35561410443, 5611.859703507445, 5615.522680572197, 5409.729513524387, 5491.588130890119, 5523.8066667666435, 5539.362973258127, 5643.322801263875, 5658.9151162733415, 5660.575456840836, 5666.4333566644655, 5668.291463567054, 5671.376148623731, 5513.58648101386, 5540.889182216414, 5550.0564903965615, 5555.194496798023, 5558.24963629921], "value": 5283.157255054567, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [555.8057003974882, 576.8240686590593, 578.199194116149, 586.3491524407908, 607.6718571971135, 43928.0, 45099.54900450994, 45140.774296128475, 45222.32166517505, 48576.0, 46321.76839115808, 46445.30332045013, 46782.766086169606, 46961.53038469614, 47069.29396059062, 8922.464652120878, 9060.320475964296, 9063.229625481841, 9066.637334506611, 9072.8639070414, 8917.68788092417, 8998.955005224965, 9014.68448604299, 9017.0, 9024.548772561378, 8841.867371989425, 8870.911290887105, 8878.067802880701, 8878.689245876396, 8881.911180888206, 8818.603162857655, 8855.424397414148, 8855.778605534848, 8860.556972151368, 8867.024627290994, 8983.191512763817, 9054.909450905472, 9062.04848490912, 9063.09369063095, 9067.591958361823, 43306.35040474396, 44069.0, 44076.3388549172, 44161.558384416065, 44359.0, 3121.4693502104697, 3228.1445416964525, 3297.66638113299, 3309.6855798699085, 3346.4478361070396, 32691.346173076643, 32716.83641581801, 32742.6725732742, 32943.34113317744, 33041.173970650685, 4141.192467468844, 4157.183888055181, 4226.682998775073, 4239.130978149472, 4413.867583972486, 257604.0, 258213.0, 258526.0, 258531.0, 258812.705936471, 58978.11532827011, 59529.40470595325, 59839.40160598338, 60010.69994649999, 60269.0, 36537.451938220416, 62887.371126289065, 62897.371026290064, 62992.0, 63024.68487657624, 15629.296681649354, 16477.58806029859, 16494.6701065978, 16722.498325050266, 16894.563962063115, 13078.0, 13196.14225075367, 13254.469821207236, 13279.203247805162, 13300.534481293109, 18441.07794610264, 18505.81494185041, 18606.255749769858, 18613.81386186148, 18760.34338798163, 6969.2682268362105, 7104.325089116525, 7112.110986126734, 7124.501284910007, 7406.629668516553, 884.91150884911, 992.6228033347281, 1018.5536538115894, 1049.879263884663, 1057.619257067455, 32617.0, 32878.3424331512, 32896.0, 33013.86368295008, 33740.0, 983.4050399508194, 1146.2262972493534, 1147.3861484105964, 1166.5916929074756, 1189.4766302826729, 16584.585385365463, 17115.657686846444, 17303.480895573153, 17326.220320085627, 17566.648667026588, 152629.0, 152933.0, 153813.0, 154313.0, 154610.22694886453, 59288.0, 59927.40072599305, 60002.699986499785, 60032.79442494786, 60058.69970650119, 1091.2633972068822, 1289.6711338608782, 1343.8857697095661, 1368.8015237790464, 1393.052724147569, 31013.689863101983, 33177.83411082929, 34333.0, 34412.48381274333, 34724.30551389009, 43380.0, 55215.72392138014, 56868.431315687965, 56933.43066569281, 62724.68637656783, 517139.0, 519005.0, 522594.0, 523507.0, 524932.0, 37198.25603487861, 37495.0, 41219.38170927498, 41603.7919810399, 41728.0, 47084.29373559468, 47364.52635473739, 47668.52331476779, 48124.75937620289, 48248.75875620599, 36182.0, 36598.26803463969, 36688.26623467569, 37148.81425592855, 37261.441078384385, 39836.601633983286, 39868.2026359477, 40343.596564033985, 41210.0, 41442.37836432516, 40498.39252411275, 40790.0, 40825.1834963305, 41078.58921410867, 41446.0, 34772.20019450907, 35926.640733593376, 36493.63506365009, 37312.067198320256, 37445.625543744216, 27638.723612763613, 27881.442371152058, 28044.57933130964, 28472.857635711687, 28530.429391412472], "value": 19580.46877924059, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [384.1337783298661, 385.64327996603146, 390.4455672944417, 392.88606304171793, 429.6648614081018, 13514.121582097157, 15965.441209557668, 18756.43730688078, 20487.69268460974, 20507.692384614224, 14033.859661403383, 16831.663366732657, 17761.82238177618, 18378.632427351444, 18548.81451185488, 5554.444555544454, 5745.482906538411, 5747.482726554609, 5750.482456578907, 5752.712364381785, 5566.610337276392, 5677.403872593381, 5697.914531282014, 5706.28671416073, 5712.086066229404, 5698.230738850244, 5761.423857614247, 5770.874679437511, 5775.27809023872, 5775.451332123442, 5492.917606235909, 5658.943410565924, 5754.798582049629, 5762.07806750922, 5764.740586673589, 5094.847154585368, 5098.719570423626, 5100.9489905100845, 5102.209157580581, 5102.438731739506, 23568.29295121149, 23585.0, 23773.881130594236, 24163.516729665484, 24257.757422425726, 2305.3890718959487, 2407.2176542623542, 2472.462160234557, 2516.094206085808, 2605.1403036997744, 13467.393967271399, 14538.418463261456, 14681.265936703228, 15070.623234419118, 15384.461543845911, 1907.637548865711, 1915.7317975483443, 1915.904204789769, 1979.2379933725476, 2050.1696812790697, 86306.0, 86746.56626716889, 87139.0, 87444.56277718571, 87604.56197719034, 9904.207663386911, 9996.950015249877, 10078.647247346307, 10179.84730229047, 10213.74465638365, 13626.386812593457, 13688.65778355529, 13736.65658358549, 13749.587512374645, 13752.587422377344, 8022.836688680225, 8139.755807325671, 8264.173582641808, 8348.66605335792, 8595.742127736177, 8168.7957801055445, 8237.958810205912, 8281.792955176168, 8495.95752021236, 8556.486610803371, 5726.427357264323, 6229.034499652561, 6336.58812177207, 6540.084388185658, 6609.942409214599, 1876.47458711561, 1900.8954507501944, 1922.4424916773978, 1923.6633589121848, 1971.8028197180454, 909.60432211988, 938.1650331205233, 967.3228739882111, 994.6369575105034, 1040.1834559870465, 18252.45242642723, 18395.90802046008, 19661.410157695293, 19673.21307147727, 20225.29211477591, 980.0885176785658, 997.4264797741328, 1009.8586197932295, 1014.9137323327452, 1041.8228901086834, 10626.0, 10981.945090274497, 11053.613123540797, 11123.221374503708, 11206.775864482664, 487668.0, 492217.0, 494336.0, 513932.0, 514177.0, 99448.63754648682, 99506.0, 99506.50246748865, 103746.48126759469, 105024.0, 961.3222678011984, 1027.075631931268, 1040.0899213188309, 1044.9791004179874, 1065.4406436620836, 16673.749893751847, 16939.830601694317, 17299.394521191698, 17505.21226544783, 17899.0, 43023.56976430196, 43787.562124378346, 43805.780971094944, 44179.558204417546, 44717.10565788601, 61597.0, 61711.0, 61959.0, 62091.0, 62521.68739156275, 7816.296533312029, 8141.267285944294, 8534.487930724177, 8606.397552171287, 8891.333150013645, 11923.284602923852, 12419.0, 12882.67793305175, 12920.806187907378, 12969.805452918403, 10916.672499824701, 11188.21682482251, 11239.494222759831, 11244.156688248251, 11660.825087623523, 11227.27022743519, 11272.887271127183, 11363.488643010918, 11399.373034483184, 11573.768524629628, 10672.545314577847, 10767.515461804081, 11417.1437142213, 11937.880621193677, 12246.510139594317, 7546.434017448603, 7844.450888437755, 7903.170167132598, 8509.957450212709, 8785.692500762443, 8289.295409889986, 10622.415767132881, 11202.15983801202, 11203.159763017644, 11521.711957201138], "value": 9304.481745233765, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1302.303267751753, 1331.8268625078742, 1332.3737843213692, 1345.4147445861045, 1443.4298452111423, 8184.754457366281, 8456.154384561549, 8541.743747687564, 8555.871661925075, 8791.384603077788, 8327.125651806564, 8463.0, 8613.698520551781, 8623.094575069606, 8623.525706086162, 2164.491344534033, 2413.9758602414013, 2425.6482809992494, 2472.8887200076038, 2477.5044991001782, 2510.134003768697, 2541.796656267494, 2542.33899186212, 2547.5287071891757, 2551.7958563314983, 2419.6733440985417, 2441.2554170977933, 2451.3871532116973, 2499.6250562415603, 2499.9250022499264, 2399.4241382068353, 2431.7932975697, 2439.292605144497, 2440.475297810979, 2485.5898776702, 2448.865312407817, 2457.201409541888, 2475.257422773179, 2477.0834791127218, 2487.328421326232, 8945.776355591097, 8991.28069754418, 9016.954915225382, 9023.368364214508, 9044.547772611342, 5300.178472336794, 5415.187721841755, 5418.864528386783, 5432.456754324576, 5433.701146436944, 3484.564429446319, 3512.262424890776, 3552.662497062775, 3570.732195085379, 3578.0160455874843, 1138.5901075612774, 1155.4338374196668, 1182.2788099259444, 1207.2454715802623, 1992.85053620979, 12392.504299827997, 12907.741845163138, 12912.096153269275, 12928.676783080498, 12929.288889111094, 4711.882202944954, 4890.828820991248, 5019.447860735316, 5027.974860125676, 5052.873678158002, 10407.94796026015, 10408.271421000458, 10416.531256093494, 10419.479026048668, 10458.163346932228, 5534.893021395737, 5538.086215774432, 5538.086215774432, 5540.36285827135, 5546.4453554644215, 4292.313229883203, 4603.608693261043, 4987.600991920638, 5060.746962651852, 5076.517730815566, 4108.815103320358, 4123.505179378494, 4207.305794543927, 4254.893627659333, 4266.701330906869, 1269.2955409747494, 1341.4768240386063, 1365.0444688717937, 1368.5962641020922, 1375.9449622015206, 831.2839873921923, 836.5566249887569, 885.4775682347446, 901.396064636695, 920.1672486399818, 5962.731677074542, 6101.237345331833, 6127.693615319216, 6240.063990401476, 6311.933871207192, 944.5230158769915, 1009.2632378363688, 1011.944343061124, 1025.3591505309182, 1034.2004911454017, 4240.406343111967, 4327.156204540147, 4396.912061758747, 4403.691741578059, 4493.977530112328, 11229.66311010671, 11433.771324573461, 11531.423428828524, 11562.537498499965, 11582.6525204244, 11457.255278406878, 11473.598424055119, 11508.712282192844, 11514.827277590843, 11520.251183673034, 7699.26856948589, 8003.159668234868, 8027.678892844221, 8185.672573097128, 8208.302294304931, 5956.195913551615, 6052.636841789506, 6284.214473190851, 6296.779612713533, 6391.009393544008, 10445.791084178425, 10455.0, 10567.94716026415, 10672.252942293964, 10690.786184276116, 10254.948725256327, 10317.793644127225, 10547.419891905713, 10724.356538607708, 10747.516361763583, 6972.09362782835, 7594.468387212842, 7751.302382785577, 8083.3533317333295, 8198.262156405952, 8652.697155599524, 8716.128387161232, 8742.38803283764, 8742.431741936754, 8748.825023499367, 7722.266384693445, 7771.106322772954, 7778.261065198797, 7893.829196970879, 8029.638666259915, 7788.221177882167, 7827.295543401121, 7828.765137045898, 7947.086085100056, 7983.121856595886, 7185.2814718527725, 7232.74685386009, 7313.744018959311, 7320.341169294789, 7327.37717294036, 5251.107311756934, 5382.865428364165, 5412.161115027177, 5440.211169380497, 5547.472990065938, 4994.925076123788, 5067.037262920034, 5101.158308878993, 5259.579233661374, 5527.309086364205], "value": 4782.762791433437, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [298.7729325712459, 314.69631805307887, 316.7038818704513, 330.1548037025215, 331.4547569248586, 5029.862308518883, 5117.283580298761, 5185.092608793456, 5185.9222111668305, 5210.713410762407, 5126.001289245795, 5135.743212839352, 5146.794128234876, 5153.561947234481, 5162.870928226786, 4105.876823695294, 4108.979455102721, 4118.217538667644, 4119.105211602667, 4123.278426275405, 3910.6284902934176, 4049.230646177217, 4123.134141830219, 4124.422580838685, 4141.896452588694, 4012.3379642358977, 4019.829292182218, 4022.537408198051, 4026.1947610477873, 4037.919241615166, 4000.119973605802, 4004.979975100135, 4012.919741605166, 4014.2372949139863, 4028.738132021409, 3328.2012317043977, 3428.074419906636, 3458.15275257561, 3461.809600471973, 3582.283543291352, 4990.750462476862, 5000.874978125576, 5007.471227030326, 5009.524095210949, 5045.798168073273, 4467.955320446787, 4474.485434175079, 4494.348319493655, 4495.348174514677, 4495.550444955478, 5106.489351064901, 5294.470552944713, 5297.655652382621, 5317.8404647860625, 5378.2470454136455, 3894.240623078501, 3906.4726261954556, 3908.8436462541463, 3909.7458665186673, 3913.3542965410675, 5582.609217354787, 5599.076152434844, 5606.915896261559, 5619.185218143346, 5620.213170156181, 3822.8853134406013, 3920.5099362579676, 3926.391409331558, 3945.8951493581844, 3949.763014219156, 3967.3652215645357, 3968.4245784361683, 3969.3450580654444, 3993.2612466693754, 4005.35914253718, 4567.429071366079, 4574.4739354973935, 4576.908461830745, 4582.862514124582, 4585.931211031837, 5295.947040529545, 5350.250964864922, 5444.537214336747, 5457.5633949283965, 5462.180672899018, 1351.6688411339285, 1378.3108445777111, 1381.2679279981626, 1384.349355802771, 1385.5981765287954, 855.5294587976588, 887.4453466583385, 888.9066648001867, 905.42053086025, 906.1618003346878, 4623.86128416148, 4626.467956185014, 4630.212863813093, 4631.907361852744, 4639.0, 4810.975945120322, 4851.684640498356, 4852.733099679552, 4870.829520966749, 4891.358666320148, 4423.248047831877, 4597.678162528591, 4605.861824145281, 4617.653675974316, 4631.768411579407, 2576.2786419802487, 2611.2557920992426, 2621.2791482342127, 2627.8423294602003, 2637.604359346075, 5076.106619227079, 5093.7909117255895, 5095.770690318945, 5105.259737338065, 5107.9489205107475, 5006.699598024057, 5013.89972200554, 5022.347094877716, 5030.070530879759, 5264.309730815859, 5694.914576281276, 5749.798757043483, 5755.5683323750045, 5759.94240057594, 5813.82558523245, 5487.890242195213, 5502.724863756876, 5521.861953451196, 5578.525825304894, 5578.86052848682, 5376.462353764592, 5450.071542091066, 5494.36814766307, 5533.280673512418, 5533.446655334435, 5649.180868774087, 5738.426157384228, 5765.308163020464, 5790.247267855152, 5799.188113664006, 3828.8468461261236, 3925.705572082048, 3997.4403583498915, 4015.3976903464713, 4028.8388464461095, 5452.400235973961, 5461.453854614507, 5518.172274158908, 5527.281453411191, 5536.695481748381, 5396.487333703292, 5420.701861397661, 5443.8094666686475, 5444.401115877171, 5461.863453413696, 5226.346706661668, 5405.189301563244, 5428.158635411518, 5431.2667789847865, 5437.673739575638, 5424.318461276859, 5427.240186373831, 5429.592780541554, 5432.0, 5437.673739575638, 5172.922406163835, 5419.810306639249, 5421.159720243369, 5432.619716619957, 5471.619845367278, 5296.087152066425, 5334.386545547157, 5372.919406208832, 5373.596980226421, 5374.140137577969], "value": 4039.128236538281, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [669.5647828911207, 677.6069879469907, 679.6126109193069, 730.6492883415958, 733.9633018349081, 13466.12470189437, 13878.99649825904, 14442.783358249635, 14460.638484037905, 14486.2756862157, 13769.518066867662, 13796.241206733626, 13796.310184490785, 13856.861431385683, 13886.513972010982, 807.4146243973116, 833.0461621443444, 833.8624127019065, 834.3283656656389, 835.0980940584154, 819.115355416152, 822.481836443043, 822.7243873302451, 823.2097186700775, 825.5376988886213, 680.7379159023786, 832.2967092806568, 865.2429124516049, 865.7316231968078, 871.8082021955191, 863.6372723456163, 863.8142799298149, 864.4251572704144, 864.5029108262711, 864.7146441674264, 632.1118828046602, 633.6736580660963, 633.832034510855, 634.3719717479662, 634.9396807303299, 10154.796904061952, 13068.934655326757, 13597.04820662554, 13629.931850340685, 13677.042607017513, 14034.438622455089, 14429.35067921946, 14661.92669036648, 14668.413263469554, 14706.234413965087, 11355.659330220107, 11402.664379018133, 11467.31196128235, 11559.711007224887, 11572.247803892804, 3840.9423858642144, 3877.2827027000094, 3896.47397601323, 4035.414864844581, 4055.574164712692, 85275.99999999937, 87517.56241218817, 88054.55972720095, 88916.0, 92025.53987230088, 9674.56464459101, 9925.751856203653, 9975.850362244428, 10037.69886903394, 10134.493275336352, 19568.90215548913, 19639.31262405809, 19645.803541964684, 19675.704864427044, 19686.11412486413, 8089.47418417801, 8321.95839020801, 8372.916270837335, 8418.957905210435, 8576.271016963628, 4289.935650965238, 4323.308270676676, 4354.716943398669, 4354.869353919387, 4387.254166791653, 3406.4379377402947, 3491.458823882302, 3512.2097528056493, 3514.9121271967892, 3538.2569660371096, 578.2713780636428, 584.1296468262259, 585.4028890531633, 592.7717828636006, 611.2390074357364, 630.4168644004278, 634.4828964394004, 646.0922404022356, 647.2427260105687, 654.3227759269133, 9354.625814967325, 9376.0, 9557.0, 9730.610775568897, 9804.950975245078, 582.8338923406809, 610.6397225636896, 648.6497291462651, 656.0118659505996, 669.3340126573993, 4005.5794141615293, 4390.2317094508335, 4406.339049142654, 4418.867433976986, 4432.268675668543, 123402.38298808449, 123738.0, 125741.37129314295, 125997.74002260044, 130928.34535827259, 106606.46696766466, 106929.0, 107887.0, 108177.45911270393, 108519.45740271248, 93740.0, 94284.52857735667, 94967.0, 96894.0, 98399.50800246096, 8291.626876790438, 8546.359023073419, 8552.828943421222, 8608.139186081593, 8820.514871682119, 56174.0, 56250.718746406004, 56828.71585642045, 57522.7123864378, 57660.13509797272, 65791.34208657852, 67566.9324800632, 78551.0, 80497.0, 83502.58248708717, 12003.879961200277, 12210.87789122133, 12322.199057061262, 12604.936975315064, 13141.0, 14008.509702160783, 14080.718385632024, 14511.492097776527, 14771.261436928326, 14818.0, 12675.429605667952, 13036.41336139857, 13162.736745265232, 13827.377768000262, 14149.504767333094, 13639.659008524866, 13784.310784460937, 13971.161730295808, 13993.580192594238, 14496.420143194155, 13158.671033224246, 13274.269915154373, 13613.79579306331, 13719.519816806363, 13846.0, 10513.0, 10563.419011954416, 10704.625338113128, 10892.891071089505, 10979.615713449992, 10839.187060970617, 11028.669139925814, 11168.0, 11391.259568128045, 11583.6524904253], "value": 7405.629022513406, "unit": "score"}], "name": "dromaeo_css", "value": 7186.16375032611, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [103.0, 113.0, 111.0, 112.0, 112.0, 115.0, 111.0, 112.0, 112.0, 111.0], "value": 111.2, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 116.0, 123.0, 178.0, 119.0, 120.0, 146.0, 123.0, 164.0, 118.0], "value": 135.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 160.0, 159.0, 160.0, 159.0, 159.0, 161.0, 161.0, 160.0, 160.0], "value": 159.9, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [73.0, 75.0, 75.0, 103.0, 74.0, 77.0, 74.0, 74.0, 109.0, 75.0], "value": 80.9, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [84.0, 85.0, 120.0, 84.0, 85.0, 85.0, 126.0, 84.0, 86.0, 135.0], "value": 97.4, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 116.0, 117.0, 116.0, 116.0, 116.0, 117.0, 117.0, 117.0, 117.0], "value": 116.6, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 147.0, 146.0, 146.0, 146.0, 146.0, 147.0, 147.0, 146.0, 147.0], "value": 146.4, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [95.0, 95.0, 95.0, 94.0, 96.0, 96.0, 95.0, 95.0, 95.0, 95.0], "value": 95.1, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [49.0, 51.0, 50.0, 50.0, 50.0, 52.0, 51.0, 51.0, 50.0, 50.0], "value": 50.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 62.0, 62.0, 62.0, 63.0, 62.0, 63.0, 61.0, 62.0, 62.0], "value": 62.1, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 78.0, 77.0, 78.0, 77.0, 76.0, 86.0, 81.0, 77.0, 78.0], "value": 78.6, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [132.0, 120.0, 130.0, 124.0, 121.0, 120.0, 128.0, 120.0, 136.0, 133.0], "value": 126.4, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 162.0, 166.0, 164.0, 161.0, 161.0, 160.0, 161.0, 160.0, 161.0], "value": 161.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [65.0, 64.0, 63.0, 64.0, 64.0, 64.0, 67.0, 62.0, 65.0, 63.0], "value": 64.1, "unit": "score"}], "name": "kraken", "value": 1486.1999999999998, "alertThreshold": 2.0}]} 13:33:23 INFO - Return code: 0 13:33:23 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 13:33:23 INFO - # TBPL SUCCESS # 13:33:23 INFO - Running post-action listener: _resource_record_post_action 13:33:23 INFO - [mozharness: 2016-08-19 20:33:23.168391Z] Finished run-tests step (success) 13:33:23 INFO - Running post-run listener: _resource_record_post_run 13:33:23 INFO - Total resource usage - Wall time: 1193s; CPU: 13.0%; Read bytes: 4096; Write bytes: 408137728; Read time: 84; Write time: 231836 13:33:23 INFO - TinderboxPrint: CPU usage
13.0% 13:33:23 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 84 13:33:23 INFO - TinderboxPrint: I/O write bytes / time
408,137,728 / 231,836 13:33:23 INFO - TinderboxPrint: CPU idle
8,280.9 (87.0%) 13:33:23 INFO - TinderboxPrint: CPU user
1,196.1 (12.6%) 13:33:23 INFO - TinderboxPrint: Swap in / out
0 / 0 13:33:23 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 117383168; Read time: 0; Write time: 70832 13:33:23 INFO - run-tests - Wall time: 1176s; CPU: 13.0%; Read bytes: 4096; Write bytes: 289853440; Read time: 84; Write time: 160984 13:33:23 INFO - Running post-run listener: _upload_blobber_files 13:33:23 INFO - Blob upload gear active. 13:33:23 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 13:33:23 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:33:23 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 13:33:23 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 13:33:24 INFO - (blobuploader) - INFO - Open directory for files ... 13:33:24 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 13:33:24 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:33:24 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:33:28 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 13:33:28 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:33:28 INFO - (blobuploader) - INFO - Done attempting. 13:33:28 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 13:33:28 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:33:28 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:33:29 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 13:33:29 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:33:29 INFO - (blobuploader) - INFO - Done attempting. 13:33:29 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 13:33:29 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 13:33:29 INFO - (blobuploader) - INFO - Uploading, attempt #1. 13:33:30 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 13:33:30 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 13:33:30 INFO - (blobuploader) - INFO - Done attempting. 13:33:30 INFO - (blobuploader) - INFO - Iteration through files over. 13:33:30 INFO - Return code: 0 13:33:30 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 13:33:30 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 13:33:30 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4953fbff9081ebca0b25f3d1345be890ca09f68df5bfe8ff289b820a5837aeff083b4ffcdc206aff09b0e1aa342944b93b8a19614da860a42ec8d6c062647d94", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d9f3d2832ab508ebdab941e5eb4e2022509824cbe3ed11f4f46e01a6627b0b41bb852bfa082b54ffecbf159ec7a18f223c52548db55a77cf94bbe96ae508de4f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/9d88a422ab738cdd84c21a619593a272d113eca7005806ca0638c1f6981e92fec633af60fc95558b79777a6d222e3ef25b54381ae3f18e6dfa7f62bec6248d13"} 13:33:30 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 13:33:30 INFO - Writing to file /builds/slave/test/properties/blobber_files 13:33:30 INFO - Contents: 13:33:30 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4953fbff9081ebca0b25f3d1345be890ca09f68df5bfe8ff289b820a5837aeff083b4ffcdc206aff09b0e1aa342944b93b8a19614da860a42ec8d6c062647d94", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d9f3d2832ab508ebdab941e5eb4e2022509824cbe3ed11f4f46e01a6627b0b41bb852bfa082b54ffecbf159ec7a18f223c52548db55a77cf94bbe96ae508de4f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/9d88a422ab738cdd84c21a619593a272d113eca7005806ca0638c1f6981e92fec633af60fc95558b79777a6d222e3ef25b54381ae3f18e6dfa7f62bec6248d13"} 13:33:30 INFO - Running post-run listener: copy_logs_to_upload_dir 13:33:30 INFO - Copying logs to upload dir... 13:33:30 INFO - mkdir: /builds/slave/test/build/upload/logs 13:33:30 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1237.580069 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 37 secs) (at 2016-08-19 13:33:30.000876) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-19 13:33:30.007231) ========= 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=8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4953fbff9081ebca0b25f3d1345be890ca09f68df5bfe8ff289b820a5837aeff083b4ffcdc206aff09b0e1aa342944b93b8a19614da860a42ec8d6c062647d94", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d9f3d2832ab508ebdab941e5eb4e2022509824cbe3ed11f4f46e01a6627b0b41bb852bfa082b54ffecbf159ec7a18f223c52548db55a77cf94bbe96ae508de4f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/9d88a422ab738cdd84c21a619593a272d113eca7005806ca0638c1f6981e92fec633af60fc95558b79777a6d222e3ef25b54381ae3f18e6dfa7f62bec6248d13"} build_url:https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011481 build_url: 'https://queue.taskcluster.net/v1/task/RfubB43VRK-n073PGkPCrQ/artifacts/public/build/firefox-51.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/4953fbff9081ebca0b25f3d1345be890ca09f68df5bfe8ff289b820a5837aeff083b4ffcdc206aff09b0e1aa342944b93b8a19614da860a42ec8d6c062647d94", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/d9f3d2832ab508ebdab941e5eb4e2022509824cbe3ed11f4f46e01a6627b0b41bb852bfa082b54ffecbf159ec7a18f223c52548db55a77cf94bbe96ae508de4f", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/9d88a422ab738cdd84c21a619593a272d113eca7005806ca0638c1f6981e92fec633af60fc95558b79777a6d222e3ef25b54381ae3f18e6dfa7f62bec6248d13"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-08-19 13:33:30.033040) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-19 13:33:30.033361) ========= 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=8887e36bb8e381bfd44124ac000001a8-1471635712.740862-304068929 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004469 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-08-19 13:33:30.116962) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-19 13:33:30.117283) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-08-19 13:33:30.117585) ========= ========= Total master_lag: 0.20 =========