builder: autoland_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-047 starttime: 1476484363.72 results: success (0) buildid: 20161014123005 builduid: aa96268848e0429397a9e7f83e7757fb revision: 3ccac82a6bcff2da20a93b056a4a21663fc35652 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-14 15:32:43.723707) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-14 15:32:43.724400) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-14 15:32:43.724898) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-14 15:32:43.775706) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 15:32:43.775988) ========= 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=03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-10-14 15:32:43-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.25, 63.245.215.102 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.25|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 44.1M=0s 2016-10-14 15:32:44 (44.1 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.130720 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 15:32:43.921236) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 15:32:43.921576) ========= 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=03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.013804 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 15:32:43.971406) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 15:32:43.971753) ========= bash -c 'python archiver_client.py mozharness --repo integration/autoland --rev 3ccac82a6bcff2da20a93b056a4a21663fc35652 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/autoland --rev 3ccac82a6bcff2da20a93b056a4a21663fc35652 --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=03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-10-14 15:32:44,224 truncating revision to first 12 chars 2016-10-14 15:32:44,224 Setting DEBUG logging. 2016-10-14 15:32:44,224 attempt 1/10 2016-10-14 15:32:44,224 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/autoland/3ccac82a6bcf?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-14 15:32:44,879 unpacking tar archive at: autoland-3ccac82a6bcf/testing/mozharness/ program finished with exit code 0 elapsedTime=0.981805 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 15:32:44.966928) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-14 15:32:44.967268) ========= script_repo_revision: 3ccac82a6bcff2da20a93b056a4a21663fc35652 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-14 15:32:44.967693) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-14 15:32:44.967966) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-14 15:32:44.977126) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 43 secs) (at 2016-10-14 15:32:44.977503) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Autoland --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland 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', 'Autoland', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Autoland'] 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=03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 15:32:45 INFO - MultiFileLogger online at 20161014 15:32:45 in /builds/slave/test 15:32:45 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Autoland --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Autoland 15:32:45 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 15:32:45 INFO - {'append_to_log': False, 15:32:45 INFO - 'base_work_dir': '/builds/slave/test', 15:32:45 INFO - 'blob_upload_branch': 'Autoland', 15:32:45 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 15:32:45 INFO - 'branch': 'Autoland', 15:32:45 INFO - 'buildbot_json_path': 'buildprops.json', 15:32:45 INFO - 'config_files': ('talos/linux_config.py',), 15:32:45 INFO - 'default_actions': ('clobber', 15:32:45 INFO - 'read-buildbot-config', 15:32:45 INFO - 'download-and-extract', 15:32:45 INFO - 'populate-webroot', 15:32:45 INFO - 'create-virtualenv', 15:32:45 INFO - 'install', 15:32:45 INFO - 'run-tests'), 15:32:45 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 15:32:45 INFO - 'download_minidump_stackwalk': True, 15:32:45 INFO - 'download_symbols': 'ondemand', 15:32:45 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 15:32:45 INFO - 'tooltool.py': '/tools/tooltool.py', 15:32:45 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 15:32:45 INFO - '/tools/misc-python/virtualenv.py')}, 15:32:45 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 15:32:45 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 15:32:45 INFO - 'installer_path': 'installer.exe', 15:32:45 INFO - 'log_level': 'info', 15:32:45 INFO - 'log_name': 'talos', 15:32:45 INFO - 'log_to_console': True, 15:32:45 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 15:32:45 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 15:32:45 INFO - 'opt_config_files': (), 15:32:45 INFO - 'pip_index': False, 15:32:45 INFO - 'sps_profile': False, 15:32:45 INFO - 'sps_profile_interval': 0, 15:32:45 INFO - 'suite': 'dromaeojs', 15:32:45 INFO - 'system_bits': '32', 15:32:45 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 15:32:45 INFO - 'title': 'talos-linux64-ix-047', 15:32:45 INFO - 'tooltool_cache': '/builds/tooltool_cache', 15:32:45 INFO - 'use_talos_json': True, 15:32:45 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 15:32:45 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 15:32:45 INFO - 'work_dir': 'build'} 15:32:45 INFO - [mozharness: 2016-10-14 22:32:45.332502Z] Running clobber step. 15:32:45 INFO - Running pre-action listener: _resource_record_pre_action 15:32:45 INFO - Running main action method: clobber 15:32:45 INFO - rmtree: /builds/slave/test/build 15:32:45 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 15:32:45 INFO - Running post-action listener: _resource_record_post_action 15:32:45 INFO - [mozharness: 2016-10-14 22:32:45.783639Z] Finished clobber step (success) 15:32:45 INFO - [mozharness: 2016-10-14 22:32:45.783740Z] Running read-buildbot-config step. 15:32:45 INFO - Running pre-action listener: _resource_record_pre_action 15:32:45 INFO - Running main action method: read_buildbot_config 15:32:45 INFO - Using buildbot properties: 15:32:45 INFO - { 15:32:45 INFO - "project": "", 15:32:45 INFO - "product": "firefox", 15:32:45 INFO - "script_repo_revision": "production", 15:32:45 INFO - "builddir": "autoland_ubuntu64_hw_test-dromaeojs", 15:32:45 INFO - "repository": "", 15:32:45 INFO - "buildername": "Ubuntu HW 12.04 x64 autoland pgo talos dromaeojs", 15:32:45 INFO - "buildid": "20161014123005", 15:32:45 INFO - "pgo_build": "True", 15:32:45 INFO - "basedir": "/builds/slave/test", 15:32:45 INFO - "buildnumber": 349, 15:32:45 INFO - "slavename": "talos-linux64-ix-047", 15:32:45 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 15:32:45 INFO - "platform": "ubuntu64_hw", 15:32:45 INFO - "scheduler": "tests-autoland-linux64-pgo-talos", 15:32:45 INFO - "branch": "autoland", 15:32:45 INFO - "repo_path": "integration/autoland", 15:32:45 INFO - "revision": "3ccac82a6bcff2da20a93b056a4a21663fc35652", 15:32:45 INFO - "stage_platform": "linux64-pgo", 15:32:45 INFO - "builduid": "aa96268848e0429397a9e7f83e7757fb", 15:32:45 INFO - "slavebuilddir": "test" 15:32:45 INFO - } 15:32:45 INFO - Found installer url https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 15:32:45 INFO - Running post-action listener: _resource_record_post_action 15:32:45 INFO - [mozharness: 2016-10-14 22:32:45.786703Z] Finished read-buildbot-config step (success) 15:32:45 INFO - [mozharness: 2016-10-14 22:32:45.786792Z] Running download-and-extract step. 15:32:45 INFO - Running pre-action listener: _resource_record_pre_action 15:32:45 INFO - Running main action method: download_and_extract 15:32:45 INFO - mkdir: /builds/slave/test/build/tests 15:32:45 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')]} 15:32:45 INFO - trying https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 15:32:45 INFO - Downloading https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 15:32:45 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 15:32:46 INFO - Downloaded 1361 bytes. 15:32:46 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 15:32:46 INFO - Using the following test package requirements: 15:32:46 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 15:32:46 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 15:32:46 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 15:32:46 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 15:32:46 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 15:32:46 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 15:32:46 INFO - u'jsshell-linux-x86_64.zip'], 15:32:46 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 15:32:46 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 15:32:46 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 15:32:46 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 15:32:46 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 15:32:46 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 15:32:46 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 15:32:46 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 15:32:46 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 15:32:46 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 15:32:46 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 15:32:46 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 15:32:46 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 15:32:46 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 15:32:46 INFO - Fetch https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 15:32:47 INFO - Http code: 200 15:32:47 INFO - via: 1.1 336f0e6ef9a3462f682d6ca49029b665.cloudfront.net (CloudFront) 15:32:47 INFO - x-amz-cf-id: tpy3WZB75yUFniaPmUUrSTM0rGx6CtRS_pXIHRqwjp1Eir-MdP29AQ== 15:32:47 INFO - x-amz-version-id: I_QuiLuLUs8EkU_rYrEdGpKMZ2wwnTkF 15:32:48 INFO - Expected file size: 22123060 15:32:48 INFO - Obtained file size: 22123060 15:32:52 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'] for test suite category: talos 15:32:52 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 15:32:52 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 15:32:52 INFO - Fetch https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 15:32:52 INFO - Http code: 200 15:32:52 INFO - via: 1.1 bfc29822e21ecc352f71dce83e06ab74.cloudfront.net (CloudFront) 15:32:52 INFO - x-amz-cf-id: arFEvnLa6i5AA7tJrAd_boVSqsnFBRf6frkTI9cIXvXGk1R-lQF_FQ== 15:32:52 INFO - x-amz-version-id: I_QuiLuLUs8EkU_rYrEdGpKMZ2wwnTkF 15:32:53 INFO - Expected file size: 22123060 15:32:53 INFO - Obtained file size: 22123060 15:32:57 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 15:32:57 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 15:32:57 INFO - Fetch https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 15:32:58 INFO - Http code: 200 15:32:58 INFO - via: 1.1 032d42677fbf05c24a4bb71369581429.cloudfront.net (CloudFront) 15:32:58 INFO - x-amz-cf-id: bjPn7Gwjk3jzmzZf5rTBWNrGD9vNXgYi_MP92r6Aej0qT1dXlbC4Vg== 15:32:58 INFO - x-amz-version-id: 2gl6CviBdqaKtcymLe4oa8_ryHM2xWFw 15:32:59 INFO - Expected file size: 14409006 15:32:59 INFO - Obtained file size: 14409006 15:32: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')]} 15:32:59 INFO - trying https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 15:32:59 INFO - Downloading https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 15:32:59 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 15:33:02 INFO - Downloaded 59518845 bytes. 15:33:02 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 15:33:02 INFO - mkdir: /builds/slave/test/properties 15:33:02 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 15:33:02 INFO - Writing to file /builds/slave/test/properties/build_url 15:33:02 INFO - Contents: 15:33:02 INFO - build_url:https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 15:33:02 INFO - Running post-action listener: _resource_record_post_action 15:33:02 INFO - Running post-action listener: set_extra_try_arguments 15:33:02 INFO - [mozharness: 2016-10-14 22:33:02.755374Z] Finished download-and-extract step (success) 15:33:02 INFO - [mozharness: 2016-10-14 22:33:02.755600Z] Running populate-webroot step. 15:33:02 INFO - Running pre-action listener: _resource_record_pre_action 15:33:02 INFO - Running main action method: populate_webroot 15:33:02 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 15:33:02 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 15:33:02 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 15:33:02 INFO - '--tppagecycles', 15:33:02 INFO - '7'], 15:33:02 INFO - 'tests': ['tsvgm']}}, 15:33:02 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 15:33:02 INFO - 'tests': ['tresize', 'tcanvasmark']}, 15:33:02 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 15:33:02 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 15:33:02 INFO - 'tests': ['dromaeo_css', 'kraken']}, 15:33:02 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 15:33:02 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:02 INFO - 'talos_options': ['--disable-e10s'], 15:33:02 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:33:02 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:02 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 15:33:02 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:02 INFO - 'talos_options': ['--disable-e10s'], 15:33:02 INFO - 'tests': ['damp', 'tps']}, 15:33:02 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:02 INFO - 'tests': ['damp', 'tps']}, 15:33:02 INFO - 'g3': {'talos_options': ['--disable-e10s'], 15:33:02 INFO - 'tests': ['dromaeo_dom']}, 15:33:02 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 15:33:02 INFO - 'g4': {'talos_options': ['--disable-e10s'], 15:33:02 INFO - 'tests': ['basic_compositor_video']}, 15:33:02 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 15:33:02 INFO - 'other': {'talos_options': ['--disable-e10s'], 15:33:02 INFO - 'tests': ['a11yr', 15:33:02 INFO - 'ts_paint', 15:33:02 INFO - 'tpaint', 15:33:02 INFO - 'sessionrestore', 15:33:02 INFO - 'sessionrestore_no_auto_restore', 15:33:02 INFO - 'tabpaint']}, 15:33:02 INFO - 'other-e10s': {'tests': ['a11yr', 15:33:02 INFO - 'ts_paint', 15:33:02 INFO - 'tpaint', 15:33:02 INFO - 'sessionrestore', 15:33:02 INFO - 'sessionrestore_no_auto_restore', 15:33:02 INFO - 'tabpaint']}, 15:33:02 INFO - 'other-e10s_l64': {'tests': ['a11yr', 15:33:02 INFO - 'ts_paint', 15:33:02 INFO - 'tpaint', 15:33:02 INFO - 'sessionrestore', 15:33:02 INFO - 'sessionrestore_no_auto_restore', 15:33:02 INFO - 'tabpaint']}, 15:33:02 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 15:33:02 INFO - 'ts_paint', 15:33:02 INFO - 'tpaint', 15:33:02 INFO - 'sessionrestore', 15:33:02 INFO - 'sessionrestore_no_auto_restore', 15:33:02 INFO - 'tabpaint']}, 15:33:02 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 15:33:02 INFO - 'tests': ['a11yr', 15:33:02 INFO - 'ts_paint', 15:33:02 INFO - 'tpaint', 15:33:02 INFO - 'sessionrestore', 15:33:02 INFO - 'sessionrestore_no_auto_restore', 15:33:02 INFO - 'tabpaint']}, 15:33:02 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 15:33:02 INFO - 'tests': ['a11yr', 15:33:02 INFO - 'ts_paint', 15:33:02 INFO - 'tpaint', 15:33:02 INFO - 'sessionrestore', 15:33:02 INFO - 'sessionrestore_no_auto_restore', 15:33:02 INFO - 'tabpaint']}, 15:33:02 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 15:33:02 INFO - 'tests': ['tsvgx', 15:33:02 INFO - 'tsvgr_opacity', 15:33:02 INFO - 'tart', 15:33:02 INFO - 'tscrollx', 15:33:02 INFO - 'cart']}, 15:33:02 INFO - 'svgr-e10s': {'tests': ['tsvgx', 15:33:02 INFO - 'tsvgr_opacity', 15:33:02 INFO - 'tart', 15:33:02 INFO - 'tscrollx', 15:33:02 INFO - 'cart']}, 15:33:02 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:02 INFO - 'talos_options': ['--disable-e10s'], 15:33:02 INFO - 'tests': ['tp5o']}, 15:33:02 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:02 INFO - 'tests': ['tp5o']}, 15:33:02 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:02 INFO - 'talos_options': ['--disable-e10s', 15:33:02 INFO - '--xperf_path', 15:33:02 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:33:02 INFO - 'tests': ['tp5n']}, 15:33:02 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 15:33:02 INFO - 'talos_options': ['--xperf_path', 15:33:02 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 15:33:02 INFO - 'tests': ['tp5n']}}, 15:33:02 INFO - 'talos.zip': {'path': '', 15:33:02 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 15:33:02 INFO - Running post-action listener: _resource_record_post_action 15:33:02 INFO - [mozharness: 2016-10-14 22:33:02.774991Z] Finished populate-webroot step (success) 15:33:02 INFO - [mozharness: 2016-10-14 22:33:02.775079Z] Running create-virtualenv step. 15:33:02 INFO - Running pre-action listener: _resource_record_pre_action 15:33:02 INFO - Running main action method: create_virtualenv 15:33:02 INFO - Creating virtualenv /builds/slave/test/build/venv 15:33:02 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 15:33:02 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 15:33:02 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 15:33:02 INFO - Using real prefix '/usr' 15:33:02 INFO - New python executable in /builds/slave/test/build/venv/bin/python 15:33:03 INFO - Installing distribute.............................................................................................................................................................................................done. 15:33:05 INFO - Installing pip.................done. 15:33:05 INFO - Return code: 0 15:33:05 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 15:33:05 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 15:33:05 INFO - Reading from file tmpfile_stdout 15:33:05 INFO - Output received: 15:33:05 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 15:33:05 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 15:33: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')]} 15:33:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:33:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33: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')]} 15:33:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:33:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33:05 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 0x7f64d1e82f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a448a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b107b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b9f790>, '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 0x2ba0690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ba0b20>, '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': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', '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 15:33:05 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 15:33:05 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 15:33:05 INFO - Using env: {'DISPLAY': ':0', 15:33:05 INFO - 'HOME': '/home/cltbld', 15:33:05 INFO - 'LANG': 'en_US.UTF-8', 15:33:05 INFO - 'LANGUAGE': 'en_US:en', 15:33:05 INFO - 'LOGNAME': 'cltbld', 15:33:05 INFO - 'MAIL': '/var/mail/cltbld', 15:33:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:33:05 INFO - 'MOZ_NO_REMOTE': '1', 15:33:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:33:05 INFO - 'NO_EM_RESTART': '1', 15:33:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:33:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:33:05 INFO - 'PWD': '/builds/slave/test', 15:33:05 INFO - 'SHELL': '/bin/bash', 15:33:05 INFO - 'SHLVL': '1', 15:33:05 INFO - 'TERM': 'linux', 15:33:05 INFO - 'TMOUT': '86400', 15:33:05 INFO - 'USER': 'cltbld', 15:33:05 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', 15:33:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:33:05 INFO - '_': '/tools/buildbot/bin/python'} 15:33:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:33:05 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 15:33:05 INFO - Cleaning up... 15:33:05 INFO - Return code: 0 15:33:05 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 15:33: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')]} 15:33:05 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:33:05 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33: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')]} 15:33:05 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:33:05 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33:05 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 0x7f64d1e82f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a448a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b107b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b9f790>, '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 0x2ba0690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ba0b20>, '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': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', '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 15:33:05 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 15:33:05 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 15:33:05 INFO - Using env: {'DISPLAY': ':0', 15:33:05 INFO - 'HOME': '/home/cltbld', 15:33:05 INFO - 'LANG': 'en_US.UTF-8', 15:33:05 INFO - 'LANGUAGE': 'en_US:en', 15:33:05 INFO - 'LOGNAME': 'cltbld', 15:33:05 INFO - 'MAIL': '/var/mail/cltbld', 15:33:05 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:33:05 INFO - 'MOZ_NO_REMOTE': '1', 15:33:05 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:33:05 INFO - 'NO_EM_RESTART': '1', 15:33:05 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:33:05 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:33:05 INFO - 'PWD': '/builds/slave/test', 15:33:05 INFO - 'SHELL': '/bin/bash', 15:33:05 INFO - 'SHLVL': '1', 15:33:05 INFO - 'TERM': 'linux', 15:33:05 INFO - 'TMOUT': '86400', 15:33:05 INFO - 'USER': 'cltbld', 15:33:05 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', 15:33:05 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:33:05 INFO - '_': '/tools/buildbot/bin/python'} 15:33:05 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:33:05 INFO - Downloading/unpacking psutil>=3.1.1 15:33:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:33:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:33:05 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 15:33:05 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 15:33:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 15:33:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 15:33:07 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 15:33:08 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:33:08 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:33:08 INFO - Installing collected packages: psutil 15:33:08 INFO - Running setup.py install for psutil 15:33:08 INFO - building 'psutil._psutil_linux' extension 15:33:08 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 15:33:08 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 15:33:08 INFO - building 'psutil._psutil_posix' extension 15:33:08 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 15:33:08 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 15:33:08 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 15:33:08 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 15:33:08 INFO - Successfully installed psutil 15:33:08 INFO - Cleaning up... 15:33:08 INFO - Return code: 0 15:33:08 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 15:33:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:33:08 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:33:08 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33:08 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:33:08 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:33:08 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33:08 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 0x7f64d1e82f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a448a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b107b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b9f790>, '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 0x2ba0690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ba0b20>, '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': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', '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 15:33:08 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 15:33:08 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 15:33:08 INFO - Using env: {'DISPLAY': ':0', 15:33:08 INFO - 'HOME': '/home/cltbld', 15:33:08 INFO - 'LANG': 'en_US.UTF-8', 15:33:08 INFO - 'LANGUAGE': 'en_US:en', 15:33:08 INFO - 'LOGNAME': 'cltbld', 15:33:08 INFO - 'MAIL': '/var/mail/cltbld', 15:33:08 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:33:08 INFO - 'MOZ_NO_REMOTE': '1', 15:33:08 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:33:08 INFO - 'NO_EM_RESTART': '1', 15:33:08 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:33:08 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:33:08 INFO - 'PWD': '/builds/slave/test', 15:33:08 INFO - 'SHELL': '/bin/bash', 15:33:08 INFO - 'SHLVL': '1', 15:33:08 INFO - 'TERM': 'linux', 15:33:08 INFO - 'TMOUT': '86400', 15:33:08 INFO - 'USER': 'cltbld', 15:33:08 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', 15:33:08 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:33:08 INFO - '_': '/tools/buildbot/bin/python'} 15:33:08 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:33:08 INFO - Downloading/unpacking mozsystemmonitor==0.3 15:33:08 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 15:33:08 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 15:33:08 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 15:33:08 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 15:33:08 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 15:33:08 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 15:33:10 INFO - Downloading mozsystemmonitor-0.3.tar.gz 15:33:10 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 15:33:10 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 15:33:10 INFO - Installing collected packages: mozsystemmonitor 15:33:10 INFO - Running setup.py install for mozsystemmonitor 15:33:10 INFO - Successfully installed mozsystemmonitor 15:33:10 INFO - Cleaning up... 15:33:10 INFO - Return code: 0 15:33:10 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 15:33: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')]} 15:33:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:33:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33: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')]} 15:33:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:33:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33: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', '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 0x7f64d1e82f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a448a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b107b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b9f790>, '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 0x2ba0690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ba0b20>, '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': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', '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 15:33: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', 'jsonschema==2.5.1'] in /builds/slave/test/build 15:33: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 jsonschema==2.5.1 15:33:10 INFO - Using env: {'DISPLAY': ':0', 15:33:10 INFO - 'HOME': '/home/cltbld', 15:33:10 INFO - 'LANG': 'en_US.UTF-8', 15:33:10 INFO - 'LANGUAGE': 'en_US:en', 15:33:10 INFO - 'LOGNAME': 'cltbld', 15:33:10 INFO - 'MAIL': '/var/mail/cltbld', 15:33:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:33:10 INFO - 'MOZ_NO_REMOTE': '1', 15:33:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:33:10 INFO - 'NO_EM_RESTART': '1', 15:33:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:33:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:33:10 INFO - 'PWD': '/builds/slave/test', 15:33:10 INFO - 'SHELL': '/bin/bash', 15:33:10 INFO - 'SHLVL': '1', 15:33:10 INFO - 'TERM': 'linux', 15:33:10 INFO - 'TMOUT': '86400', 15:33:10 INFO - 'USER': 'cltbld', 15:33:10 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', 15:33:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:33:10 INFO - '_': '/tools/buildbot/bin/python'} 15:33:11 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:33:11 INFO - Downloading/unpacking jsonschema==2.5.1 15:33:11 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 15:33:11 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 15:33:11 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 15:33:11 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 15:33:11 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 15:33:11 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 15:33:13 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 15:33:13 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 15:33: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 15:33: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 15:33: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 15:33: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 15:33: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 15:33: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 15:33:13 INFO - Downloading functools32-3.2.3-2.tar.gz 15:33:13 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 15:33:13 INFO - warning: no files found matching '*.txt' 15:33:13 INFO - no previously-included directories found matching 'build' 15:33:13 INFO - no previously-included directories found matching 'dist' 15:33:13 INFO - no previously-included directories found matching '.git*' 15:33:13 INFO - Installing collected packages: jsonschema, functools32 15:33:13 INFO - Running setup.py install for functools32 15:33:13 INFO - warning: no files found matching '*.txt' 15:33:13 INFO - no previously-included directories found matching 'build' 15:33:13 INFO - no previously-included directories found matching 'dist' 15:33:13 INFO - no previously-included directories found matching '.git*' 15:33:13 INFO - Successfully installed jsonschema functools32 15:33:13 INFO - Cleaning up... 15:33:13 INFO - Return code: 0 15:33:13 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 15:33: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')]} 15:33:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:33:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33: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')]} 15:33:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:33:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33: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', '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 0x7f64d1e82f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a448a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b107b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b9f790>, '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 0x2ba0690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ba0b20>, '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': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', '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 15:33: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', 'functools32==3.2.3-2'] in /builds/slave/test/build 15:33: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 functools32==3.2.3-2 15:33:13 INFO - Using env: {'DISPLAY': ':0', 15:33:13 INFO - 'HOME': '/home/cltbld', 15:33:13 INFO - 'LANG': 'en_US.UTF-8', 15:33:13 INFO - 'LANGUAGE': 'en_US:en', 15:33:13 INFO - 'LOGNAME': 'cltbld', 15:33:13 INFO - 'MAIL': '/var/mail/cltbld', 15:33:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:33:13 INFO - 'MOZ_NO_REMOTE': '1', 15:33:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:33:13 INFO - 'NO_EM_RESTART': '1', 15:33:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:33:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:33:13 INFO - 'PWD': '/builds/slave/test', 15:33:13 INFO - 'SHELL': '/bin/bash', 15:33:13 INFO - 'SHLVL': '1', 15:33:13 INFO - 'TERM': 'linux', 15:33:13 INFO - 'TMOUT': '86400', 15:33:13 INFO - 'USER': 'cltbld', 15:33:13 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', 15:33:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:33:13 INFO - '_': '/tools/buildbot/bin/python'} 15:33:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:33:13 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 15:33:13 INFO - Cleaning up... 15:33:13 INFO - Return code: 0 15:33:13 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 15:33: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')]} 15:33:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:33:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33: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')]} 15:33:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:33:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33: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', '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 0x7f64d1e82f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a448a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b107b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b9f790>, '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 0x2ba0690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ba0b20>, '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': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', '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 15:33: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', 'blobuploader==1.2.4'] in /builds/slave/test/build 15:33: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 blobuploader==1.2.4 15:33:13 INFO - Using env: {'DISPLAY': ':0', 15:33:13 INFO - 'HOME': '/home/cltbld', 15:33:13 INFO - 'LANG': 'en_US.UTF-8', 15:33:13 INFO - 'LANGUAGE': 'en_US:en', 15:33:13 INFO - 'LOGNAME': 'cltbld', 15:33:13 INFO - 'MAIL': '/var/mail/cltbld', 15:33:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:33:13 INFO - 'MOZ_NO_REMOTE': '1', 15:33:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:33:13 INFO - 'NO_EM_RESTART': '1', 15:33:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:33:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:33:13 INFO - 'PWD': '/builds/slave/test', 15:33:13 INFO - 'SHELL': '/bin/bash', 15:33:13 INFO - 'SHLVL': '1', 15:33:13 INFO - 'TERM': 'linux', 15:33:13 INFO - 'TMOUT': '86400', 15:33:13 INFO - 'USER': 'cltbld', 15:33:13 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', 15:33:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:33:13 INFO - '_': '/tools/buildbot/bin/python'} 15:33:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:33:14 INFO - Downloading/unpacking blobuploader==1.2.4 15:33:14 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 15:33:14 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 15:33:14 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 15:33:14 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 15:33:14 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 15:33:14 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 15:33:15 INFO - Downloading blobuploader-1.2.4.tar.gz 15:33:15 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 15:33:15 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 15:33:15 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 15:33:15 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 15:33:15 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 15:33:15 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 15:33:15 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 15:33:15 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 15:33:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 15:33:16 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 15:33: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 15:33: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 15:33: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 15:33: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 15:33: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 15:33: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 15:33:16 INFO - Downloading docopt-0.6.1.tar.gz 15:33:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 15:33:16 INFO - Installing collected packages: blobuploader, requests, docopt 15:33:16 INFO - Running setup.py install for blobuploader 15:33:16 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 15:33:16 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 15:33:16 INFO - Running setup.py install for requests 15:33:17 INFO - Running setup.py install for docopt 15:33:17 INFO - Successfully installed blobuploader requests docopt 15:33:17 INFO - Cleaning up... 15:33:17 INFO - Return code: 0 15:33:17 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:33:17 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')]} 15:33:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:33:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33:17 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')]} 15:33:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:33:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33:17 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 0x7f64d1e82f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a448a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b107b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b9f790>, '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 0x2ba0690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ba0b20>, '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': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', '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 15:33:17 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 15:33:17 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 15:33:17 INFO - Using env: {'DISPLAY': ':0', 15:33:17 INFO - 'HOME': '/home/cltbld', 15:33:17 INFO - 'LANG': 'en_US.UTF-8', 15:33:17 INFO - 'LANGUAGE': 'en_US:en', 15:33:17 INFO - 'LOGNAME': 'cltbld', 15:33:17 INFO - 'MAIL': '/var/mail/cltbld', 15:33:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:33:17 INFO - 'MOZ_NO_REMOTE': '1', 15:33:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:33:17 INFO - 'NO_EM_RESTART': '1', 15:33:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:33:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:33:17 INFO - 'PWD': '/builds/slave/test', 15:33:17 INFO - 'SHELL': '/bin/bash', 15:33:17 INFO - 'SHLVL': '1', 15:33:17 INFO - 'TERM': 'linux', 15:33:17 INFO - 'TMOUT': '86400', 15:33:17 INFO - 'USER': 'cltbld', 15:33:17 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', 15:33:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:33:17 INFO - '_': '/tools/buildbot/bin/python'} 15:33:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:33:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:33:17 INFO - Running setup.py (path:/tmp/pip-7CKEeV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:33:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:33:17 INFO - Running setup.py (path:/tmp/pip-3eQDBY-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:33:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:33:17 INFO - Running setup.py (path:/tmp/pip-BHNert-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:33:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:33:17 INFO - Running setup.py (path:/tmp/pip-FISQSA-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:33:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:33:17 INFO - Running setup.py (path:/tmp/pip-rLBiPa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:33:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:33:17 INFO - Running setup.py (path:/tmp/pip-A6A9bi-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:33:17 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:33:17 INFO - Running setup.py (path:/tmp/pip-QDpz6B-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:33:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:33:18 INFO - Running setup.py (path:/tmp/pip-ZUbz5H-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:33:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:33:18 INFO - Running setup.py (path:/tmp/pip-sD1IF5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:33:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:33:18 INFO - Running setup.py (path:/tmp/pip-MeDpFW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:33:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:33:18 INFO - Running setup.py (path:/tmp/pip-oE5dA5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:33:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:33:18 INFO - Running setup.py (path:/tmp/pip-DiFxrL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:33:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:33:18 INFO - Running setup.py (path:/tmp/pip-vDfXZ5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:33:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:33:18 INFO - Running setup.py (path:/tmp/pip-E0gbir-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:33:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:33:18 INFO - Running setup.py (path:/tmp/pip-oxkCKS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:33:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:33:18 INFO - Running setup.py (path:/tmp/pip-Wdvc2T-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:33:18 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:33:18 INFO - Running setup.py (path:/tmp/pip-2mKdhP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:33:18 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 15:33:18 INFO - Running setup.py install for manifestparser 15:33:18 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 15:33:18 INFO - Running setup.py install for mozcrash 15:33:18 INFO - Running setup.py install for mozdebug 15:33:19 INFO - Running setup.py install for mozdevice 15:33:19 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 15:33:19 INFO - Installing dm script to /builds/slave/test/build/venv/bin 15:33:19 INFO - Running setup.py install for mozfile 15:33:19 INFO - Running setup.py install for mozhttpd 15:33:19 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 15:33:19 INFO - Running setup.py install for mozinfo 15:33:19 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 15:33:19 INFO - Running setup.py install for mozInstall 15:33:19 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 15:33:19 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 15:33:19 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 15:33:19 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 15:33:19 INFO - Running setup.py install for mozleak 15:33:19 INFO - Running setup.py install for mozlog 15:33:19 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 15:33:19 INFO - Running setup.py install for moznetwork 15:33:19 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 15:33:19 INFO - Running setup.py install for mozprocess 15:33:19 INFO - Running setup.py install for mozprofile 15:33:20 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 15:33:20 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 15:33:20 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 15:33:20 INFO - Running setup.py install for mozrunner 15:33:20 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 15:33:20 INFO - Running setup.py install for mozscreenshot 15:33:20 INFO - Running setup.py install for moztest 15:33:20 INFO - Running setup.py install for mozversion 15:33:20 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 15:33:20 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 15:33:20 INFO - Cleaning up... 15:33:20 INFO - Return code: 0 15:33:20 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:33:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:33:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:33:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:33:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:33:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33:20 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 0x7f64d1e82f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a448a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b107b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b9f790>, '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 0x2ba0690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ba0b20>, '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': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', '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 15:33:20 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 15:33:20 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 15:33:20 INFO - Using env: {'DISPLAY': ':0', 15:33:20 INFO - 'HOME': '/home/cltbld', 15:33:20 INFO - 'LANG': 'en_US.UTF-8', 15:33:20 INFO - 'LANGUAGE': 'en_US:en', 15:33:20 INFO - 'LOGNAME': 'cltbld', 15:33:20 INFO - 'MAIL': '/var/mail/cltbld', 15:33:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:33:20 INFO - 'MOZ_NO_REMOTE': '1', 15:33:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:33:20 INFO - 'NO_EM_RESTART': '1', 15:33:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:33:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:33:20 INFO - 'PWD': '/builds/slave/test', 15:33:20 INFO - 'SHELL': '/bin/bash', 15:33:20 INFO - 'SHLVL': '1', 15:33:20 INFO - 'TERM': 'linux', 15:33:20 INFO - 'TMOUT': '86400', 15:33:20 INFO - 'USER': 'cltbld', 15:33:20 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', 15:33:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:33:20 INFO - '_': '/tools/buildbot/bin/python'} 15:33:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:33:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 15:33:20 INFO - Running setup.py (path:/tmp/pip-G8NNj6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 15:33:20 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)) 15:33:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 15:33:20 INFO - Running setup.py (path:/tmp/pip-mOroIl-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 15:33:20 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)) 15:33:20 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 15:33:20 INFO - Running setup.py (path:/tmp/pip-8Up96l-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 15:33:21 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)) 15:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 15:33:21 INFO - Running setup.py (path:/tmp/pip-6TnWsm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 15:33:21 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)) 15:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 15:33:21 INFO - Running setup.py (path:/tmp/pip-kUYEL0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 15:33:21 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)) 15:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 15:33:21 INFO - Running setup.py (path:/tmp/pip-wRaaRP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 15:33:21 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)) 15:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 15:33:21 INFO - Running setup.py (path:/tmp/pip-2Fe7HV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 15:33:21 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)) 15:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 15:33:21 INFO - Running setup.py (path:/tmp/pip-HJz84V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 15:33:21 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)) 15:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 15:33:21 INFO - Running setup.py (path:/tmp/pip-jP2R2S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 15:33:21 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)) 15:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 15:33:21 INFO - Running setup.py (path:/tmp/pip-xW6UnI-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 15:33:21 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog==3.4 from file:///builds/slave/test/build/tests/mozbase/mozlog in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 15:33:21 INFO - Running setup.py (path:/tmp/pip-MHGhYR-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 15:33:21 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)) 15:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 15:33:21 INFO - Running setup.py (path:/tmp/pip-7tBlJV-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 15:33:21 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)) 15:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 15:33:21 INFO - Running setup.py (path:/tmp/pip-fzxSoC-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 15:33:21 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)) 15:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 15:33:21 INFO - Running setup.py (path:/tmp/pip-j0Ojmb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 15:33:21 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)) 15:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 15:33:21 INFO - Running setup.py (path:/tmp/pip-hTDT4W-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 15:33:21 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)) 15:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 15:33:21 INFO - Running setup.py (path:/tmp/pip-oNVWzZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 15:33:21 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)) 15:33:21 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 15:33:21 INFO - Running setup.py (path:/tmp/pip-2b2r1S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 15:33:22 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)) 15:33:22 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)) 15:33:22 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)) 15:33:22 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)) 15:33:22 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)) 15:33:22 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)) 15:33:22 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 15:33:22 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 15:33:22 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 15:33:22 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 15:33:22 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 15:33:22 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 15:33:22 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 15:33:23 INFO - Downloading blessings-1.6.tar.gz 15:33:23 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 15:33:24 INFO - Installing collected packages: blessings 15:33:24 INFO - Running setup.py install for blessings 15:33:24 INFO - Successfully installed blessings 15:33:24 INFO - Cleaning up... 15:33:24 INFO - Return code: 0 15:33:24 INFO - Done creating virtualenv /builds/slave/test/build/venv. 15:33:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:33:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:33:24 INFO - Reading from file tmpfile_stdout 15:33:24 INFO - Current package versions: 15:33:24 INFO - argparse == 1.2.1 15:33:24 INFO - blessings == 1.6 15:33:24 INFO - blobuploader == 1.2.4 15:33:24 INFO - docopt == 0.6.1 15:33:24 INFO - functools32 == 3.2.3-2 15:33:24 INFO - jsonschema == 2.5.1 15:33:24 INFO - manifestparser == 1.1 15:33:24 INFO - mozInstall == 1.12 15:33:24 INFO - mozcrash == 0.17 15:33:24 INFO - mozdebug == 0.1 15:33:24 INFO - mozdevice == 0.48 15:33:24 INFO - mozfile == 1.2 15:33:24 INFO - mozhttpd == 0.7 15:33:24 INFO - mozinfo == 0.9 15:33:24 INFO - mozleak == 0.1 15:33:24 INFO - mozlog == 3.4 15:33:24 INFO - moznetwork == 0.27 15:33:24 INFO - mozprocess == 0.23 15:33:24 INFO - mozprofile == 0.28 15:33:24 INFO - mozrunner == 6.12 15:33:24 INFO - mozscreenshot == 0.1 15:33:24 INFO - mozsystemmonitor == 0.3 15:33:24 INFO - moztest == 0.7 15:33:24 INFO - mozversion == 1.4 15:33:24 INFO - psutil == 3.1.1 15:33:24 INFO - requests == 1.2.3 15:33:24 INFO - wsgiref == 0.1.2 15:33:24 INFO - Installing None into virtualenv /builds/slave/test/build/venv 15:33:24 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')]} 15:33:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:33:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33:24 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')]} 15:33:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:33:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33:24 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 0x7f64d1e82f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a448a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b107b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b9f790>, '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 0x2ba0690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ba0b20>, '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': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', '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 15:33:24 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 15:33:24 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 15:33:24 INFO - Using env: {'DISPLAY': ':0', 15:33:24 INFO - 'HOME': '/home/cltbld', 15:33:24 INFO - 'LANG': 'en_US.UTF-8', 15:33:24 INFO - 'LANGUAGE': 'en_US:en', 15:33:24 INFO - 'LOGNAME': 'cltbld', 15:33:24 INFO - 'MAIL': '/var/mail/cltbld', 15:33:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:33:24 INFO - 'MOZ_NO_REMOTE': '1', 15:33:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:33:24 INFO - 'NO_EM_RESTART': '1', 15:33:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:33:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:33:24 INFO - 'PWD': '/builds/slave/test', 15:33:24 INFO - 'SHELL': '/bin/bash', 15:33:24 INFO - 'SHLVL': '1', 15:33:24 INFO - 'TERM': 'linux', 15:33:24 INFO - 'TMOUT': '86400', 15:33:24 INFO - 'USER': 'cltbld', 15:33:24 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', 15:33:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:33:24 INFO - '_': '/tools/buildbot/bin/python'} 15:33:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:33:24 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)) 15:33:24 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)) 15:33:24 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)) 15:33:24 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)) 15:33:24 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)) 15:33:24 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)) 15:33:24 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)) 15:33:24 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)) 15:33:24 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)) 15:33:24 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)) 15:33:24 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)) 15:33:24 INFO - Cleaning up... 15:33:24 INFO - Return code: 0 15:33:24 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 15:33:24 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')]} 15:33:24 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 15:33:24 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33:24 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')]} 15:33:24 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 15:33:24 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 15:33:24 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 0x7f64d1e82f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2a448a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x2b107b0>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x2b9f790>, '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 0x2ba0690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ba0b20>, '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': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', '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 15:33:24 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 15:33:24 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 15:33:24 INFO - Using env: {'DISPLAY': ':0', 15:33:24 INFO - 'HOME': '/home/cltbld', 15:33:24 INFO - 'LANG': 'en_US.UTF-8', 15:33:24 INFO - 'LANGUAGE': 'en_US:en', 15:33:24 INFO - 'LOGNAME': 'cltbld', 15:33:24 INFO - 'MAIL': '/var/mail/cltbld', 15:33:24 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:33:24 INFO - 'MOZ_NO_REMOTE': '1', 15:33:24 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:33:24 INFO - 'NO_EM_RESTART': '1', 15:33:24 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:33:24 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:33:24 INFO - 'PWD': '/builds/slave/test', 15:33:24 INFO - 'SHELL': '/bin/bash', 15:33:24 INFO - 'SHLVL': '1', 15:33:24 INFO - 'TERM': 'linux', 15:33:24 INFO - 'TMOUT': '86400', 15:33:24 INFO - 'USER': 'cltbld', 15:33:24 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', 15:33:24 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:33:24 INFO - '_': '/tools/buildbot/bin/python'} 15:33:24 INFO - Ignoring indexes: https://pypi.python.org/simple/ 15:33:24 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 15:33:24 INFO - Cleaning up... 15:33:24 INFO - Return code: 0 15:33:24 INFO - Running post-action listener: _resource_record_post_action 15:33:24 INFO - Running post-action listener: _start_resource_monitoring 15:33:24 INFO - Starting resource monitoring. 15:33:24 INFO - [mozharness: 2016-10-14 22:33:24.947598Z] Finished create-virtualenv step (success) 15:33:24 INFO - [mozharness: 2016-10-14 22:33:24.948113Z] Running install step. 15:33:24 INFO - Running pre-action listener: _resource_record_pre_action 15:33:24 INFO - Running main action method: install 15:33:24 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 15:33:24 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 15:33:25 INFO - Reading from file tmpfile_stdout 15:33:25 INFO - Detecting whether we're running mozinstall >=1.0... 15:33:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 15:33:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 15:33:25 INFO - Reading from file tmpfile_stdout 15:33:25 INFO - Output received: 15:33:25 INFO - Usage: mozinstall [options] installer 15:33:25 INFO - Options: 15:33:25 INFO - -h, --help show this help message and exit 15:33:25 INFO - -d DEST, --destination=DEST 15:33:25 INFO - Directory to install application into. [default: 15:33:25 INFO - "/builds/slave/test"] 15:33:25 INFO - --app=APP Application being installed. [default: firefox] 15:33:25 INFO - mkdir: /builds/slave/test/build/application 15:33:25 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', '--destination', '/builds/slave/test/build/application'] 15:33:25 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 --destination /builds/slave/test/build/application 15:33:42 INFO - Reading from file tmpfile_stdout 15:33:42 INFO - Output received: 15:33:42 INFO - /builds/slave/test/build/application/firefox/firefox 15:33:42 INFO - Running post-action listener: _resource_record_post_action 15:33:42 INFO - [mozharness: 2016-10-14 22:33:42.214795Z] Finished install step (success) 15:33:42 INFO - [mozharness: 2016-10-14 22:33:42.215041Z] Running run-tests step. 15:33:42 INFO - Running pre-action listener: _resource_record_pre_action 15:33:42 INFO - Running main action method: run_tests 15:33:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 15:33:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 15:33:42 INFO - Python 2.7.3 15:33:42 INFO - Return code: 0 15:33:42 INFO - grabbing minidump binary from tooltool 15:33:42 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 15:33:42 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 0x2b9f790>, '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 0x2ba0690>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x2ba0b20>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 15:33:42 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 15:33:42 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 15:33:42 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 15:33:42 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 15:33:42 INFO - Return code: 0 15:33:42 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 15:33:42 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 15:33:42 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 15:33:42 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 15:33:42 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 15:33:42 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-047', '--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 15:33:42 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Autoland --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-047 --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 15:33:42 INFO - Using env: {'DISPLAY': ':0', 15:33:42 INFO - 'HOME': '/home/cltbld', 15:33:42 INFO - 'LANG': 'en_US.UTF-8', 15:33:42 INFO - 'LANGUAGE': 'en_US:en', 15:33:42 INFO - 'LOGNAME': 'cltbld', 15:33:42 INFO - 'MAIL': '/var/mail/cltbld', 15:33:42 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 15:33:42 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 15:33:42 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 15:33:42 INFO - 'MOZ_NO_REMOTE': '1', 15:33:42 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 15:33:42 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 15:33:42 INFO - 'NO_EM_RESTART': '1', 15:33:42 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 15:33:42 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 15:33:42 INFO - 'PWD': '/builds/slave/test', 15:33:42 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 15:33:42 INFO - 'SHELL': '/bin/bash', 15:33:42 INFO - 'SHLVL': '1', 15:33:42 INFO - 'TERM': 'linux', 15:33:42 INFO - 'TMOUT': '86400', 15:33:42 INFO - 'USER': 'cltbld', 15:33:42 INFO - 'XDG_SESSION_COOKIE': '03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392', 15:33:42 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 15:33:42 INFO - '_': '/tools/buildbot/bin/python'} 15:33:42 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Autoland', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-047', '--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 15:33:42 INFO - mozversion application_buildid: 20161014123005 15:33:42 INFO - mozversion application_changeset: 3ccac82a6bcff2da20a93b056a4a21663fc35652 15:33:42 INFO - mozversion application_display_name: Nightly 15:33:42 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 15:33:42 INFO - mozversion application_name: Firefox 15:33:42 INFO - mozversion application_remotingname: firefox 15:33:42 INFO - mozversion application_repository: https://hg.mozilla.org/integration/autoland 15:33:42 INFO - mozversion application_vendor: Mozilla 15:33:42 INFO - mozversion application_version: 52.0a1 15:33:42 INFO - mozversion platform_buildid: 20161014123005 15:33:42 INFO - mozversion platform_changeset: 3ccac82a6bcff2da20a93b056a4a21663fc35652 15:33:42 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/autoland 15:33:42 INFO - mozversion platform_version: 52.0a1 15:33:42 INFO - using testdate: 1476484422 15:33:42 INFO - actual date: 1476484422 15:33:42 INFO - starting webserver on 'localhost:34419' 15:33:42 INFO - SUITE-START | Running 2 tests 15:33:42 INFO - TEST-START | dromaeo_css 15:33:42 INFO - operating with platform_type : linux_ 15:33:42 INFO - Initialising browser for dromaeo_css test... 15:33:42 INFO - TEST-INFO | started process 26829 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpRRkjG4/profile http://localhost:34419/getInfo.html) 15:33:46 INFO - PROCESS | 26829 | __metrics Screen width/height:1600/1200 15:33:46 INFO - PROCESS | 26829 | colorDepth:24 15:33:46 INFO - PROCESS | 26829 | Browser inner width/height: 1024/697 15:33:46 INFO - PROCESS | 26829 | __metrics 15:33:47 INFO - PROCESS | 26829 | 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" 15:33:47 INFO - PROCESS | 26829 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 15:33:48 INFO - PROCESS | 26829 | console.error: PushService: 15:33:48 INFO - PROCESS | 26829 | stateChangeProcessEnqueue: Error transitioning state 15:33:48 INFO - PROCESS | 26829 | UnknownError 15:33:48 INFO - TEST-INFO | 26829: exit 0 15:33:48 INFO - Browser initialized. 15:33:48 INFO - Running cycle 1/1 for dromaeo_css test... 15:33:48 INFO - TEST-INFO | started process 26911 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpRRkjG4/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 15:34:00 INFO - PROCESS | 26911 | RSS: Main: 171630592 15:34:00 INFO - PROCESS | 26911 | 15:34:51 INFO - PROCESS | 26911 | 1476484491783 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] 15:37:03 INFO - PROCESS | 26911 | Cycle 1(1): loaded http://localhost:34419/tests/dromaeo/cssquery-dojo.html (next: http://localhost:34419/tests/dromaeo/cssquery-ext.html) 15:37:04 INFO - PROCESS | 26911 | RSS: Main: 291037184 15:37:04 INFO - PROCESS | 26911 | 15:40:07 INFO - PROCESS | 26911 | Cycle 1(1): loaded http://localhost:34419/tests/dromaeo/cssquery-ext.html (next: http://localhost:34419/tests/dromaeo/cssquery-jquery.html) 15:40:07 INFO - PROCESS | 26911 | RSS: Main: 275673088 15:40:07 INFO - PROCESS | 26911 | 15:43:09 INFO - PROCESS | 26911 | Cycle 1(1): loaded http://localhost:34419/tests/dromaeo/cssquery-jquery.html (next: http://localhost:34419/tests/dromaeo/cssquery-mootools.html) 15:43:10 INFO - PROCESS | 26911 | RSS: Main: 214859776 15:43:10 INFO - PROCESS | 26911 | 15:46:12 INFO - PROCESS | 26911 | Cycle 1(1): loaded http://localhost:34419/tests/dromaeo/cssquery-mootools.html (next: http://localhost:34419/tests/dromaeo/cssquery-prototype.html) 15:46:12 INFO - PROCESS | 26911 | RSS: Main: 233451520 15:46:12 INFO - PROCESS | 26911 | 15:49:15 INFO - PROCESS | 26911 | Cycle 1(1): loaded http://localhost:34419/tests/dromaeo/cssquery-prototype.html (next: http://localhost:34419/tests/dromaeo/cssquery-yui.html) 15:49:16 INFO - PROCESS | 26911 | RSS: Main: 216727552 15:49:16 INFO - PROCESS | 26911 | 15:52:19 INFO - PROCESS | 26911 | Cycle 1(1): loaded http://localhost:34419/tests/dromaeo/cssquery-yui.html (next: http://localhost:34419/tests/dromaeo/cssquery-dojo.html) 15:52:19 INFO - PROCESS | 26911 | RSS: Main: 311058432 15:52:19 INFO - PROCESS | 26911 | 15:52:19 INFO - PROCESS | 26911 | __start_tp_report 15:52:19 INFO - PROCESS | 26911 | _x_x_mozilla_page_load 15:52:19 INFO - PROCESS | 26911 | _x_x_mozilla_page_load_details 15:52:19 INFO - PROCESS | 26911 | |i|pagename|runs| 15:52:19 INFO - PROCESS | 26911 | |0;dojo.html;2972.568977498263;2981.35900781332;2991.7307442330184;3010.202296391455;3055.526393409021;5072.315237442944;5171.560417364529;5243.37079550454;5326.360836699597;5326.866828329294;5189.143791274435;5218.060749065166;5230.34620672416;5230.372355317368;5232.633715639907;4717.221658426355;4780.641451891105;4803;4817.397825271841;4835.226363781796;4902.338184345122;4905.166121759292;4931.087748766472;4939.728314942677;4942.43162036365;4845.878853028685;4886.657933944625;4917.803287868481;4930.211166213407;4933.40799104108;4947.505249475078;4950.3069570260195;4960.900781984376;4969.0807200668;5010.048090862724;4743.407074115736;4777.116233496814;4839.927401088987;4871.878203044952;4880.048390563841;5344.465553444625;5363.9463605363835;5377.4084850666395;5386.084365657847;5470.835874923759;5695.629784064023;5737.598368114233;5752.482276595127;5753.482186603226;5758.884822303572;5520.447955204488;5677.772889084473;5689.146628005791;5785.768569257225;5802.361740208574;5285.7885684572575;5312.707801070939;5318.8936221276135;5324.440933701983;5384.596155288369;5799.5070419014855;5836.270466191726;5836.562257830679;5840.620359676607;5844.1818145459665;5358.089124848785;5581.720913954286;5585.385607583163;5585.497305242548;5588.993981083363;5483.122700367922;5661.433856614306;5681.545476361881;5774.364819869811;5778.133280008033;5637.3235211774845;5650;5692.288463942007;5694.06048002075;5712.11462223356;5708.143778433186;5715.8856822864145;5716.57125715573;5731.799387021434;5774.585226619505;4241.957580424156;4272.359146128106;4276;4398.626116780046;4413.558644135561;3932.272529581979;3935.822887970048;3965.6827453803626;3976.5426975897562;3982.303096958021;5526.50261476469;5537.169424586345;5541.445855414507;5542.113261878161;5546.833594992157;5564.86087847799;5616.494515493625;5665.2635157430095;5815.244018277597;5909.763609455574;5421.484958928895;5423.647462914898;5440.6735595864375;5495.175723641486;5500.834974950758;4974.875628109254;4977.0792403405485;4978;4985.052839960396;5012.373453318335;5666.206731057573;5794.594378393472;5920.082387229986;5924.881502369843;5925.259342582263;5689.630174038674;5758.971205143947;5764.308283006066;5772.04761214395;5830.62100963436;5950.7917222896995;5953.7916172935475;5960.254968128984;5962.135490353961;5964.194833697569;5460.208269800777;5630.549556035426;5635.182898479616;5639;5641.633293835887;5601.075822489243;5660.094384898396;5670;5720.914186287126;5809.157672137601;5540.556755459473;5591.692456914909;5595.692236927008;5607.158926161109;5614.101743720985;5556.555475561864;5600.0479918414785;5608.130739735348;5615.2700148982;5618.634788738719;5345.091334473072;5393.029254734185;5527.50252477279;5560.19377190297;5564.77740890376;5646.632968857176;5649.124385720055;5650.3219613646625;5661;5706.828795136153;5351.5451186648015;5385.8922821542565;5526.032944234663;5538.086215774352;5538.47384498472 15:52:19 INFO - PROCESS | 26911 | |1;ext.html;586.3257254157718;605.2283338743102;626.9655168965706;631.4790298004148;638.5913015669969;30881.84559077204;31541.68458315416;33386.8330658347;33422.49866252002;33451.16372090696;46286.53713462864;47543.52456475434;47728;47909.52090479103;47934;8835.867461988058;8963.820723585524;8978.191962723353;8978.86531702025;8984.101589840997;8183;8381;8853.026167121612;8939.240164586017;8946.23956963659;10555.683329500127;10783;10796.136309095293;11173.608923687672;11177.72055698606;10797.29817561856;10863.130949524018;10870;10879.945600271947;10883.67348979528;10547;10601.946990265;10623.787524249548;10625.574977000912;10638.680839574825;40501.79749101265;40971.1805763883;41009;41052.79473602613;41061.178776424305;3428.6571342865514;3861.362875125601;3861.4593956846065;3926.175503144343;3943.6647884929816;30893.146411215173;31213.37573248545;31457.21356966071;31684.683153168404;32875.50686739701;3906.8046597670004;3910.6284902934176;3911.3546264866263;4041.939370909439;4163.042500224965;328754;330471;331291.9999999976;331431;331744;33558.16104597405;34303.65696343055;34407.31185376278;55392.72303638456;55855;36042.45936310958;36047.4592881107;36149.27701445956;36202.637973620454;36210;14569.562913112624;14721.411143554138;14723.92638036803;14733.705325893423;14734.115953042852;12172.14794964344;12249;12255.816162757566;12260;12261.14172007951;7703.114141873644;7831.921680783119;7982.321502672222;8174.38692098095;8200.179982001871;3162.57305263791;3232;3241.0762932564576;3248.3503299340227;3253.4143854106014;945.3571571331423;977.5796407544682;1053.9156867450586;1075.0109898893038;1100.1913593508764;30674.38651226963;31125.688743112732;32158.517622235686;32704.67295327016;34554.30891382158;1031.515187861704;1040.8646875906236;1106.0322218059198;1110.4336788238056;1113.6881673131536;15380.92309538445;16129.838701612834;16275.918620406823;16297.266623001993;16713.665726685642;494292;497316;497938;499169;501338;54560.544775484406;54888;54951.450485494635;54964;54979.45020549823;1237.9381030948596;1293.2176033499597;1297.8831905128395;1316.8419789625307;1328.8936885049172;29395;31041.534376983913;31730.20674483064;32001.199970000936;32012.19969500781;46677.29984050174;47256.52743472659;47341.289880652505;47349.763251183525;47359.76320118377;417125;421118;421775;421936;422318;26859.731402685724;26983.46033079288;27097;27258.182254532396;28681.569776453787;45928;46131;46488.53511464842;46717;46827.29759053685;38223;39226.41160382539;39613;40119.799401002805;40648.79675601603;39327.41008884812;39621.60378396179;39736;39831.80084099561;40052.39921401123;39171.2165756689;39442.802785985885;39978.400323995746;40144.1971160581;40202.59797401988;32982;35111.297774043866;35215.82392088023;35266.471002934464;35736.463953041246;27039;27081;27265.182044538695;27502.4329382408;27562 15:52:19 INFO - PROCESS | 26911 | |2;jquery.html;365.5978423733895;382.44726410772256;382.84877473398024;383.71988448432637;419.4693712453745;14664.15555632855;15640.921795391021;18556.164972576233;19095.809041909575;19114.04429778509;18824.15291311891;18880.5279868003;18949.75685576775;19163.520911977208;19191.904040479814;4268.935965960513;5677.659340439576;5918.082697181943;5925.407459254083;5927.61470504418;4904.8528544143555;6616.834579135536;6662.367075127855;6675.232348279961;6718.42893354063;5535.6955367454775;5812.564057695668;6627.635480048595;6632.137822083122;6634.270230274666;5892.823215303548;5927.1998280232265;5927.555433342516;5936.940630593704;5938.465538101592;5508.91736623951;5746.195532625436;5762.567807414461;5797.942020579782;5806.970965145148;13982.230977296245;14217.57347279573;14223.28883555818;21696.783032169635;22356.552868942694;2060.7527096748486;2087.37378786365;2106.7998540138815;2333.7666233376694;2441.292025312657;9873.703788886345;9969.700908972742;10060.446675432848;10295.485225738683;10539.104176145036;1898.905054747271;1969.2910552201197;1973.0726558517474;1978.1098505672505;1997.6304383688919;79155.6042219791;84346.99999999939;84349;86451.56774216151;87409.56295218547;10439.37363758177;10607.257491975643;10807.83788243177;11243.437828108725;11407.201495895373;15521.689566208612;15558.299876505584;15562.766558501631;15576.92211538935;15592.688146237011;7863.0957439894;8162.510249384937;8174.877376839352;8211.17888211186;8362;7504.399648028145;7549.131849837339;7566.205548417337;7748.302652761278;7833.09919359281;4400.361947517592;4534.909301813946;4660.557247061523;4717.245240761462;4920.975395123001;1721.7847769028872;1810.2758896441528;1838.4668446150733;1853.6107417442217;1998.3305592626343;794.9324307433933;899.8515244984635;933.5612262236738;1010.9747256318651;1026.6047571684805;17998.820011799977;19496.415107546796;19513.219471221277;19647.31234406789;19686.60626787485;907.945523268606;908.2643059122;919.8758167647416;925.8888933328044;946.3281070439928;8247;10333.534990925426;10969.177311701655;10995.945020274847;11062.446877656084;404260;408830;440407;449187;453832;90089;90294.54852725826;90881;90942;91968.54015729879;994.7115336552318;1008.9747756306151;1028.5011769291887;1053.868266466707;1061.4480470155477;15845.683086338438;17020.404285849934;17869;18064.458066258034;18096.72854907151;39834.60165398309;42859.856627240726;42862.57137428586;43052;43090;49098.26352604642;56575.20908750468;58417.4158258412;59578;60162.39837601568;7543.3965282778345;7833.138354781084;8315.293200078062;8330.750077497685;8908.688195913111;12477.812832807696;13266.204027758366;13371.732565348833;13417.194968301934;13486.865131348954;11375.943120284346;11383.317000979967;11558.133140014701;11656.475458604213;11940.283582985048;10988.340699557732;11258.268212566158;11376;11532.538698451968;11764.58823941158;11491.770164596828;11621.418929053345;11668.474918628512;11805.822912656145;11962.76074478523;7957.482763620346;7991.800204994922;8063.959680201561;8170.305524030524;8300.12848650883;11051.72370690739;11415.429228538374;11794.115441342105;11904.821427678418;12163.391830408267 15:52:19 INFO - PROCESS | 26911 | |3;mootools.html;1454.05486433818;1494.0662086196128;1632.4939268826656;1751.0806826416137;1804.377489766031;7522.022137122167;7811.570363629998;8446.788830279238;9088.318376121784;9090.500022498769;8586.098459661724;8781.121887811216;8857.689980850671;9109.225715814147;9110.31672624554;2127.4894025433864;2138.272987184357;2151.34384012876;2157.2341818654386;2160.8919554022314;1842.990785046073;1903.2196799312285;2117.2060477321006;2167.9783202168014;2226.1206823304865;1921.3659492367485;1929;1933.4489670443927;2067.1008111471556;2134.338355109921;2105.757837848644;2111.4510227340847;2118.3115487466634;2119.4913220826966;2121.0349291072525;2099.128861522466;2111.524906895936;2161.8594791338514;2163.3942496101117;2165.2854557995825;8573.957130214372;8612.870806937839;8613.052564217931;8634.5251011195;8953.776155596097;5230.110881150214;5362.168863826113;5364.436734142898;5365.302510673627;5386.622936394454;3201.3277211785553;3281.868725250987;3355.5637767090366;3373.274745929637;3388.119089036868;952.0289304908954;1012.9746756331077;1029.6190409548515;1031.128696251666;1040.7033995311376;12223.816642750366;12239.510419583206;12295.93852030743;12296;12321.322327271997;4297.140571885635;4584.88537786558;4621.676482646182;4718.386609740712;4753.263244197155;10578.471076446147;10589.629362972259;10629.627963021412;10630.574777008987;10634.41510716918;5281.656692315064;5334.199870019528;5336.119540275811;5342.786288548492;5347.438518955531;4783.832565860248;4852.126617208865;4906;4909.950900491021;4916.213405855046;3705.5368078990127;3784.8864534064023;3838.9424158637644;3850.7882066486054;3928.096537796323;1233.3833083458271;1246.5761641042088;1263.0590210293205;1268.517963173988;1286.6133322686283;742.0983505041401;744.0587656614388;798.9201079891965;890.9842779231681;920.282179899666;5630.8029218977135;5798.884022319615;5889.1755154278435;5954.46409823118;6115.877682446326;901.1169054326797;951.4338968313842;958.0706714486937;961.4327546747453;979.9902000980042;3897.980510097488;4067.471228740245;4096.754194748325;4186.162518082482;4209.7474151551005;10879.619213327655;11114.722131946604;11148.996590306911;11291.322520648788;11304.491297891615;11034.503447344729;11050.115990720724;11050.447477626087;11061.170412218955;11062.944685276521;8040.8793868092025;8159.46963447374;8325.333973282122;8349.916500835036;8360;5805.680687562224;5837.67892765885;5873.676947767743;5970.134330522137;6039.456448919443;10159.593616255266;10274.948625257124;10302.948485257526;10405.791884162425;10419.479026048515;9976;10066.44634545107;10383.53274102652;10515.527826104199;10534.525946332587;7386.630668466662;7609.429292803173;7642.694292228249;7649.617519124133;7657.731979380917;8502.234798867885;8585.613647385757;8645.394822362374;8665.046844846936;8734.519601421984;7674.9144001551995;7711.305982461606;7806.141324454192;7817.0619525657285;7840.725574604861;7418;7484.214157513383;7630.4277179212895;7665.195154508696;7688.115866675404;6795.1845778506895;6981.197162326397;7020.7893763187185;7079.362857342864;7094.077769889881;4833.830815921426;5040.546350828443;5061.215511595708;5061.772220250024;5326.547243484347;5033.622478314214;5052.9747351263;5145.536901678867;5257.921131182959;5406.8648283791645 15:52:19 INFO - PROCESS | 26911 | |4;prototype.html;291.5699343468383;325.7491731366846;329.0556103981573;332.4514550990864;336.94945758136276;5119.283300337951;5343.812966546172;5444.482774136461;5459;5489.313835770528;5211.895762084766;5314.441983591715;5389.191621256813;5428.5928555358305;5436.293281873361;4161.292580261348;4166.208420400129;4168.812403441845;4175.958240417603;4181.034913590607;4021.658159056484;4123.752574845504;4132.400801883725;4143.854965076223;4148.8962775930695;4090.979545102285;4093.3246014407737;4112.218678451085;4115.958840411602;4135.689823263252;4140.151268989865;4145.854895078658;4160.979195104035;4168.979155104235;4174.707770456039;3530.770499917497;3616.65641764032;3630.3102410541915;3665.8533658653623;3669.5963444021136;5124.948750512484;5151.5106064923775;5162.948370516285;5174.844754657366;5221.817236396746;4659.5573420525;4673.299005149221;4673.696209746356;4684.36761037259;4686.430045934616;5462;5491.313585801775;5524.06090964537;5528.944710552883;5542.173491519314;3922.6077392260545;3927.960720392788;3935.9212815743813;3942.6451619354107;3958;5842.795502157446;5842.853928651775;5880.353161152269;5889.204957330749;5911.285727139168;4031.7177797554477;4066.6949978751713;4073.4297198391655;4140.503139623264;4142.378643203544;4095.774732389747;4103.815328310233;4111.8560850370095;4112.609302116294;4151.501819781585;4377.1683380157665;4532.501424843264;4563.224251877189;4724.196886529298;4740.762961851894;5280.234366016906;5631.521320687787;5632.718364081779;5687.744051517691;5689.573282003867;1332.6535100873843;1340.095435580979;1357.730521961949;1375.7386096641806;1376.9242691651855;953.3136141977765;973.075578200698;989.5250279865704;1000.2997901469001;1002.3134153105146;5356.571474282048;5394.460553944574;5410.621256512007;5432.456754324536;5448.945510544923;5640.379558248589;5658.660480371191;5669.829905102771;5674.432556744375;5716.971415142981;5228.581713462914;5318.760655770499;5352.65207761502;5410.513053825096;5425.159100339453;2619.895204191811;2642.2733748219007;2644.405008872988;2652.005497938273;2666.3200883774903;5087.796488140433;5134.614903882224;5144.974275128675;5149.716765577854;5212.7914883405;4768.833090841873;4984;5016.247562865599;5064.670796398296;5161.406438259648;5099.617528685363;5107.97446012775;5117.462666420047;5123.590112791042;5130.820421285237;4906.288588154769;4939.703617782944;4957.702537847596;4989.501049894981;5049.7727602257255;4943.925841112315;5480.945190548044;5722.7710891563875;5750.7987220447085;5757.65454072757;5945.91081133792;5995.490383317467;6008.978473659401;6015.338312785678;6022.728977196124;3797.430385442206;3905.6875449964505;4007.4389585458644;4018.3972404138444;4033.173199494155;5526.972365138148;5640.915386269291;5700.771969121189;5703.401142879938;5722.284714410699;5563.388027316911;5577.8047768327915;5586.413426590149;5603.243562119062;5620.325560932714;5415.106507426231;5586.944130558805;5592.636478628876;5594.86012849682;5607.299087614048;5513.649155956817;5516.503514683698;5526.751296191762;5538.833834984957;5540.722963851872;5457.69982650958;5621.638911657195;5635.88728225425;5651.2935883014625;5656.519195868233;5488.725563721878;5506.697131657637;5510.752016159363;5518.862028449321;5526.392096869261 15:52:19 INFO - PROCESS | 26911 | |5;yui.html;723.4863247094563;729.6242435145899;750.5121670913906;804.6258489802241;805.8670319397299;15149.697006059872;16588.08765517896;16602.75095873563;16632.58418539537;16661.250243739032;13791.448342066305;13830.446782128727;13856.792148117785;13880.79178812316;13883.930580347109;662.5527768756094;679.4666187043172;780.6955287437904;781.9491733037335;802.7792357101786;795.9602019899011;805.7743831727097;807.4267270238138;807.7738233294657;808.3129340060931;859.9312055035614;860.4923095373729;861.6510313323114;861.840559496492;862.3833958719514;689.8378880962995;707.9504434689574;819.7049062337554;857.459800325797;857.9828403431927;607.5686262753451;617.4072890025581;618.4094190048493;619.5508256513991;619.5508256514037;12767.36163191846;12815.61553153407;12849.935750321281;12850.16473929201;12855.74288514234;13105.934470327682;13434;13700.794488082687;13967.231802250872;14244;11423.371714555697;11453.942730286379;11554.711132221677;12765.42555585001;12802.103852730312;4389.441748179414;4436.889077773049;4451.176532341495;4460.353248778909;4498.122866041123;71138.28861711368;72354.63822680853;72651;73468;73581;10863;10902.727431814268;10998.890011099787;11326.773464530828;11354.091672666167;16973;17031.914840425718;17041.7443738344;17078.060706661003;17094.316227351017;7894.328982036476;8072.273495385443;8093.392995525359;8133.837323253501;8246.587670616445;3954.6197691233797;4037.313656678372;4050.1292222172374;4057.411675307123;4121.258173528734;3448.8792892249153;3556.5376501054698;3565.180008598037;3572.374834403969;3784.545854497478;662.9071929929813;670.2426258328155;672.9461643068543;677.6340775980915;680.5100327764002;676.5095305903279;690.8514669346115;694.6839188169371;695.5027155583782;713.5540287320425;9702.369345992487;9722.902770972341;9865.802683946424;9876.111149996535;10072.848907266396;592.7273454211025;657.6120089147425;703.5040296590994;714.2072299747276;714.3071220915704;4336;4645.372874661945;4671.5094915034115;4674.280985308132;4824.734639594786;72950.63524682449;117181.41409293069;119263.2110518343;122513;126124;94760.52619736857;99252;99295.50352248193;100041;100583;87604.5619771897;90304.5484772585;93969;96043.51978240065;96598.5170074131;8879;8949.552522373986;9140.268778497837;9221.815563688822;9242.537873106183;53710.194347085606;53883;54385;55859.44140558705;56731.43268567262;73998.26001739914;78280;79295;80332.59833700793;80843.59578202071;11525.88474115248;11994.940025300166;12003.81994270104;12237.816432753338;12527.686807829878;13224.206547607175;13345.599632011055;13615.79576306376;13762.65593360174;13844.446222151;12065.336406497727;12171.81742273849;12203.267803931793;12327.93836030814;12440.937795310965;11977.880221198026;12151.149419540547;12415.317157556421;12439.626811195678;12718.109732319019;12143;12174.269543827399;12185.939070304592;12416.875831241572;12904.935475322563;9398.201152901807;9671.120144264856;9996.850047249152;10589.682309530726;10603.94698026505;10273.537690803782;10517.631882884063;10556.524956377136;10559.63041293551;10620.007683365428 15:52:19 INFO - PROCESS | 26911 | __end_tp_report 15:52:19 INFO - PROCESS | 26911 | __start_cc_report 15:52:19 INFO - PROCESS | 26911 | _x_x_mozilla_cycle_collect,1133 15:52:19 INFO - PROCESS | 26911 | __end_cc_report 15:52:19 INFO - PROCESS | 26911 | __startTimestamp1476485539290__endTimestamp 15:52:19 INFO - PROCESS | 26911 | 15:52:19 INFO - PROCESS | 26911 | ------- Summary: start ------- 15:52:19 INFO - PROCESS | 26911 | Number of tests: 6 15:52:19 INFO - PROCESS | 26911 | 15:52:19 INFO - PROCESS | 26911 | [#0] dojo.html Cycles:165 Average:5305.88 Median:5538.09 stddev:608.24 (11.0%) stddev-sans-first:581.91 15:52:19 INFO - PROCESS | 26911 | Values: 2972.6 2981.4 2991.7 3010.2 3055.5 5072.3 5171.6 5243.4 5326.4 5326.9 5189.1 5218.1 5230.3 5230.4 5232.6 4717.2 4780.6 4803.0 4817.4 4835.2 4902.3 4905.2 4931.1 4939.7 4942.4 4845.9 4886.7 4917.8 4930.2 4933.4 4947.5 4950.3 4960.9 4969.1 5010.0 4743.4 4777.1 4839.9 4871.9 4880.0 5344.5 5363.9 5377.4 5386.1 5470.8 5695.6 5737.6 5752.5 5753.5 5758.9 5520.4 5677.8 5689.1 5785.8 5802.4 5285.8 5312.7 5318.9 5324.4 5384.6 5799.5 5836.3 5836.6 5840.6 5844.2 5358.1 5581.7 5585.4 5585.5 5589.0 5483.1 5661.4 5681.5 5774.4 5778.1 5637.3 5650.0 5692.3 5694.1 5712.1 5708.1 5715.9 5716.6 5731.8 5774.6 4242.0 4272.4 4276.0 4398.6 4413.6 3932.3 3935.8 3965.7 3976.5 3982.3 5526.5 5537.2 5541.4 5542.1 5546.8 5564.9 5616.5 5665.3 5815.2 5909.8 5421.5 5423.6 5440.7 5495.2 5500.8 4974.9 4977.1 4978.0 4985.1 5012.4 5666.2 5794.6 5920.1 5924.9 5925.3 5689.6 5759.0 5764.3 5772.0 5830.6 5950.8 5953.8 5960.3 5962.1 5964.2 5460.2 5630.5 5635.2 5639.0 5641.6 5601.1 5660.1 5670.0 5720.9 5809.2 5540.6 5591.7 5595.7 5607.2 5614.1 5556.6 5600.0 5608.1 5615.3 5618.6 5345.1 5393.0 5527.5 5560.2 5564.8 5646.6 5649.1 5650.3 5661.0 5706.8 5351.5 5385.9 5526.0 5538.1 5538.5 15:52:19 INFO - PROCESS | 26911 | 15:52:19 INFO - PROCESS | 26911 | [#1] ext.html Cycles:180 Average:56045.73 Median:35501.47 stddev:111961.90 (315.4%) stddev-sans-first:112198.55 15:52:19 INFO - PROCESS | 26911 | Values: 586.3 605.2 627.0 631.5 638.6 30881.8 31541.7 33386.8 33422.5 33451.2 46286.5 47543.5 47728.0 47909.5 47934.0 8835.9 8963.8 8978.2 8978.9 8984.1 8183.0 8381.0 8853.0 8939.2 8946.2 10555.7 10783.0 10796.1 11173.6 11177.7 10797.3 10863.1 10870.0 10879.9 10883.7 10547.0 10601.9 10623.8 10625.6 10638.7 40501.8 40971.2 41009.0 41052.8 41061.2 3428.7 3861.4 3861.5 3926.2 3943.7 30893.1 31213.4 31457.2 31684.7 32875.5 3906.8 3910.6 3911.4 4041.9 4163.0 328754.0 330471.0 331292.0 331431.0 331744.0 33558.2 34303.7 34407.3 55392.7 55855.0 36042.5 36047.5 36149.3 36202.6 36210.0 14569.6 14721.4 14723.9 14733.7 14734.1 12172.1 12249.0 12255.8 12260.0 12261.1 7703.1 7831.9 7982.3 8174.4 8200.2 3162.6 3232.0 3241.1 3248.4 3253.4 945.4 977.6 1053.9 1075.0 1100.2 30674.4 31125.7 32158.5 32704.7 34554.3 1031.5 1040.9 1106.0 1110.4 1113.7 15380.9 16129.8 16275.9 16297.3 16713.7 494292.0 497316.0 497938.0 499169.0 501338.0 54560.5 54888.0 54951.5 54964.0 54979.5 1237.9 1293.2 1297.9 1316.8 1328.9 29395.0 31041.5 31730.2 32001.2 32012.2 46677.3 47256.5 47341.3 47349.8 47359.8 417125.0 421118.0 421775.0 421936.0 422318.0 26859.7 26983.5 27097.0 27258.2 28681.6 45928.0 46131.0 46488.5 46717.0 46827.3 38223.0 39226.4 39613.0 40119.8 40648.8 39327.4 39621.6 39736.0 39831.8 40052.4 39171.2 39442.8 39978.4 40144.2 40202.6 32982.0 35111.3 35215.8 35266.5 35736.5 27039.0 27081.0 27265.2 27502.4 27562.0 15:52:19 INFO - PROCESS | 26911 | 15:52:19 INFO - PROCESS | 26911 | [#2] jquery.html Cycles:180 Average:27172.00 Median:383.28 stddev:71631.36 (18688.8%) stddev-sans-first:71804.03 15:52:19 INFO - PROCESS | 26911 | Values: 365.6 382.4 382.8 383.7 419.5 14664.2 15640.9 18556.2 19095.8 19114.0 18824.2 18880.5 18949.8 19163.5 19191.9 4268.9 5677.7 5918.1 5925.4 5927.6 4904.9 6616.8 6662.4 6675.2 6718.4 5535.7 5812.6 6627.6 6632.1 6634.3 5892.8 5927.2 5927.6 5936.9 5938.5 5508.9 5746.2 5762.6 5797.9 5807.0 13982.2 14217.6 14223.3 21696.8 22356.6 2060.8 2087.4 2106.8 2333.8 2441.3 9873.7 9969.7 10060.4 10295.5 10539.1 1898.9 1969.3 1973.1 1978.1 1997.6 79155.6 84347.0 84349.0 86451.6 87409.6 10439.4 10607.3 10807.8 11243.4 11407.2 15521.7 15558.3 15562.8 15576.9 15592.7 7863.1 8162.5 8174.9 8211.2 8362.0 7504.4 7549.1 7566.2 7748.3 7833.1 4400.4 4534.9 4660.6 4717.2 4921.0 1721.8 1810.3 1838.5 1853.6 1998.3 794.9 899.9 933.6 1011.0 1026.6 17998.8 19496.4 19513.2 19647.3 19686.6 907.9 908.3 919.9 925.9 946.3 8247.0 10333.5 10969.2 10995.9 11062.4 404260.0 408830.0 440407.0 449187.0 453832.0 90089.0 90294.5 90881.0 90942.0 91968.5 994.7 1009.0 1028.5 1053.9 1061.4 15845.7 17020.4 17869.0 18064.5 18096.7 39834.6 42859.9 42862.6 43052.0 43090.0 49098.3 56575.2 58417.4 59578.0 60162.4 7543.4 7833.1 8315.3 8330.8 8908.7 12477.8 13266.2 13371.7 13417.2 13486.9 11375.9 11383.3 11558.1 11656.5 11940.3 10988.3 11258.3 11376.0 11532.5 11764.6 11491.8 11621.4 11668.5 11805.8 11962.8 7957.5 7991.8 8064.0 8170.3 8300.1 11051.7 11415.4 11794.1 11904.8 12163.4 15:52:19 INFO - PROCESS | 26911 | 15:52:19 INFO - PROCESS | 26911 | [#3] mootools.html Cycles:180 Average:5777.17 Median:4879.06 stddev:3374.16 (69.2%) stddev-sans-first:3367.99 15:52:19 INFO - PROCESS | 26911 | Values: 1454.1 1494.1 1632.5 1751.1 1804.4 7522.0 7811.6 8446.8 9088.3 9090.5 8586.1 8781.1 8857.7 9109.2 9110.3 2127.5 2138.3 2151.3 2157.2 2160.9 1843.0 1903.2 2117.2 2168.0 2226.1 1921.4 1929.0 1933.4 2067.1 2134.3 2105.8 2111.5 2118.3 2119.5 2121.0 2099.1 2111.5 2161.9 2163.4 2165.3 8574.0 8612.9 8613.1 8634.5 8953.8 5230.1 5362.2 5364.4 5365.3 5386.6 3201.3 3281.9 3355.6 3373.3 3388.1 952.0 1013.0 1029.6 1031.1 1040.7 12223.8 12239.5 12295.9 12296.0 12321.3 4297.1 4584.9 4621.7 4718.4 4753.3 10578.5 10589.6 10629.6 10630.6 10634.4 5281.7 5334.2 5336.1 5342.8 5347.4 4783.8 4852.1 4906.0 4910.0 4916.2 3705.5 3784.9 3838.9 3850.8 3928.1 1233.4 1246.6 1263.1 1268.5 1286.6 742.1 744.1 798.9 891.0 920.3 5630.8 5798.9 5889.2 5954.5 6115.9 901.1 951.4 958.1 961.4 980.0 3898.0 4067.5 4096.8 4186.2 4209.7 10879.6 11114.7 11149.0 11291.3 11304.5 11034.5 11050.1 11050.4 11061.2 11062.9 8040.9 8159.5 8325.3 8349.9 8360.0 5805.7 5837.7 5873.7 5970.1 6039.5 10159.6 10274.9 10302.9 10405.8 10419.5 9976.0 10066.4 10383.5 10515.5 10534.5 7386.6 7609.4 7642.7 7649.6 7657.7 8502.2 8585.6 8645.4 8665.0 8734.5 7674.9 7711.3 7806.1 7817.1 7840.7 7418.0 7484.2 7630.4 7665.2 7688.1 6795.2 6981.2 7020.8 7079.4 7094.1 4833.8 5040.5 5061.2 5061.8 5326.5 5033.6 5053.0 5145.5 5257.9 5406.9 15:52:19 INFO - PROCESS | 26911 | 15:52:19 INFO - PROCESS | 26911 | [#4] prototype.html Cycles:180 Average:4592.81 Median:5139.79 stddev:1355.46 (26.4%) stddev-sans-first:1320.25 15:52:19 INFO - PROCESS | 26911 | Values: 291.6 325.7 329.1 332.5 336.9 5119.3 5343.8 5444.5 5459.0 5489.3 5211.9 5314.4 5389.2 5428.6 5436.3 4161.3 4166.2 4168.8 4176.0 4181.0 4021.7 4123.8 4132.4 4143.9 4148.9 4091.0 4093.3 4112.2 4116.0 4135.7 4140.2 4145.9 4161.0 4169.0 4174.7 3530.8 3616.7 3630.3 3665.9 3669.6 5124.9 5151.5 5162.9 5174.8 5221.8 4659.6 4673.3 4673.7 4684.4 4686.4 5462.0 5491.3 5524.1 5528.9 5542.2 3922.6 3928.0 3935.9 3942.6 3958.0 5842.8 5842.9 5880.4 5889.2 5911.3 4031.7 4066.7 4073.4 4140.5 4142.4 4095.8 4103.8 4111.9 4112.6 4151.5 4377.2 4532.5 4563.2 4724.2 4740.8 5280.2 5631.5 5632.7 5687.7 5689.6 1332.7 1340.1 1357.7 1375.7 1376.9 953.3 973.1 989.5 1000.3 1002.3 5356.6 5394.5 5410.6 5432.5 5448.9 5640.4 5658.7 5669.8 5674.4 5717.0 5228.6 5318.8 5352.7 5410.5 5425.2 2619.9 2642.3 2644.4 2652.0 2666.3 5087.8 5134.6 5145.0 5149.7 5212.8 4768.8 4984.0 5016.2 5064.7 5161.4 5099.6 5108.0 5117.5 5123.6 5130.8 4906.3 4939.7 4957.7 4989.5 5049.8 4943.9 5480.9 5722.8 5750.8 5757.7 5945.9 5995.5 6009.0 6015.3 6022.7 3797.4 3905.7 4007.4 4018.4 4033.2 5527.0 5640.9 5700.8 5703.4 5722.3 5563.4 5577.8 5586.4 5603.2 5620.3 5415.1 5586.9 5592.6 5594.9 5607.3 5513.6 5516.5 5526.8 5538.8 5540.7 5457.7 5621.6 5635.9 5651.3 5656.5 5488.7 5506.7 5510.8 5518.9 5526.4 15:52:19 INFO - PROCESS | 26911 | 15:52:19 INFO - PROCESS | 26911 | [#5] yui.html Cycles:180 Average:20547.06 Median:4658.44 stddev:30453.67 (653.7%) stddev-sans-first:30502.72 15:52:19 INFO - PROCESS | 26911 | Values: 723.5 729.6 750.5 804.6 805.9 15149.7 16588.1 16602.8 16632.6 16661.3 13791.4 13830.4 13856.8 13880.8 13883.9 662.6 679.5 780.7 781.9 802.8 796.0 805.8 807.4 807.8 808.3 859.9 860.5 861.7 861.8 862.4 689.8 708.0 819.7 857.5 858.0 607.6 617.4 618.4 619.6 619.6 12767.4 12815.6 12849.9 12850.2 12855.7 13105.9 13434.0 13700.8 13967.2 14244.0 11423.4 11453.9 11554.7 12765.4 12802.1 4389.4 4436.9 4451.2 4460.4 4498.1 71138.3 72354.6 72651.0 73468.0 73581.0 10863.0 10902.7 10998.9 11326.8 11354.1 16973.0 17031.9 17041.7 17078.1 17094.3 7894.3 8072.3 8093.4 8133.8 8246.6 3954.6 4037.3 4050.1 4057.4 4121.3 3448.9 3556.5 3565.2 3572.4 3784.5 662.9 670.2 672.9 677.6 680.5 676.5 690.9 694.7 695.5 713.6 9702.4 9722.9 9865.8 9876.1 10072.8 592.7 657.6 703.5 714.2 714.3 4336.0 4645.4 4671.5 4674.3 4824.7 72950.6 117181.4 119263.2 122513.0 126124.0 94760.5 99252.0 99295.5 100041.0 100583.0 87604.6 90304.5 93969.0 96043.5 96598.5 8879.0 8949.6 9140.3 9221.8 9242.5 53710.2 53883.0 54385.0 55859.4 56731.4 73998.3 78280.0 79295.0 80332.6 80843.6 11525.9 11994.9 12003.8 12237.8 12527.7 13224.2 13345.6 13615.8 13762.7 13844.4 12065.3 12171.8 12203.3 12327.9 12440.9 11977.9 12151.1 12415.3 12439.6 12718.1 12143.0 12174.3 12185.9 12416.9 12904.9 9398.2 9671.1 9996.9 10589.7 10603.9 10273.5 10517.6 10556.5 10559.6 10620.0 15:52:19 INFO - PROCESS | 26911 | -------- Summary: end -------- 15:52:19 INFO - PROCESS | 26911 | 15:52:20 INFO - TEST-INFO | 26911: exit 0 15:52:20 INFO - TEST-OK | dromaeo_css | took 1117718ms 15:52:20 INFO - TEST-START | kraken 15:52:20 INFO - operating with platform_type : linux_ 15:52:20 INFO - Initialising browser for kraken test... 15:52:20 INFO - TEST-INFO | started process 27220 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpzZPDgD/profile http://localhost:34419/getInfo.html) 15:52:24 INFO - PROCESS | 27220 | __metrics Screen width/height:1600/1200 15:52:24 INFO - PROCESS | 27220 | colorDepth:24 15:52:24 INFO - PROCESS | 27220 | Browser inner width/height: 1024/697 15:52:24 INFO - PROCESS | 27220 | __metrics 15:52:24 INFO - PROCESS | 27220 | 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" 15:52:24 INFO - PROCESS | 27220 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 181: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 15:52:25 INFO - PROCESS | 27220 | console.error: PushService: 15:52:25 INFO - PROCESS | 27220 | stateChangeProcessEnqueue: Error transitioning state 15:52:25 INFO - PROCESS | 27220 | UnknownError 15:52:26 INFO - TEST-INFO | 27220: exit 0 15:52:26 INFO - Browser initialized. 15:52:26 INFO - Running cycle 1/1 for kraken test... 15:52:26 INFO - TEST-INFO | started process 27303 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpzZPDgD/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 15:52:38 INFO - PROCESS | 27303 | RSS: Main: 172400640 15:52:38 INFO - PROCESS | 27303 | 15:52:40 INFO - PROCESS | 27303 | Cycle 1(1): loaded http://localhost:34419/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:34419/tests/kraken/driver.html?testName=audio-beat-detection) 15:52:41 INFO - PROCESS | 27303 | RSS: Main: 229019648 15:52:41 INFO - PROCESS | 27303 | 15:52:44 INFO - PROCESS | 27303 | Cycle 1(1): loaded http://localhost:34419/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:34419/tests/kraken/driver.html?testName=audio-dft) 15:52:45 INFO - PROCESS | 27303 | RSS: Main: 216526848 15:52:45 INFO - PROCESS | 27303 | 15:52:48 INFO - PROCESS | 27303 | Cycle 1(1): loaded http://localhost:34419/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:34419/tests/kraken/driver.html?testName=audio-fft) 15:52:48 INFO - PROCESS | 27303 | RSS: Main: 298577920 15:52:48 INFO - PROCESS | 27303 | 15:52:50 INFO - PROCESS | 27303 | Cycle 1(1): loaded http://localhost:34419/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:34419/tests/kraken/driver.html?testName=audio-oscillator) 15:52:51 INFO - PROCESS | 27303 | RSS: Main: 206315520 15:52:51 INFO - PROCESS | 27303 | 15:52:53 INFO - PROCESS | 27303 | Cycle 1(1): loaded http://localhost:34419/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:34419/tests/kraken/driver.html?testName=imaging-gaussian-blur) 15:52:54 INFO - PROCESS | 27303 | RSS: Main: 211996672 15:52:54 INFO - PROCESS | 27303 | 15:52:57 INFO - PROCESS | 27303 | Cycle 1(1): loaded http://localhost:34419/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:34419/tests/kraken/driver.html?testName=imaging-darkroom) 15:52:57 INFO - PROCESS | 27303 | RSS: Main: 248328192 15:52:57 INFO - PROCESS | 27303 | 15:53:01 INFO - PROCESS | 27303 | Cycle 1(1): loaded http://localhost:34419/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:34419/tests/kraken/driver.html?testName=imaging-desaturate) 15:53:01 INFO - PROCESS | 27303 | RSS: Main: 247336960 15:53:01 INFO - PROCESS | 27303 | 15:53:04 INFO - PROCESS | 27303 | Cycle 1(1): loaded http://localhost:34419/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:34419/tests/kraken/driver.html?testName=json-parse-financial) 15:53:04 INFO - PROCESS | 27303 | RSS: Main: 246689792 15:53:04 INFO - PROCESS | 27303 | 15:53:06 INFO - PROCESS | 27303 | Cycle 1(1): loaded http://localhost:34419/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:34419/tests/kraken/driver.html?testName=json-stringify-tinderbox) 15:53:07 INFO - PROCESS | 27303 | RSS: Main: 209199104 15:53:07 INFO - PROCESS | 27303 | 15:53:08 INFO - PROCESS | 27303 | Cycle 1(1): loaded http://localhost:34419/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:34419/tests/kraken/driver.html?testName=stanford-crypto-aes) 15:53:09 INFO - PROCESS | 27303 | RSS: Main: 216985600 15:53:09 INFO - PROCESS | 27303 | 15:53:11 INFO - PROCESS | 27303 | Cycle 1(1): loaded http://localhost:34419/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:34419/tests/kraken/driver.html?testName=stanford-crypto-ccm) 15:53:12 INFO - PROCESS | 27303 | RSS: Main: 225943552 15:53:12 INFO - PROCESS | 27303 | 15:53:14 INFO - PROCESS | 27303 | Cycle 1(1): loaded http://localhost:34419/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:34419/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 15:53:15 INFO - PROCESS | 27303 | RSS: Main: 233680896 15:53:15 INFO - PROCESS | 27303 | 15:53:18 INFO - PROCESS | 27303 | Cycle 1(1): loaded http://localhost:34419/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:34419/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 15:53:18 INFO - PROCESS | 27303 | RSS: Main: 231804928 15:53:18 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | Cycle 1(1): loaded http://localhost:34419/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:34419/tests/kraken/driver.html?testName=ai-astar) 15:53:20 INFO - PROCESS | 27303 | RSS: Main: 282759168 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | __start_tp_report 15:53:20 INFO - PROCESS | 27303 | _x_x_mozilla_page_load 15:53:20 INFO - PROCESS | 27303 | _x_x_mozilla_page_load_details 15:53:20 INFO - PROCESS | 27303 | |i|pagename|runs| 15:53:20 INFO - PROCESS | 27303 | |0;ai-astar;106;112;111;112;115;111;112;111;112;111 15:53:20 INFO - PROCESS | 27303 | |1;audio-beat-detection;149;120;122;155;129;122;125;132;158;122 15:53:20 INFO - PROCESS | 27303 | |2;audio-dft;160;162;159;160;159;161;161;161;160;160 15:53:20 INFO - PROCESS | 27303 | |3;audio-fft;75;76;76;105;76;76;85;75;96;75 15:53:20 INFO - PROCESS | 27303 | |4;audio-oscillator;83;82;113;84;83;83;106;82;82;114 15:53:20 INFO - PROCESS | 27303 | |5;imaging-gaussian-blur;117;118;117;117;117;117;117;116;116;118 15:53:20 INFO - PROCESS | 27303 | |6;imaging-darkroom;145;146;145;145;145;146;146;146;146;145 15:53:20 INFO - PROCESS | 27303 | |7;imaging-desaturate;85;84;86;86;85;85;85;84;84;85 15:53:20 INFO - PROCESS | 27303 | |8;json-parse-financial;55;56;53;54;53;54;57;55;55;55 15:53:20 INFO - PROCESS | 27303 | |9;json-stringify-tinderbox;59;60;59;60;60;59;60;60;59;60 15:53:20 INFO - PROCESS | 27303 | |10;stanford-crypto-aes;82;80;81;81;80;81;81;80;80;81 15:53:20 INFO - PROCESS | 27303 | |11;stanford-crypto-ccm;137;142;132;146;131;139;134;139;186;132 15:53:20 INFO - PROCESS | 27303 | |12;stanford-crypto-pbkdf2;170;164;166;165;165;166;165;164;169;164 15:53:20 INFO - PROCESS | 27303 | |13;stanford-crypto-sha256-iterative;67;68;71;76;66;65;66;65;66;64 15:53:20 INFO - PROCESS | 27303 | __end_tp_report 15:53:20 INFO - PROCESS | 27303 | __start_cc_report 15:53:20 INFO - PROCESS | 27303 | _x_x_mozilla_cycle_collect,1722 15:53:20 INFO - PROCESS | 27303 | __end_cc_report 15:53:20 INFO - PROCESS | 27303 | __startTimestamp1476485600738__endTimestamp 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | ------- Summary: start ------- 15:53:20 INFO - PROCESS | 27303 | Number of tests: 14 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | [#0] ai-astar Cycles:10 Average:111.30 Median:112.00 stddev:2.21 (2.0%) stddev-sans-first:1.27 15:53:20 INFO - PROCESS | 27303 | Values: 106.0 112.0 111.0 112.0 115.0 111.0 112.0 111.0 112.0 111.0 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | [#1] audio-beat-detection Cycles:10 Average:133.40 Median:130.50 stddev:14.82 (11.4%) stddev-sans-first:14.60 15:53:20 INFO - PROCESS | 27303 | Values: 149.0 120.0 122.0 155.0 129.0 122.0 125.0 132.0 158.0 122.0 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | [#2] audio-dft Cycles:10 Average:160.30 Median:160.50 stddev:0.95 (0.6%) stddev-sans-first:1.00 15:53:20 INFO - PROCESS | 27303 | Values: 160.0 162.0 159.0 160.0 159.0 161.0 161.0 161.0 160.0 160.0 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | [#3] audio-fft Cycles:10 Average:81.50 Median:76.00 stddev:10.66 (14.0%) stddev-sans-first:11.04 15:53:20 INFO - PROCESS | 27303 | Values: 75.0 76.0 76.0 105.0 76.0 76.0 85.0 75.0 96.0 75.0 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | [#4] audio-oscillator Cycles:10 Average:91.20 Median:82.50 stddev:13.83 (16.8%) stddev-sans-first:14.35 15:53:20 INFO - PROCESS | 27303 | Values: 83.0 82.0 113.0 84.0 83.0 83.0 106.0 82.0 82.0 114.0 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | [#5] imaging-gaussian-blur Cycles:10 Average:117.00 Median:117.00 stddev:0.67 (0.6%) stddev-sans-first:0.71 15:53:20 INFO - PROCESS | 27303 | Values: 117.0 118.0 117.0 117.0 117.0 117.0 117.0 116.0 116.0 118.0 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | [#6] imaging-darkroom Cycles:10 Average:145.50 Median:146.00 stddev:0.53 (0.4%) stddev-sans-first:0.53 15:53:20 INFO - PROCESS | 27303 | Values: 145.0 146.0 145.0 145.0 145.0 146.0 146.0 146.0 146.0 145.0 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | [#7] imaging-desaturate Cycles:10 Average:84.90 Median:85.00 stddev:0.74 (0.9%) stddev-sans-first:0.78 15:53:20 INFO - PROCESS | 27303 | Values: 85.0 84.0 86.0 86.0 85.0 85.0 85.0 84.0 84.0 85.0 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | [#8] json-parse-financial Cycles:10 Average:54.70 Median:55.00 stddev:1.25 (2.3%) stddev-sans-first:1.32 15:53:20 INFO - PROCESS | 27303 | Values: 55.0 56.0 53.0 54.0 53.0 54.0 57.0 55.0 55.0 55.0 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | [#9] json-stringify-tinderbox Cycles:10 Average:59.60 Median:60.00 stddev:0.52 (0.9%) stddev-sans-first:0.50 15:53:20 INFO - PROCESS | 27303 | Values: 59.0 60.0 59.0 60.0 60.0 59.0 60.0 60.0 59.0 60.0 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | [#10] stanford-crypto-aes Cycles:10 Average:80.70 Median:81.00 stddev:0.67 (0.8%) stddev-sans-first:0.53 15:53:20 INFO - PROCESS | 27303 | Values: 82.0 80.0 81.0 81.0 80.0 81.0 81.0 80.0 80.0 81.0 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | [#11] stanford-crypto-ccm Cycles:10 Average:141.80 Median:139.00 stddev:16.26 (11.7%) stddev-sans-first:17.15 15:53:20 INFO - PROCESS | 27303 | Values: 137.0 142.0 132.0 146.0 131.0 139.0 134.0 139.0 186.0 132.0 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:165.80 Median:165.50 stddev:2.10 (1.3%) stddev-sans-first:1.58 15:53:20 INFO - PROCESS | 27303 | Values: 170.0 164.0 166.0 165.0 165.0 166.0 165.0 164.0 169.0 164.0 15:53:20 INFO - PROCESS | 27303 | 15:53:20 INFO - PROCESS | 27303 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.40 Median:66.50 stddev:3.60 (5.4%) stddev-sans-first:3.81 15:53:20 INFO - PROCESS | 27303 | Values: 67.0 68.0 71.0 76.0 66.0 65.0 66.0 65.0 66.0 64.0 15:53:20 INFO - PROCESS | 27303 | -------- Summary: end -------- 15:53:20 INFO - PROCESS | 27303 | 15:53:21 INFO - TEST-INFO | 27303: exit 0 15:53:21 INFO - TEST-OK | kraken | took 61740ms 15:53:21 INFO - SUITE-END | took 1179s 15:53:22 INFO - Completed test suite (00:19:39) 15:53:22 INFO - javascript benchmark 15:53:22 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [2972.568977498263, 2981.35900781332, 2991.7307442330184, 3010.202296391455, 3055.526393409021, 5072.315237442944, 5171.560417364529, 5243.37079550454, 5326.360836699597, 5326.866828329294, 5189.143791274435, 5218.060749065166, 5230.34620672416, 5230.372355317368, 5232.633715639907, 4717.221658426355, 4780.641451891105, 4803.0, 4817.397825271841, 4835.226363781796, 4902.338184345122, 4905.166121759292, 4931.087748766472, 4939.728314942677, 4942.43162036365, 4845.878853028685, 4886.657933944625, 4917.803287868481, 4930.211166213407, 4933.40799104108, 4947.505249475078, 4950.3069570260195, 4960.900781984376, 4969.0807200668, 5010.048090862724, 4743.407074115736, 4777.116233496814, 4839.927401088987, 4871.878203044952, 4880.048390563841, 5344.465553444625, 5363.9463605363835, 5377.4084850666395, 5386.084365657847, 5470.835874923759, 5695.629784064023, 5737.598368114233, 5752.482276595127, 5753.482186603226, 5758.884822303572, 5520.447955204488, 5677.772889084473, 5689.146628005791, 5785.768569257225, 5802.361740208574, 5285.7885684572575, 5312.707801070939, 5318.8936221276135, 5324.440933701983, 5384.596155288369, 5799.5070419014855, 5836.270466191726, 5836.562257830679, 5840.620359676607, 5844.1818145459665, 5358.089124848785, 5581.720913954286, 5585.385607583163, 5585.497305242548, 5588.993981083363, 5483.122700367922, 5661.433856614306, 5681.545476361881, 5774.364819869811, 5778.133280008033, 5637.3235211774845, 5650.0, 5692.288463942007, 5694.06048002075, 5712.11462223356, 5708.143778433186, 5715.8856822864145, 5716.57125715573, 5731.799387021434, 5774.585226619505, 4241.957580424156, 4272.359146128106, 4276.0, 4398.626116780046, 4413.558644135561, 3932.272529581979, 3935.822887970048, 3965.6827453803626, 3976.5426975897562, 3982.303096958021, 5526.50261476469, 5537.169424586345, 5541.445855414507, 5542.113261878161, 5546.833594992157, 5564.86087847799, 5616.494515493625, 5665.2635157430095, 5815.244018277597, 5909.763609455574, 5421.484958928895, 5423.647462914898, 5440.6735595864375, 5495.175723641486, 5500.834974950758, 4974.875628109254, 4977.0792403405485, 4978.0, 4985.052839960396, 5012.373453318335, 5666.206731057573, 5794.594378393472, 5920.082387229986, 5924.881502369843, 5925.259342582263, 5689.630174038674, 5758.971205143947, 5764.308283006066, 5772.04761214395, 5830.62100963436, 5950.7917222896995, 5953.7916172935475, 5960.254968128984, 5962.135490353961, 5964.194833697569, 5460.208269800777, 5630.549556035426, 5635.182898479616, 5639.0, 5641.633293835887, 5601.075822489243, 5660.094384898396, 5670.0, 5720.914186287126, 5809.157672137601, 5540.556755459473, 5591.692456914909, 5595.692236927008, 5607.158926161109, 5614.101743720985, 5556.555475561864, 5600.0479918414785, 5608.130739735348, 5615.2700148982, 5618.634788738719, 5345.091334473072, 5393.029254734185, 5527.50252477279, 5560.19377190297, 5564.77740890376, 5646.632968857176, 5649.124385720055, 5650.3219613646625, 5661.0, 5706.828795136153, 5351.5451186648015, 5385.8922821542565, 5526.032944234663, 5538.086215774352, 5538.47384498472], "value": 5263.905380494215, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [586.3257254157718, 605.2283338743102, 626.9655168965706, 631.4790298004148, 638.5913015669969, 30881.84559077204, 31541.68458315416, 33386.8330658347, 33422.49866252002, 33451.16372090696, 46286.53713462864, 47543.52456475434, 47728.0, 47909.52090479103, 47934.0, 8835.867461988058, 8963.820723585524, 8978.191962723353, 8978.86531702025, 8984.101589840997, 8183.0, 8381.0, 8853.026167121612, 8939.240164586017, 8946.23956963659, 10555.683329500127, 10783.0, 10796.136309095293, 11173.608923687672, 11177.72055698606, 10797.29817561856, 10863.130949524018, 10870.0, 10879.945600271947, 10883.67348979528, 10547.0, 10601.946990265, 10623.787524249548, 10625.574977000912, 10638.680839574825, 40501.79749101265, 40971.1805763883, 41009.0, 41052.79473602613, 41061.178776424305, 3428.6571342865514, 3861.362875125601, 3861.4593956846065, 3926.175503144343, 3943.6647884929816, 30893.146411215173, 31213.37573248545, 31457.21356966071, 31684.683153168404, 32875.50686739701, 3906.8046597670004, 3910.6284902934176, 3911.3546264866263, 4041.939370909439, 4163.042500224965, 328754.0, 330471.0, 331291.9999999976, 331431.0, 331744.0, 33558.16104597405, 34303.65696343055, 34407.31185376278, 55392.72303638456, 55855.0, 36042.45936310958, 36047.4592881107, 36149.27701445956, 36202.637973620454, 36210.0, 14569.562913112624, 14721.411143554138, 14723.92638036803, 14733.705325893423, 14734.115953042852, 12172.14794964344, 12249.0, 12255.816162757566, 12260.0, 12261.14172007951, 7703.114141873644, 7831.921680783119, 7982.321502672222, 8174.38692098095, 8200.179982001871, 3162.57305263791, 3232.0, 3241.0762932564576, 3248.3503299340227, 3253.4143854106014, 945.3571571331423, 977.5796407544682, 1053.9156867450586, 1075.0109898893038, 1100.1913593508764, 30674.38651226963, 31125.688743112732, 32158.517622235686, 32704.67295327016, 34554.30891382158, 1031.515187861704, 1040.8646875906236, 1106.0322218059198, 1110.4336788238056, 1113.6881673131536, 15380.92309538445, 16129.838701612834, 16275.918620406823, 16297.266623001993, 16713.665726685642, 494292.0, 497316.0, 497938.0, 499169.0, 501338.0, 54560.544775484406, 54888.0, 54951.450485494635, 54964.0, 54979.45020549823, 1237.9381030948596, 1293.2176033499597, 1297.8831905128395, 1316.8419789625307, 1328.8936885049172, 29395.0, 31041.534376983913, 31730.20674483064, 32001.199970000936, 32012.19969500781, 46677.29984050174, 47256.52743472659, 47341.289880652505, 47349.763251183525, 47359.76320118377, 417125.0, 421118.0, 421775.0, 421936.0, 422318.0, 26859.731402685724, 26983.46033079288, 27097.0, 27258.182254532396, 28681.569776453787, 45928.0, 46131.0, 46488.53511464842, 46717.0, 46827.29759053685, 38223.0, 39226.41160382539, 39613.0, 40119.799401002805, 40648.79675601603, 39327.41008884812, 39621.60378396179, 39736.0, 39831.80084099561, 40052.39921401123, 39171.2165756689, 39442.802785985885, 39978.400323995746, 40144.1971160581, 40202.59797401988, 32982.0, 35111.297774043866, 35215.82392088023, 35266.471002934464, 35736.463953041246, 27039.0, 27081.0, 27265.182044538695, 27502.4329382408, 27562.0], "value": 18501.554160692504, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [365.5978423733895, 382.44726410772256, 382.84877473398024, 383.71988448432637, 419.4693712453745, 14664.15555632855, 15640.921795391021, 18556.164972576233, 19095.809041909575, 19114.04429778509, 18824.15291311891, 18880.5279868003, 18949.75685576775, 19163.520911977208, 19191.904040479814, 4268.935965960513, 5677.659340439576, 5918.082697181943, 5925.407459254083, 5927.61470504418, 4904.8528544143555, 6616.834579135536, 6662.367075127855, 6675.232348279961, 6718.42893354063, 5535.6955367454775, 5812.564057695668, 6627.635480048595, 6632.137822083122, 6634.270230274666, 5892.823215303548, 5927.1998280232265, 5927.555433342516, 5936.940630593704, 5938.465538101592, 5508.91736623951, 5746.195532625436, 5762.567807414461, 5797.942020579782, 5806.970965145148, 13982.230977296245, 14217.57347279573, 14223.28883555818, 21696.783032169635, 22356.552868942694, 2060.7527096748486, 2087.37378786365, 2106.7998540138815, 2333.7666233376694, 2441.292025312657, 9873.703788886345, 9969.700908972742, 10060.446675432848, 10295.485225738683, 10539.104176145036, 1898.905054747271, 1969.2910552201197, 1973.0726558517474, 1978.1098505672505, 1997.6304383688919, 79155.6042219791, 84346.99999999939, 84349.0, 86451.56774216151, 87409.56295218547, 10439.37363758177, 10607.257491975643, 10807.83788243177, 11243.437828108725, 11407.201495895373, 15521.689566208612, 15558.299876505584, 15562.766558501631, 15576.92211538935, 15592.688146237011, 7863.0957439894, 8162.510249384937, 8174.877376839352, 8211.17888211186, 8362.0, 7504.399648028145, 7549.131849837339, 7566.205548417337, 7748.302652761278, 7833.09919359281, 4400.361947517592, 4534.909301813946, 4660.557247061523, 4717.245240761462, 4920.975395123001, 1721.7847769028872, 1810.2758896441528, 1838.4668446150733, 1853.6107417442217, 1998.3305592626343, 794.9324307433933, 899.8515244984635, 933.5612262236738, 1010.9747256318651, 1026.6047571684805, 17998.820011799977, 19496.415107546796, 19513.219471221277, 19647.31234406789, 19686.60626787485, 907.945523268606, 908.2643059122, 919.8758167647416, 925.8888933328044, 946.3281070439928, 8247.0, 10333.534990925426, 10969.177311701655, 10995.945020274847, 11062.446877656084, 404260.0, 408830.0, 440407.0, 449187.0, 453832.0, 90089.0, 90294.54852725826, 90881.0, 90942.0, 91968.54015729879, 994.7115336552318, 1008.9747756306151, 1028.5011769291887, 1053.868266466707, 1061.4480470155477, 15845.683086338438, 17020.404285849934, 17869.0, 18064.458066258034, 18096.72854907151, 39834.60165398309, 42859.856627240726, 42862.57137428586, 43052.0, 43090.0, 49098.26352604642, 56575.20908750468, 58417.4158258412, 59578.0, 60162.39837601568, 7543.3965282778345, 7833.138354781084, 8315.293200078062, 8330.750077497685, 8908.688195913111, 12477.812832807696, 13266.204027758366, 13371.732565348833, 13417.194968301934, 13486.865131348954, 11375.943120284346, 11383.317000979967, 11558.133140014701, 11656.475458604213, 11940.283582985048, 10988.340699557732, 11258.268212566158, 11376.0, 11532.538698451968, 11764.58823941158, 11491.770164596828, 11621.418929053345, 11668.474918628512, 11805.822912656145, 11962.76074478523, 7957.482763620346, 7991.800204994922, 8063.959680201561, 8170.305524030524, 8300.12848650883, 11051.72370690739, 11415.429228538374, 11794.115441342105, 11904.821427678418, 12163.391830408267], "value": 9028.13999645642, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1454.05486433818, 1494.0662086196128, 1632.4939268826656, 1751.0806826416137, 1804.377489766031, 7522.022137122167, 7811.570363629998, 8446.788830279238, 9088.318376121784, 9090.500022498769, 8586.098459661724, 8781.121887811216, 8857.689980850671, 9109.225715814147, 9110.31672624554, 2127.4894025433864, 2138.272987184357, 2151.34384012876, 2157.2341818654386, 2160.8919554022314, 1842.990785046073, 1903.2196799312285, 2117.2060477321006, 2167.9783202168014, 2226.1206823304865, 1921.3659492367485, 1929.0, 1933.4489670443927, 2067.1008111471556, 2134.338355109921, 2105.757837848644, 2111.4510227340847, 2118.3115487466634, 2119.4913220826966, 2121.0349291072525, 2099.128861522466, 2111.524906895936, 2161.8594791338514, 2163.3942496101117, 2165.2854557995825, 8573.957130214372, 8612.870806937839, 8613.052564217931, 8634.5251011195, 8953.776155596097, 5230.110881150214, 5362.168863826113, 5364.436734142898, 5365.302510673627, 5386.622936394454, 3201.3277211785553, 3281.868725250987, 3355.5637767090366, 3373.274745929637, 3388.119089036868, 952.0289304908954, 1012.9746756331077, 1029.6190409548515, 1031.128696251666, 1040.7033995311376, 12223.816642750366, 12239.510419583206, 12295.93852030743, 12296.0, 12321.322327271997, 4297.140571885635, 4584.88537786558, 4621.676482646182, 4718.386609740712, 4753.263244197155, 10578.471076446147, 10589.629362972259, 10629.627963021412, 10630.574777008987, 10634.41510716918, 5281.656692315064, 5334.199870019528, 5336.119540275811, 5342.786288548492, 5347.438518955531, 4783.832565860248, 4852.126617208865, 4906.0, 4909.950900491021, 4916.213405855046, 3705.5368078990127, 3784.8864534064023, 3838.9424158637644, 3850.7882066486054, 3928.096537796323, 1233.3833083458271, 1246.5761641042088, 1263.0590210293205, 1268.517963173988, 1286.6133322686283, 742.0983505041401, 744.0587656614388, 798.9201079891965, 890.9842779231681, 920.282179899666, 5630.8029218977135, 5798.884022319615, 5889.1755154278435, 5954.46409823118, 6115.877682446326, 901.1169054326797, 951.4338968313842, 958.0706714486937, 961.4327546747453, 979.9902000980042, 3897.980510097488, 4067.471228740245, 4096.754194748325, 4186.162518082482, 4209.7474151551005, 10879.619213327655, 11114.722131946604, 11148.996590306911, 11291.322520648788, 11304.491297891615, 11034.503447344729, 11050.115990720724, 11050.447477626087, 11061.170412218955, 11062.944685276521, 8040.8793868092025, 8159.46963447374, 8325.333973282122, 8349.916500835036, 8360.0, 5805.680687562224, 5837.67892765885, 5873.676947767743, 5970.134330522137, 6039.456448919443, 10159.593616255266, 10274.948625257124, 10302.948485257526, 10405.791884162425, 10419.479026048515, 9976.0, 10066.44634545107, 10383.53274102652, 10515.527826104199, 10534.525946332587, 7386.630668466662, 7609.429292803173, 7642.694292228249, 7649.617519124133, 7657.731979380917, 8502.234798867885, 8585.613647385757, 8645.394822362374, 8665.046844846936, 8734.519601421984, 7674.9144001551995, 7711.305982461606, 7806.141324454192, 7817.0619525657285, 7840.725574604861, 7418.0, 7484.214157513383, 7630.4277179212895, 7665.195154508696, 7688.115866675404, 6795.1845778506895, 6981.197162326397, 7020.7893763187185, 7079.362857342864, 7094.077769889881, 4833.830815921426, 5040.546350828443, 5061.215511595708, 5061.772220250024, 5326.547243484347, 5033.622478314214, 5052.9747351263, 5145.536901678867, 5257.921131182959, 5406.8648283791645], "value": 4547.217194500728, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [291.5699343468383, 325.7491731366846, 329.0556103981573, 332.4514550990864, 336.94945758136276, 5119.283300337951, 5343.812966546172, 5444.482774136461, 5459.0, 5489.313835770528, 5211.895762084766, 5314.441983591715, 5389.191621256813, 5428.5928555358305, 5436.293281873361, 4161.292580261348, 4166.208420400129, 4168.812403441845, 4175.958240417603, 4181.034913590607, 4021.658159056484, 4123.752574845504, 4132.400801883725, 4143.854965076223, 4148.8962775930695, 4090.979545102285, 4093.3246014407737, 4112.218678451085, 4115.958840411602, 4135.689823263252, 4140.151268989865, 4145.854895078658, 4160.979195104035, 4168.979155104235, 4174.707770456039, 3530.770499917497, 3616.65641764032, 3630.3102410541915, 3665.8533658653623, 3669.5963444021136, 5124.948750512484, 5151.5106064923775, 5162.948370516285, 5174.844754657366, 5221.817236396746, 4659.5573420525, 4673.299005149221, 4673.696209746356, 4684.36761037259, 4686.430045934616, 5462.0, 5491.313585801775, 5524.06090964537, 5528.944710552883, 5542.173491519314, 3922.6077392260545, 3927.960720392788, 3935.9212815743813, 3942.6451619354107, 3958.0, 5842.795502157446, 5842.853928651775, 5880.353161152269, 5889.204957330749, 5911.285727139168, 4031.7177797554477, 4066.6949978751713, 4073.4297198391655, 4140.503139623264, 4142.378643203544, 4095.774732389747, 4103.815328310233, 4111.8560850370095, 4112.609302116294, 4151.501819781585, 4377.1683380157665, 4532.501424843264, 4563.224251877189, 4724.196886529298, 4740.762961851894, 5280.234366016906, 5631.521320687787, 5632.718364081779, 5687.744051517691, 5689.573282003867, 1332.6535100873843, 1340.095435580979, 1357.730521961949, 1375.7386096641806, 1376.9242691651855, 953.3136141977765, 973.075578200698, 989.5250279865704, 1000.2997901469001, 1002.3134153105146, 5356.571474282048, 5394.460553944574, 5410.621256512007, 5432.456754324536, 5448.945510544923, 5640.379558248589, 5658.660480371191, 5669.829905102771, 5674.432556744375, 5716.971415142981, 5228.581713462914, 5318.760655770499, 5352.65207761502, 5410.513053825096, 5425.159100339453, 2619.895204191811, 2642.2733748219007, 2644.405008872988, 2652.005497938273, 2666.3200883774903, 5087.796488140433, 5134.614903882224, 5144.974275128675, 5149.716765577854, 5212.7914883405, 4768.833090841873, 4984.0, 5016.247562865599, 5064.670796398296, 5161.406438259648, 5099.617528685363, 5107.97446012775, 5117.462666420047, 5123.590112791042, 5130.820421285237, 4906.288588154769, 4939.703617782944, 4957.702537847596, 4989.501049894981, 5049.7727602257255, 4943.925841112315, 5480.945190548044, 5722.7710891563875, 5750.7987220447085, 5757.65454072757, 5945.91081133792, 5995.490383317467, 6008.978473659401, 6015.338312785678, 6022.728977196124, 3797.430385442206, 3905.6875449964505, 4007.4389585458644, 4018.3972404138444, 4033.173199494155, 5526.972365138148, 5640.915386269291, 5700.771969121189, 5703.401142879938, 5722.284714410699, 5563.388027316911, 5577.8047768327915, 5586.413426590149, 5603.243562119062, 5620.325560932714, 5415.106507426231, 5586.944130558805, 5592.636478628876, 5594.86012849682, 5607.299087614048, 5513.649155956817, 5516.503514683698, 5526.751296191762, 5538.833834984957, 5540.722963851872, 5457.69982650958, 5621.638911657195, 5635.88728225425, 5651.2935883014625, 5656.519195868233, 5488.725563721878, 5506.697131657637, 5510.752016159363, 5518.862028449321, 5526.392096869261], "value": 4161.297861138506, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [723.4863247094563, 729.6242435145899, 750.5121670913906, 804.6258489802241, 805.8670319397299, 15149.697006059872, 16588.08765517896, 16602.75095873563, 16632.58418539537, 16661.250243739032, 13791.448342066305, 13830.446782128727, 13856.792148117785, 13880.79178812316, 13883.930580347109, 662.5527768756094, 679.4666187043172, 780.6955287437904, 781.9491733037335, 802.7792357101786, 795.9602019899011, 805.7743831727097, 807.4267270238138, 807.7738233294657, 808.3129340060931, 859.9312055035614, 860.4923095373729, 861.6510313323114, 861.840559496492, 862.3833958719514, 689.8378880962995, 707.9504434689574, 819.7049062337554, 857.459800325797, 857.9828403431927, 607.5686262753451, 617.4072890025581, 618.4094190048493, 619.5508256513991, 619.5508256514037, 12767.36163191846, 12815.61553153407, 12849.935750321281, 12850.16473929201, 12855.74288514234, 13105.934470327682, 13434.0, 13700.794488082687, 13967.231802250872, 14244.0, 11423.371714555697, 11453.942730286379, 11554.711132221677, 12765.42555585001, 12802.103852730312, 4389.441748179414, 4436.889077773049, 4451.176532341495, 4460.353248778909, 4498.122866041123, 71138.28861711368, 72354.63822680853, 72651.0, 73468.0, 73581.0, 10863.0, 10902.727431814268, 10998.890011099787, 11326.773464530828, 11354.091672666167, 16973.0, 17031.914840425718, 17041.7443738344, 17078.060706661003, 17094.316227351017, 7894.328982036476, 8072.273495385443, 8093.392995525359, 8133.837323253501, 8246.587670616445, 3954.6197691233797, 4037.313656678372, 4050.1292222172374, 4057.411675307123, 4121.258173528734, 3448.8792892249153, 3556.5376501054698, 3565.180008598037, 3572.374834403969, 3784.545854497478, 662.9071929929813, 670.2426258328155, 672.9461643068543, 677.6340775980915, 680.5100327764002, 676.5095305903279, 690.8514669346115, 694.6839188169371, 695.5027155583782, 713.5540287320425, 9702.369345992487, 9722.902770972341, 9865.802683946424, 9876.111149996535, 10072.848907266396, 592.7273454211025, 657.6120089147425, 703.5040296590994, 714.2072299747276, 714.3071220915704, 4336.0, 4645.372874661945, 4671.5094915034115, 4674.280985308132, 4824.734639594786, 72950.63524682449, 117181.41409293069, 119263.2110518343, 122513.0, 126124.0, 94760.52619736857, 99252.0, 99295.50352248193, 100041.0, 100583.0, 87604.5619771897, 90304.5484772585, 93969.0, 96043.51978240065, 96598.5170074131, 8879.0, 8949.552522373986, 9140.268778497837, 9221.815563688822, 9242.537873106183, 53710.194347085606, 53883.0, 54385.0, 55859.44140558705, 56731.43268567262, 73998.26001739914, 78280.0, 79295.0, 80332.59833700793, 80843.59578202071, 11525.88474115248, 11994.940025300166, 12003.81994270104, 12237.816432753338, 12527.686807829878, 13224.206547607175, 13345.599632011055, 13615.79576306376, 13762.65593360174, 13844.446222151, 12065.336406497727, 12171.81742273849, 12203.267803931793, 12327.93836030814, 12440.937795310965, 11977.880221198026, 12151.149419540547, 12415.317157556421, 12439.626811195678, 12718.109732319019, 12143.0, 12174.269543827399, 12185.939070304592, 12416.875831241572, 12904.935475322563, 9398.201152901807, 9671.120144264856, 9996.850047249152, 10589.682309530726, 10603.94698026505, 10273.537690803782, 10517.631882884063, 10556.524956377136, 10559.63041293551, 10620.007683365428], "value": 7303.57160579907, "unit": "score"}], "name": "dromaeo_css", "value": 7037.924235543874, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [106.0, 112.0, 111.0, 112.0, 115.0, 111.0, 112.0, 111.0, 112.0, 111.0], "value": 111.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [149.0, 120.0, 122.0, 155.0, 129.0, 122.0, 125.0, 132.0, 158.0, 122.0], "value": 133.4, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [160.0, 162.0, 159.0, 160.0, 159.0, 161.0, 161.0, 161.0, 160.0, 160.0], "value": 160.3, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [75.0, 76.0, 76.0, 105.0, 76.0, 76.0, 85.0, 75.0, 96.0, 75.0], "value": 81.5, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 82.0, 113.0, 84.0, 83.0, 83.0, 106.0, 82.0, 82.0, 114.0], "value": 91.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [117.0, 118.0, 117.0, 117.0, 117.0, 117.0, 117.0, 116.0, 116.0, 118.0], "value": 117.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [145.0, 146.0, 145.0, 145.0, 145.0, 146.0, 146.0, 146.0, 146.0, 145.0], "value": 145.5, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 84.0, 86.0, 86.0, 85.0, 85.0, 85.0, 84.0, 84.0, 85.0], "value": 84.9, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [55.0, 56.0, 53.0, 54.0, 53.0, 54.0, 57.0, 55.0, 55.0, 55.0], "value": 54.7, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [59.0, 60.0, 59.0, 60.0, 60.0, 59.0, 60.0, 60.0, 59.0, 60.0], "value": 59.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 80.0, 81.0, 81.0, 80.0, 81.0, 81.0, 80.0, 80.0, 81.0], "value": 80.7, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [137.0, 142.0, 132.0, 146.0, 131.0, 139.0, 134.0, 139.0, 186.0, 132.0], "value": 141.8, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [170.0, 164.0, 166.0, 165.0, 165.0, 166.0, 165.0, 164.0, 169.0, 164.0], "value": 165.8, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [67.0, 68.0, 71.0, 76.0, 66.0, 65.0, 66.0, 65.0, 66.0, 64.0], "value": 67.4, "unit": "score"}], "name": "kraken", "value": 1495.1000000000001, "alertThreshold": 2.0}]} 15:53:22 INFO - Return code: 0 15:53:22 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 15:53:22 INFO - # TBPL SUCCESS # 15:53:22 INFO - Running post-action listener: _resource_record_post_action 15:53:22 INFO - [mozharness: 2016-10-14 22:53:22.543069Z] Finished run-tests step (success) 15:53:22 INFO - Running post-run listener: _resource_record_post_run 15:53:22 INFO - Total resource usage - Wall time: 1197s; CPU: 13.0%; Read bytes: 4096; Write bytes: 393007104; Read time: 20; Write time: 280772 15:53:22 INFO - TinderboxPrint: CPU usage
13.1% 15:53:22 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 20 15:53:22 INFO - TinderboxPrint: I/O write bytes / time
393,007,104 / 280,772 15:53:22 INFO - TinderboxPrint: CPU idle
8,300.2 (86.9%) 15:53:22 INFO - TinderboxPrint: CPU user
1,201.0 (12.6%) 15:53:22 INFO - TinderboxPrint: Swap in / out
0 / 0 15:53:22 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 103583744; Read time: 0; Write time: 80148 15:53:22 INFO - run-tests - Wall time: 1180s; CPU: 13.0%; Read bytes: 0; Write bytes: 289423360; Read time: 0; Write time: 200624 15:53:23 INFO - Running post-run listener: _upload_blobber_files 15:53:23 INFO - Blob upload gear active. 15:53:23 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 15:53: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 15:53: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', 'Autoland', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 15:53: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 Autoland -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 15:53:23 INFO - (blobuploader) - INFO - Open directory for files ... 15:53:23 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 15:53:23 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 15:53:23 INFO - (blobuploader) - INFO - Uploading, attempt #1. 15:53:26 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 15:53:26 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 15:53:26 INFO - (blobuploader) - INFO - Done attempting. 15:53:26 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 15:53:26 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 15:53:26 INFO - (blobuploader) - INFO - Uploading, attempt #1. 15:53:27 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 15:53:27 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 15:53:27 INFO - (blobuploader) - INFO - Done attempting. 15:53:27 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 15:53:27 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 15:53:27 INFO - (blobuploader) - INFO - Uploading, attempt #1. 15:53:28 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 15:53:28 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 15:53:28 INFO - (blobuploader) - INFO - Done attempting. 15:53:28 INFO - (blobuploader) - INFO - Iteration through files over. 15:53:28 INFO - Return code: 0 15:53:28 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 15:53:28 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 15:53:28 INFO - Setting buildbot property blobber_files to {"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/cb4d25ade6164852ec964e99ea75cc81ca482afa220487f9c843e7cfe75e7fcdaae2261c8704a2dbccdab17fb5492517772048ef67685a51b41833ae54ee6f99", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/e529979605c7f7e839dafcd711f36090f71669b324ff2c8d428adb26497fa76bd9221a3d70ac3c54ccfca639f5c3aa127a1568e516618f3ed7f11776d7392e9b", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/51563c879b02be8e8108d7ba1bdeaf5dc2dbb3083096b1f1f2c4af369cf01d62723e1edd593c485e1c12ccb39ab01df5e0bd3b7bf4878978cf8d7f520e03429b"} 15:53:28 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 15:53:28 INFO - Writing to file /builds/slave/test/properties/blobber_files 15:53:28 INFO - Contents: 15:53:28 INFO - blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/cb4d25ade6164852ec964e99ea75cc81ca482afa220487f9c843e7cfe75e7fcdaae2261c8704a2dbccdab17fb5492517772048ef67685a51b41833ae54ee6f99", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/e529979605c7f7e839dafcd711f36090f71669b324ff2c8d428adb26497fa76bd9221a3d70ac3c54ccfca639f5c3aa127a1568e516618f3ed7f11776d7392e9b", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/51563c879b02be8e8108d7ba1bdeaf5dc2dbb3083096b1f1f2c4af369cf01d62723e1edd593c485e1c12ccb39ab01df5e0bd3b7bf4878978cf8d7f520e03429b"} 15:53:28 INFO - Running post-run listener: copy_logs_to_upload_dir 15:53:28 INFO - Copying logs to upload dir... 15:53:28 INFO - mkdir: /builds/slave/test/build/upload/logs 15:53:28 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1243.069745 ========= master_lag: 0.02 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 43 secs) (at 2016-10-14 15:53:28.071341) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-14 15:53:28.075188) ========= 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=03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/cb4d25ade6164852ec964e99ea75cc81ca482afa220487f9c843e7cfe75e7fcdaae2261c8704a2dbccdab17fb5492517772048ef67685a51b41833ae54ee6f99", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/e529979605c7f7e839dafcd711f36090f71669b324ff2c8d428adb26497fa76bd9221a3d70ac3c54ccfca639f5c3aa127a1568e516618f3ed7f11776d7392e9b", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/51563c879b02be8e8108d7ba1bdeaf5dc2dbb3083096b1f1f2c4af369cf01d62723e1edd593c485e1c12ccb39ab01df5e0bd3b7bf4878978cf8d7f520e03429b"} build_url:https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011224 build_url: 'https://queue.taskcluster.net/v1/task/YBXKYOPRQfytMXxftcv-gQ/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/cb4d25ade6164852ec964e99ea75cc81ca482afa220487f9c843e7cfe75e7fcdaae2261c8704a2dbccdab17fb5492517772048ef67685a51b41833ae54ee6f99", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/e529979605c7f7e839dafcd711f36090f71669b324ff2c8d428adb26497fa76bd9221a3d70ac3c54ccfca639f5c3aa127a1568e516618f3ed7f11776d7392e9b", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Autoland/sha512/51563c879b02be8e8108d7ba1bdeaf5dc2dbb3083096b1f1f2c4af369cf01d62723e1edd593c485e1c12ccb39ab01df5e0bd3b7bf4878978cf8d7f520e03429b"}' ========= master_lag: 0.01 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-14 15:53:28.101162) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 15:53:28.101537) ========= 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=03627c79f6bb3d1578c4a402000001ba-1476484342.356726-2108825392 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004501 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 15:53:28.187500) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-14 15:53:28.187903) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-14 15:53:28.188315) ========= ========= Total master_lag: 0.18 =========