builder: fx-team_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-050 starttime: 1476486804.45 results: success (0) buildid: 20161014154507 builduid: 618b4d01f89746a091d96951062b5241 revision: e412b386433b8c8ba83a28a1df310d9ad0b20285 ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-14 16:13:24.449458) ========= master: http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-14 16:13:24.449912) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-14 16:13:24.450181) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-14 16:13:24.465236) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 16:13:24.465570) ========= 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=6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-10-14 16:13:24-- 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% 69.7M=0s 2016-10-14 16:13:24 (69.7 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.093016 ========= master_lag: 0.22 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 16:13:24.781485) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 16:13:24.781800) ========= 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=6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.014089 ========= master_lag: 0.02 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 16:13:24.811066) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-14 16:13:24.811408) ========= bash -c 'python archiver_client.py mozharness --repo integration/fx-team --rev e412b386433b8c8ba83a28a1df310d9ad0b20285 --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo integration/fx-team --rev e412b386433b8c8ba83a28a1df310d9ad0b20285 --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=6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-10-14 16:13:24,913 truncating revision to first 12 chars 2016-10-14 16:13:24,913 Setting DEBUG logging. 2016-10-14 16:13:24,913 attempt 1/10 2016-10-14 16:13:24,913 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/integration/fx-team/e412b386433b?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-14 16:13:25,590 unpacking tar archive at: fx-team-e412b386433b/testing/mozharness/ program finished with exit code 0 elapsedTime=1.074905 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 1 secs) (at 2016-10-14 16:13:25.904397) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-14 16:13:25.904856) ========= script_repo_revision: e412b386433b8c8ba83a28a1df310d9ad0b20285 ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-14 16:13:25.905429) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-14 16:13:25.905828) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-14 16:13:25.918810) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-10-14 16:13:25.919289) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Fx-Team', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Fx-Team'] 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=6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 16:13:26 INFO - MultiFileLogger online at 20161014 16:13:26 in /builds/slave/test 16:13:26 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Fx-Team --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Fx-Team 16:13:26 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 16:13:26 INFO - {'append_to_log': False, 16:13:26 INFO - 'base_work_dir': '/builds/slave/test', 16:13:26 INFO - 'blob_upload_branch': 'Fx-Team', 16:13:26 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 16:13:26 INFO - 'branch': 'Fx-Team', 16:13:26 INFO - 'buildbot_json_path': 'buildprops.json', 16:13:26 INFO - 'config_files': ('talos/linux_config.py',), 16:13:26 INFO - 'default_actions': ('clobber', 16:13:26 INFO - 'read-buildbot-config', 16:13:26 INFO - 'download-and-extract', 16:13:26 INFO - 'populate-webroot', 16:13:26 INFO - 'create-virtualenv', 16:13:26 INFO - 'install', 16:13:26 INFO - 'run-tests'), 16:13:26 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 16:13:26 INFO - 'download_minidump_stackwalk': True, 16:13:26 INFO - 'download_symbols': 'ondemand', 16:13:26 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 16:13:26 INFO - 'tooltool.py': '/tools/tooltool.py', 16:13:26 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 16:13:26 INFO - '/tools/misc-python/virtualenv.py')}, 16:13:26 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 16:13:26 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 16:13:26 INFO - 'installer_path': 'installer.exe', 16:13:26 INFO - 'log_level': 'info', 16:13:26 INFO - 'log_name': 'talos', 16:13:26 INFO - 'log_to_console': True, 16:13:26 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 16:13:26 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 16:13:26 INFO - 'opt_config_files': (), 16:13:26 INFO - 'pip_index': False, 16:13:26 INFO - 'sps_profile': False, 16:13:26 INFO - 'sps_profile_interval': 0, 16:13:26 INFO - 'suite': 'dromaeojs-e10s', 16:13:26 INFO - 'system_bits': '32', 16:13:26 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 16:13:26 INFO - 'title': 'talos-linux64-ix-050', 16:13:26 INFO - 'tooltool_cache': '/builds/tooltool_cache', 16:13:26 INFO - 'use_talos_json': True, 16:13:26 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 16:13:26 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 16:13:26 INFO - 'work_dir': 'build'} 16:13:26 INFO - [mozharness: 2016-10-14 23:13:26.125242Z] Running clobber step. 16:13:26 INFO - Running pre-action listener: _resource_record_pre_action 16:13:26 INFO - Running main action method: clobber 16:13:26 INFO - rmtree: /builds/slave/test/build 16:13:26 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 16:13:26 INFO - Running post-action listener: _resource_record_post_action 16:13:26 INFO - [mozharness: 2016-10-14 23:13:26.587040Z] Finished clobber step (success) 16:13:26 INFO - [mozharness: 2016-10-14 23:13:26.587141Z] Running read-buildbot-config step. 16:13:26 INFO - Running pre-action listener: _resource_record_pre_action 16:13:26 INFO - Running main action method: read_buildbot_config 16:13:26 INFO - Using buildbot properties: 16:13:26 INFO - { 16:13:26 INFO - "project": "", 16:13:26 INFO - "product": "firefox", 16:13:26 INFO - "script_repo_revision": "production", 16:13:26 INFO - "builddir": "fx-team_ubuntu64_hw_test-dromaeojs-e10s", 16:13:26 INFO - "repository": "", 16:13:26 INFO - "buildername": "Ubuntu HW 12.04 x64 fx-team pgo talos dromaeojs-e10s", 16:13:26 INFO - "buildid": "20161014154507", 16:13:26 INFO - "stage_platform": "linux64-pgo", 16:13:26 INFO - "basedir": "/builds/slave/test", 16:13:26 INFO - "buildnumber": 1245, 16:13:26 INFO - "platform": "ubuntu64_hw", 16:13:26 INFO - "master": "http://buildbot-master103.bb.releng.scl3.mozilla.com:8201/", 16:13:26 INFO - "slavebuilddir": "test", 16:13:26 INFO - "branch": "fx-team", 16:13:26 INFO - "revision": "e412b386433b8c8ba83a28a1df310d9ad0b20285", 16:13:26 INFO - "slavename": "talos-linux64-ix-050", 16:13:26 INFO - "builduid": "618b4d01f89746a091d96951062b5241", 16:13:26 INFO - "repo_path": "integration/fx-team" 16:13:26 INFO - } 16:13:26 INFO - Found installer url https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 16:13:26 INFO - Found a test packages url https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.test_packages.json. 16:13:26 INFO - Running post-action listener: _resource_record_post_action 16:13:26 INFO - [mozharness: 2016-10-14 23:13:26.589500Z] Finished read-buildbot-config step (success) 16:13:26 INFO - [mozharness: 2016-10-14 23:13:26.589586Z] Running download-and-extract step. 16:13:26 INFO - Running pre-action listener: _resource_record_pre_action 16:13:26 INFO - Running main action method: download_and_extract 16:13:26 INFO - mkdir: /builds/slave/test/build/tests 16:13:26 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')]} 16:13:26 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 16:13:26 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/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 16:13:26 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/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 16:13:26 INFO - Downloaded 1361 bytes. 16:13:26 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 16:13:26 INFO - Using the following test package requirements: 16:13:26 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 16:13:26 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 16:13:26 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 16:13:26 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 16:13:26 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 16:13:26 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 16:13:26 INFO - u'jsshell-linux-x86_64.zip'], 16:13:26 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 16:13:26 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 16:13:26 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 16:13:26 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 16:13:26 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 16:13:26 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 16:13:26 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 16:13:26 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 16:13:26 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 16:13:26 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 16:13:26 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 16:13:26 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 16:13:26 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 16:13:26 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 16:13:26 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 16:13:26 INFO - Http code: 200 16:13:26 INFO - via: 1.1 5c2ff4ca1e447265402af29264e83497.cloudfront.net (CloudFront) 16:13:26 INFO - x-amz-cf-id: f5ASFcsXBrroJxz9NXFf8ZFPMqf3gE5-g8-aaVoyJi65Aiv232W6Sw== 16:13:26 INFO - x-amz-replication-status: COMPLETED 16:13:26 INFO - x-amz-version-id: lRH5Y7emid8HixTiJq6FMSqDkYCg6.Md 16:13:26 INFO - Expected file size: 22123341 16:13:26 INFO - Obtained file size: 22123341 16:13:31 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 16:13:31 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 16:13:31 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 16:13:31 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 16:13:31 INFO - Http code: 200 16:13:31 INFO - via: 1.1 5ed093c37d643652e278a198e0556a40.cloudfront.net (CloudFront) 16:13:31 INFO - x-amz-cf-id: aZ2frg5Pi0pCowJ_QRnA87xn5dzCQLmU2jfLiDh61feJ2Mbz5wDNvQ== 16:13:31 INFO - x-amz-replication-status: COMPLETED 16:13:31 INFO - x-amz-version-id: lRH5Y7emid8HixTiJq6FMSqDkYCg6.Md 16:13:31 INFO - Expected file size: 22123341 16:13:31 INFO - Obtained file size: 22123341 16:13:36 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 16:13:36 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 16:13:36 INFO - Fetch https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 16:13:36 INFO - Http code: 200 16:13:36 INFO - via: 1.1 6cd88b9fd84ad5daa3b3867fb8c5c91a.cloudfront.net (CloudFront) 16:13:36 INFO - x-amz-cf-id: v4OCtjiY3yNhLuYjvMLEQI5B0snoaRZhHGesXd5eH57qmGChPt0PgA== 16:13:36 INFO - x-amz-replication-status: COMPLETED 16:13:36 INFO - x-amz-version-id: 7xjlszH6OzKMhfuaKJy7fayKWOZuhjCj 16:13:36 INFO - Expected file size: 14409006 16:13:36 INFO - Obtained file size: 14409006 16:13:36 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:13:36 INFO - trying https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 16:13:36 INFO - Downloading https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/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 16:13:36 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/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 16:13:37 INFO - Downloaded 59614277 bytes. 16:13:37 INFO - Setting buildbot property build_url to https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 16:13:37 INFO - mkdir: /builds/slave/test/properties 16:13:37 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 16:13:37 INFO - Writing to file /builds/slave/test/properties/build_url 16:13:37 INFO - Contents: 16:13:37 INFO - build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 16:13:37 INFO - Running post-action listener: _resource_record_post_action 16:13:37 INFO - Running post-action listener: set_extra_try_arguments 16:13:37 INFO - [mozharness: 2016-10-14 23:13:37.546080Z] Finished download-and-extract step (success) 16:13:37 INFO - [mozharness: 2016-10-14 23:13:37.546205Z] Running populate-webroot step. 16:13:37 INFO - Running pre-action listener: _resource_record_pre_action 16:13:37 INFO - Running main action method: populate_webroot 16:13:37 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 16:13:37 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 16:13:37 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 16:13:37 INFO - '--tppagecycles', 16:13:37 INFO - '7'], 16:13:37 INFO - 'tests': ['tsvgm']}}, 16:13:37 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 16:13:37 INFO - 'tests': ['tresize', 'tcanvasmark']}, 16:13:37 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 16:13:37 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 16:13:37 INFO - 'tests': ['dromaeo_css', 'kraken']}, 16:13:37 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 16:13:37 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:13:37 INFO - 'talos_options': ['--disable-e10s'], 16:13:37 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:13:37 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:13:37 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 16:13:37 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:13:37 INFO - 'talos_options': ['--disable-e10s'], 16:13:37 INFO - 'tests': ['damp', 'tps']}, 16:13:37 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:13:37 INFO - 'tests': ['damp', 'tps']}, 16:13:37 INFO - 'g3': {'talos_options': ['--disable-e10s'], 16:13:37 INFO - 'tests': ['dromaeo_dom']}, 16:13:37 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 16:13:37 INFO - 'g4': {'talos_options': ['--disable-e10s'], 16:13:37 INFO - 'tests': ['basic_compositor_video']}, 16:13:37 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 16:13:37 INFO - 'other': {'talos_options': ['--disable-e10s'], 16:13:37 INFO - 'tests': ['a11yr', 16:13:37 INFO - 'ts_paint', 16:13:37 INFO - 'tpaint', 16:13:37 INFO - 'sessionrestore', 16:13:37 INFO - 'sessionrestore_no_auto_restore', 16:13:37 INFO - 'tabpaint']}, 16:13:37 INFO - 'other-e10s': {'tests': ['a11yr', 16:13:37 INFO - 'ts_paint', 16:13:37 INFO - 'tpaint', 16:13:37 INFO - 'sessionrestore', 16:13:37 INFO - 'sessionrestore_no_auto_restore', 16:13:37 INFO - 'tabpaint']}, 16:13:37 INFO - 'other-e10s_l64': {'tests': ['a11yr', 16:13:37 INFO - 'ts_paint', 16:13:37 INFO - 'tpaint', 16:13:37 INFO - 'sessionrestore', 16:13:37 INFO - 'sessionrestore_no_auto_restore', 16:13:37 INFO - 'tabpaint']}, 16:13:37 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 16:13:37 INFO - 'ts_paint', 16:13:37 INFO - 'tpaint', 16:13:37 INFO - 'sessionrestore', 16:13:37 INFO - 'sessionrestore_no_auto_restore', 16:13:37 INFO - 'tabpaint']}, 16:13:37 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 16:13:37 INFO - 'tests': ['a11yr', 16:13:37 INFO - 'ts_paint', 16:13:37 INFO - 'tpaint', 16:13:37 INFO - 'sessionrestore', 16:13:37 INFO - 'sessionrestore_no_auto_restore', 16:13:37 INFO - 'tabpaint']}, 16:13:37 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 16:13:37 INFO - 'tests': ['a11yr', 16:13:37 INFO - 'ts_paint', 16:13:37 INFO - 'tpaint', 16:13:37 INFO - 'sessionrestore', 16:13:37 INFO - 'sessionrestore_no_auto_restore', 16:13:37 INFO - 'tabpaint']}, 16:13:37 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 16:13:37 INFO - 'tests': ['tsvgx', 16:13:37 INFO - 'tsvgr_opacity', 16:13:37 INFO - 'tart', 16:13:37 INFO - 'tscrollx', 16:13:37 INFO - 'cart']}, 16:13:37 INFO - 'svgr-e10s': {'tests': ['tsvgx', 16:13:37 INFO - 'tsvgr_opacity', 16:13:37 INFO - 'tart', 16:13:37 INFO - 'tscrollx', 16:13:37 INFO - 'cart']}, 16:13:37 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:13:37 INFO - 'talos_options': ['--disable-e10s'], 16:13:37 INFO - 'tests': ['tp5o']}, 16:13:37 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:13:37 INFO - 'tests': ['tp5o']}, 16:13:37 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:13:37 INFO - 'talos_options': ['--disable-e10s', 16:13:37 INFO - '--xperf_path', 16:13:37 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:13:37 INFO - 'tests': ['tp5n']}, 16:13:37 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 16:13:37 INFO - 'talos_options': ['--xperf_path', 16:13:37 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 16:13:37 INFO - 'tests': ['tp5n']}}, 16:13:37 INFO - 'talos.zip': {'path': '', 16:13:37 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 16:13:37 INFO - Running post-action listener: _resource_record_post_action 16:13:37 INFO - [mozharness: 2016-10-14 23:13:37.562441Z] Finished populate-webroot step (success) 16:13:37 INFO - [mozharness: 2016-10-14 23:13:37.562534Z] Running create-virtualenv step. 16:13:37 INFO - Running pre-action listener: _resource_record_pre_action 16:13:37 INFO - Running main action method: create_virtualenv 16:13:37 INFO - Creating virtualenv /builds/slave/test/build/venv 16:13:37 INFO - Running command: ['/tools/buildbot/bin/python', '/tools/misc-python/virtualenv.py', '--no-site-packages', '--distribute', '/builds/slave/test/build/venv'] in /builds/slave/test/build 16:13:37 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 16:13:37 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 16:13:37 INFO - Using real prefix '/usr' 16:13:37 INFO - New python executable in /builds/slave/test/build/venv/bin/python 16:13:38 INFO - Installing distribute.............................................................................................................................................................................................done. 16:13:40 INFO - Installing pip.................done. 16:13:40 INFO - Return code: 0 16:13:40 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 16:13:40 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 16:13:40 INFO - Reading from file tmpfile_stdout 16:13:40 INFO - Output received: 16:13:40 INFO - pip 1.5.5 from /builds/slave/test/build/venv/local/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg (python 2.7) 16:13:40 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 16:13:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:13:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:13:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:13:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:13:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:40 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 0x7f3eb7b53f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12a9790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12a6930>, '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 0x12a7830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12a7cc0>, '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': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:13:40 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 16:13:40 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 16:13:40 INFO - Using env: {'DISPLAY': ':0', 16:13:40 INFO - 'HOME': '/home/cltbld', 16:13:40 INFO - 'LANG': 'en_US.UTF-8', 16:13:40 INFO - 'LANGUAGE': 'en_US:en', 16:13:40 INFO - 'LOGNAME': 'cltbld', 16:13:40 INFO - 'MAIL': '/var/mail/cltbld', 16:13:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:13:40 INFO - 'MOZ_NO_REMOTE': '1', 16:13:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:13:40 INFO - 'NO_EM_RESTART': '1', 16:13:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:13:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:13:40 INFO - 'PWD': '/builds/slave/test', 16:13:40 INFO - 'SHELL': '/bin/bash', 16:13:40 INFO - 'SHLVL': '1', 16:13:40 INFO - 'TERM': 'linux', 16:13:40 INFO - 'TMOUT': '86400', 16:13:40 INFO - 'USER': 'cltbld', 16:13:40 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 16:13:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:13:40 INFO - '_': '/tools/buildbot/bin/python'} 16:13:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:13:40 INFO - Requirement already satisfied (use --upgrade to upgrade): pip>=1.5 in ./venv/lib/python2.7/site-packages/pip-1.5.5-py2.7.egg 16:13:40 INFO - Cleaning up... 16:13:40 INFO - Return code: 0 16:13:40 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 16:13:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:13:40 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:13:40 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:40 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:13:40 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:13:40 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:40 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 0x7f3eb7b53f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12a9790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12a6930>, '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 0x12a7830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12a7cc0>, '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': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:13:40 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 16:13:40 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 16:13:40 INFO - Using env: {'DISPLAY': ':0', 16:13:40 INFO - 'HOME': '/home/cltbld', 16:13:40 INFO - 'LANG': 'en_US.UTF-8', 16:13:40 INFO - 'LANGUAGE': 'en_US:en', 16:13:40 INFO - 'LOGNAME': 'cltbld', 16:13:40 INFO - 'MAIL': '/var/mail/cltbld', 16:13:40 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:13:40 INFO - 'MOZ_NO_REMOTE': '1', 16:13:40 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:13:40 INFO - 'NO_EM_RESTART': '1', 16:13:40 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:13:40 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:13:40 INFO - 'PWD': '/builds/slave/test', 16:13:40 INFO - 'SHELL': '/bin/bash', 16:13:40 INFO - 'SHLVL': '1', 16:13:40 INFO - 'TERM': 'linux', 16:13:40 INFO - 'TMOUT': '86400', 16:13:40 INFO - 'USER': 'cltbld', 16:13:40 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 16:13:40 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:13:40 INFO - '_': '/tools/buildbot/bin/python'} 16:13:40 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:13:40 INFO - Downloading/unpacking psutil>=3.1.1 16:13:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:40 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 16:13:40 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 16:13:40 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:40 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:42 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 16:13:42 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:13:42 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:13:42 INFO - Installing collected packages: psutil 16:13:42 INFO - Running setup.py install for psutil 16:13:42 INFO - building 'psutil._psutil_linux' extension 16:13:42 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -DPSUTIL_VERSION=311 -I/usr/include/python2.7 -c psutil/_psutil_linux.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o 16:13:43 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_linux.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_linux.so 16:13:43 INFO - building 'psutil._psutil_posix' extension 16:13:43 INFO - gcc -pthread -fno-strict-aliasing -DNDEBUG -g -fwrapv -O2 -Wall -Wstrict-prototypes -fPIC -I/usr/include/python2.7 -c psutil/_psutil_posix.c -o build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o 16:13:43 INFO - gcc -pthread -shared -Wl,-O1 -Wl,-Bsymbolic-functions -Wl,-Bsymbolic-functions -Wl,-z,relro build/temp.linux-x86_64-2.7/psutil/_psutil_posix.o -o build/lib.linux-x86_64-2.7/psutil/_psutil_posix.so 16:13:43 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 16:13:43 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 16:13:43 INFO - Successfully installed psutil 16:13:43 INFO - Cleaning up... 16:13:43 INFO - Return code: 0 16:13:43 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 16:13:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:13:43 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:13:43 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:43 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 16:13:43 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:13:43 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:43 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.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 0x7f3eb7b53f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12a9790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12a6930>, '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 0x12a7830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12a7cc0>, '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': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:13:43 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 16:13:43 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 16:13:43 INFO - Using env: {'DISPLAY': ':0', 16:13:43 INFO - 'HOME': '/home/cltbld', 16:13:43 INFO - 'LANG': 'en_US.UTF-8', 16:13:43 INFO - 'LANGUAGE': 'en_US:en', 16:13:43 INFO - 'LOGNAME': 'cltbld', 16:13:43 INFO - 'MAIL': '/var/mail/cltbld', 16:13:43 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:13:43 INFO - 'MOZ_NO_REMOTE': '1', 16:13:43 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:13:43 INFO - 'NO_EM_RESTART': '1', 16:13:43 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:13:43 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:13:43 INFO - 'PWD': '/builds/slave/test', 16:13:43 INFO - 'SHELL': '/bin/bash', 16:13:43 INFO - 'SHLVL': '1', 16:13:43 INFO - 'TERM': 'linux', 16:13:43 INFO - 'TMOUT': '86400', 16:13:43 INFO - 'USER': 'cltbld', 16:13:43 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 16:13:43 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:13:43 INFO - '_': '/tools/buildbot/bin/python'} 16:13:43 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:13:43 INFO - Downloading/unpacking mozsystemmonitor==0.3 16:13:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:43 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 16:13:43 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 16:13:43 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:43 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:45 INFO - Downloading mozsystemmonitor-0.3.tar.gz 16:13:45 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 16:13:45 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 16:13:45 INFO - Installing collected packages: mozsystemmonitor 16:13:45 INFO - Running setup.py install for mozsystemmonitor 16:13:45 INFO - Successfully installed mozsystemmonitor 16:13:45 INFO - Cleaning up... 16:13:45 INFO - Return code: 0 16:13:45 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 16:13: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')]} 16:13:45 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:13:45 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13: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')]} 16:13:45 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:13:45 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:45 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 0x7f3eb7b53f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12a9790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12a6930>, '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 0x12a7830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12a7cc0>, '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': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:13:45 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 16:13:45 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 16:13:45 INFO - Using env: {'DISPLAY': ':0', 16:13:45 INFO - 'HOME': '/home/cltbld', 16:13:45 INFO - 'LANG': 'en_US.UTF-8', 16:13:45 INFO - 'LANGUAGE': 'en_US:en', 16:13:45 INFO - 'LOGNAME': 'cltbld', 16:13:45 INFO - 'MAIL': '/var/mail/cltbld', 16:13:45 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:13:45 INFO - 'MOZ_NO_REMOTE': '1', 16:13:45 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:13:45 INFO - 'NO_EM_RESTART': '1', 16:13:45 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:13:45 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:13:45 INFO - 'PWD': '/builds/slave/test', 16:13:45 INFO - 'SHELL': '/bin/bash', 16:13:45 INFO - 'SHLVL': '1', 16:13:45 INFO - 'TERM': 'linux', 16:13:45 INFO - 'TMOUT': '86400', 16:13:45 INFO - 'USER': 'cltbld', 16:13:45 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 16:13:45 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:13:45 INFO - '_': '/tools/buildbot/bin/python'} 16:13:45 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:13:45 INFO - Downloading/unpacking jsonschema==2.5.1 16:13:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:45 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 16:13:45 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 16:13:45 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:45 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:47 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 16:13:47 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 16:13:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:47 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 16:13:47 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 16:13:47 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:47 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:48 INFO - Downloading functools32-3.2.3-2.tar.gz 16:13:48 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 16:13:48 INFO - warning: no files found matching '*.txt' 16:13:48 INFO - no previously-included directories found matching 'build' 16:13:48 INFO - no previously-included directories found matching 'dist' 16:13:48 INFO - no previously-included directories found matching '.git*' 16:13:48 INFO - Installing collected packages: jsonschema, functools32 16:13:48 INFO - Running setup.py install for functools32 16:13:48 INFO - warning: no files found matching '*.txt' 16:13:48 INFO - no previously-included directories found matching 'build' 16:13:48 INFO - no previously-included directories found matching 'dist' 16:13:48 INFO - no previously-included directories found matching '.git*' 16:13:48 INFO - Successfully installed jsonschema functools32 16:13:48 INFO - Cleaning up... 16:13:48 INFO - Return code: 0 16:13:48 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 16:13:48 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')]} 16:13:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:13:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:48 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')]} 16:13:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:13:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:48 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 0x7f3eb7b53f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12a9790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12a6930>, '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 0x12a7830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12a7cc0>, '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': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:13:48 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 16:13:48 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 16:13:48 INFO - Using env: {'DISPLAY': ':0', 16:13:48 INFO - 'HOME': '/home/cltbld', 16:13:48 INFO - 'LANG': 'en_US.UTF-8', 16:13:48 INFO - 'LANGUAGE': 'en_US:en', 16:13:48 INFO - 'LOGNAME': 'cltbld', 16:13:48 INFO - 'MAIL': '/var/mail/cltbld', 16:13:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:13:48 INFO - 'MOZ_NO_REMOTE': '1', 16:13:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:13:48 INFO - 'NO_EM_RESTART': '1', 16:13:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:13:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:13:48 INFO - 'PWD': '/builds/slave/test', 16:13:48 INFO - 'SHELL': '/bin/bash', 16:13:48 INFO - 'SHLVL': '1', 16:13:48 INFO - 'TERM': 'linux', 16:13:48 INFO - 'TMOUT': '86400', 16:13:48 INFO - 'USER': 'cltbld', 16:13:48 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 16:13:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:13:48 INFO - '_': '/tools/buildbot/bin/python'} 16:13:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:13:48 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 16:13:48 INFO - Cleaning up... 16:13:48 INFO - Return code: 0 16:13:48 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 16:13:48 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')]} 16:13:48 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:13:48 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:48 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')]} 16:13:48 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:13:48 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:48 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 0x7f3eb7b53f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12a9790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12a6930>, '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 0x12a7830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12a7cc0>, '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': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:13:48 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 16:13:48 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 16:13:48 INFO - Using env: {'DISPLAY': ':0', 16:13:48 INFO - 'HOME': '/home/cltbld', 16:13:48 INFO - 'LANG': 'en_US.UTF-8', 16:13:48 INFO - 'LANGUAGE': 'en_US:en', 16:13:48 INFO - 'LOGNAME': 'cltbld', 16:13:48 INFO - 'MAIL': '/var/mail/cltbld', 16:13:48 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:13:48 INFO - 'MOZ_NO_REMOTE': '1', 16:13:48 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:13:48 INFO - 'NO_EM_RESTART': '1', 16:13:48 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:13:48 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:13:48 INFO - 'PWD': '/builds/slave/test', 16:13:48 INFO - 'SHELL': '/bin/bash', 16:13:48 INFO - 'SHLVL': '1', 16:13:48 INFO - 'TERM': 'linux', 16:13:48 INFO - 'TMOUT': '86400', 16:13:48 INFO - 'USER': 'cltbld', 16:13:48 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 16:13:48 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:13:48 INFO - '_': '/tools/buildbot/bin/python'} 16:13:48 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:13:48 INFO - Downloading/unpacking blobuploader==1.2.4 16:13:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:48 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 16:13:48 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 16:13:48 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:48 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:50 INFO - Downloading blobuploader-1.2.4.tar.gz 16:13:50 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 16:13:50 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 16:13:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:50 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 16:13:50 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 16:13:50 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:50 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 16:13:51 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 16:13:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:51 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 16:13:51 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 16:13:51 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:51 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:51 INFO - Downloading docopt-0.6.1.tar.gz 16:13:51 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 16:13:51 INFO - Installing collected packages: blobuploader, requests, docopt 16:13:51 INFO - Running setup.py install for blobuploader 16:13:51 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 16:13:51 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 16:13:51 INFO - Running setup.py install for requests 16:13:51 INFO - Running setup.py install for docopt 16:13:52 INFO - Successfully installed blobuploader requests docopt 16:13:52 INFO - Cleaning up... 16:13:52 INFO - Return code: 0 16:13:52 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:13:52 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')]} 16:13:52 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:13:52 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:52 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')]} 16:13:52 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:13:52 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:52 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 0x7f3eb7b53f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12a9790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12a6930>, '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 0x12a7830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12a7cc0>, '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': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:13:52 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 16:13:52 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 16:13:52 INFO - Using env: {'DISPLAY': ':0', 16:13:52 INFO - 'HOME': '/home/cltbld', 16:13:52 INFO - 'LANG': 'en_US.UTF-8', 16:13:52 INFO - 'LANGUAGE': 'en_US:en', 16:13:52 INFO - 'LOGNAME': 'cltbld', 16:13:52 INFO - 'MAIL': '/var/mail/cltbld', 16:13:52 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:13:52 INFO - 'MOZ_NO_REMOTE': '1', 16:13:52 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:13:52 INFO - 'NO_EM_RESTART': '1', 16:13:52 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:13:52 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:13:52 INFO - 'PWD': '/builds/slave/test', 16:13:52 INFO - 'SHELL': '/bin/bash', 16:13:52 INFO - 'SHLVL': '1', 16:13:52 INFO - 'TERM': 'linux', 16:13:52 INFO - 'TMOUT': '86400', 16:13:52 INFO - 'USER': 'cltbld', 16:13:52 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 16:13:52 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:13:52 INFO - '_': '/tools/buildbot/bin/python'} 16:13:52 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:13:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:13:52 INFO - Running setup.py (path:/tmp/pip-CZdfDn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:13:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:13:52 INFO - Running setup.py (path:/tmp/pip-qclqvO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:13:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:13:52 INFO - Running setup.py (path:/tmp/pip-XljE6b-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:13:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:13:52 INFO - Running setup.py (path:/tmp/pip-OjFXHt-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:13:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:13:52 INFO - Running setup.py (path:/tmp/pip-oKjpES-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:13:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:13:52 INFO - Running setup.py (path:/tmp/pip-hAPOES-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:13:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:13:52 INFO - Running setup.py (path:/tmp/pip-Rhql2a-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:13:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:13:52 INFO - Running setup.py (path:/tmp/pip-NIQV3o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:13:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:13:52 INFO - Running setup.py (path:/tmp/pip-FSgabB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:13:52 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:13:52 INFO - Running setup.py (path:/tmp/pip-75Sw5R-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:13:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:13:53 INFO - Running setup.py (path:/tmp/pip-qZLs8h-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:13:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:13:53 INFO - Running setup.py (path:/tmp/pip-XsC2jX-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:13:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:13:53 INFO - Running setup.py (path:/tmp/pip-ZiO52S-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:13:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:13:53 INFO - Running setup.py (path:/tmp/pip-CLH4xv-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:13:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:13:53 INFO - Running setup.py (path:/tmp/pip-tHeidp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:13:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:13:53 INFO - Running setup.py (path:/tmp/pip-Oz7xn9-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:13:53 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:13:53 INFO - Running setup.py (path:/tmp/pip-AFU_jc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:13:53 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 16:13:53 INFO - Running setup.py install for manifestparser 16:13:53 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 16:13:53 INFO - Running setup.py install for mozcrash 16:13:53 INFO - Running setup.py install for mozdebug 16:13:53 INFO - Running setup.py install for mozdevice 16:13:53 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 16:13:53 INFO - Installing dm script to /builds/slave/test/build/venv/bin 16:13:53 INFO - Running setup.py install for mozfile 16:13:54 INFO - Running setup.py install for mozhttpd 16:13:54 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 16:13:54 INFO - Running setup.py install for mozinfo 16:13:54 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 16:13:54 INFO - Running setup.py install for mozInstall 16:13:54 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 16:13:54 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 16:13:54 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 16:13:54 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 16:13:54 INFO - Running setup.py install for mozleak 16:13:54 INFO - Running setup.py install for mozlog 16:13:54 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 16:13:54 INFO - Running setup.py install for moznetwork 16:13:54 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 16:13:54 INFO - Running setup.py install for mozprocess 16:13:54 INFO - Running setup.py install for mozprofile 16:13:54 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 16:13:54 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 16:13:54 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 16:13:54 INFO - Running setup.py install for mozrunner 16:13:55 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 16:13:55 INFO - Running setup.py install for mozscreenshot 16:13:55 INFO - Running setup.py install for moztest 16:13:55 INFO - Running setup.py install for mozversion 16:13:55 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 16:13:55 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 16:13:55 INFO - Cleaning up... 16:13:55 INFO - Return code: 0 16:13:55 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:13:55 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')]} 16:13:55 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:13:55 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:55 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')]} 16:13:55 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:13:55 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:55 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 0x7f3eb7b53f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12a9790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12a6930>, '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 0x12a7830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12a7cc0>, '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': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:13:55 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 16:13:55 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 16:13:55 INFO - Using env: {'DISPLAY': ':0', 16:13:55 INFO - 'HOME': '/home/cltbld', 16:13:55 INFO - 'LANG': 'en_US.UTF-8', 16:13:55 INFO - 'LANGUAGE': 'en_US:en', 16:13:55 INFO - 'LOGNAME': 'cltbld', 16:13:55 INFO - 'MAIL': '/var/mail/cltbld', 16:13:55 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:13:55 INFO - 'MOZ_NO_REMOTE': '1', 16:13:55 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:13:55 INFO - 'NO_EM_RESTART': '1', 16:13:55 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:13:55 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:13:55 INFO - 'PWD': '/builds/slave/test', 16:13:55 INFO - 'SHELL': '/bin/bash', 16:13:55 INFO - 'SHLVL': '1', 16:13:55 INFO - 'TERM': 'linux', 16:13:55 INFO - 'TMOUT': '86400', 16:13:55 INFO - 'USER': 'cltbld', 16:13:55 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 16:13:55 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:13:55 INFO - '_': '/tools/buildbot/bin/python'} 16:13:55 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:13:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 16:13:55 INFO - Running setup.py (path:/tmp/pip-Sk2QbO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 16:13:55 INFO - Requirement already satisfied (use --upgrade to upgrade): manifestparser==1.1 from file:///builds/slave/test/build/tests/mozbase/manifestparser in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 1)) 16:13:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 16:13:55 INFO - Running setup.py (path:/tmp/pip-wStQ3V-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 16:13:55 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)) 16:13:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 16:13:55 INFO - Running setup.py (path:/tmp/pip-VUkaNM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 16:13:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdebug==0.1 from file:///builds/slave/test/build/tests/mozbase/mozdebug in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 16:13:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 16:13:55 INFO - Running setup.py (path:/tmp/pip-2bkBuD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 16:13:55 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)) 16:13:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 16:13:55 INFO - Running setup.py (path:/tmp/pip-eYuZlH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 16:13:55 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile==1.2 from file:///builds/slave/test/build/tests/mozbase/mozfile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 5)) 16:13:55 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 16:13:55 INFO - Running setup.py (path:/tmp/pip-dlOEd3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 16:13:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd==0.7 from file:///builds/slave/test/build/tests/mozbase/mozhttpd in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 6)) 16:13:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 16:13:56 INFO - Running setup.py (path:/tmp/pip-pW27jw-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 16:13:56 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)) 16:13:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 16:13:56 INFO - Running setup.py (path:/tmp/pip-eA_oHF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 16:13:56 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)) 16:13:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 16:13:56 INFO - Running setup.py (path:/tmp/pip-Zq_0YT-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 16:13:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozleak==0.1 from file:///builds/slave/test/build/tests/mozbase/mozleak in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 9)) 16:13:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 16:13:56 INFO - Running setup.py (path:/tmp/pip-UxPMQ5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 16:13:56 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)) 16:13:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 16:13:56 INFO - Running setup.py (path:/tmp/pip-yb0m7Z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 16:13:56 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork==0.27 from file:///builds/slave/test/build/tests/mozbase/moznetwork in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 11)) 16:13:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 16:13:56 INFO - Running setup.py (path:/tmp/pip-QrH_IM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 16:13:56 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)) 16:13:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 16:13:56 INFO - Running setup.py (path:/tmp/pip-jbGsEd-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 16:13:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile==0.28 from file:///builds/slave/test/build/tests/mozbase/mozprofile in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 13)) 16:13:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 16:13:56 INFO - Running setup.py (path:/tmp/pip-4O9H0x-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 16:13:56 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)) 16:13:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 16:13:56 INFO - Running setup.py (path:/tmp/pip-ah3QcW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 16:13:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozscreenshot==0.1 from file:///builds/slave/test/build/tests/mozbase/mozscreenshot in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 15)) 16:13:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 16:13:56 INFO - Running setup.py (path:/tmp/pip-mt2d16-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 16:13:56 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)) 16:13:56 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 16:13:56 INFO - Running setup.py (path:/tmp/pip-mGedCS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 16:13:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion==1.4 from file:///builds/slave/test/build/tests/mozbase/mozversion in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 17)) 16:13:56 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)) 16:13:56 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)) 16:13:56 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozdebug==0.1->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 3)) 16:13:56 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)) 16:13:56 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)) 16:13:56 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 16:13:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:56 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 16:13:56 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 16:13:56 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 16:13:56 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 16:13:58 INFO - Downloading blessings-1.6.tar.gz 16:13:58 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 16:13:58 INFO - Installing collected packages: blessings 16:13:58 INFO - Running setup.py install for blessings 16:13:58 INFO - Successfully installed blessings 16:13:58 INFO - Cleaning up... 16:13:59 INFO - Return code: 0 16:13:59 INFO - Done creating virtualenv /builds/slave/test/build/venv. 16:13:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:13:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:13:59 INFO - Reading from file tmpfile_stdout 16:13:59 INFO - Current package versions: 16:13:59 INFO - argparse == 1.2.1 16:13:59 INFO - blessings == 1.6 16:13:59 INFO - blobuploader == 1.2.4 16:13:59 INFO - docopt == 0.6.1 16:13:59 INFO - functools32 == 3.2.3-2 16:13:59 INFO - jsonschema == 2.5.1 16:13:59 INFO - manifestparser == 1.1 16:13:59 INFO - mozInstall == 1.12 16:13:59 INFO - mozcrash == 0.17 16:13:59 INFO - mozdebug == 0.1 16:13:59 INFO - mozdevice == 0.48 16:13:59 INFO - mozfile == 1.2 16:13:59 INFO - mozhttpd == 0.7 16:13:59 INFO - mozinfo == 0.9 16:13:59 INFO - mozleak == 0.1 16:13:59 INFO - mozlog == 3.4 16:13:59 INFO - moznetwork == 0.27 16:13:59 INFO - mozprocess == 0.23 16:13:59 INFO - mozprofile == 0.28 16:13:59 INFO - mozrunner == 6.12 16:13:59 INFO - mozscreenshot == 0.1 16:13:59 INFO - mozsystemmonitor == 0.3 16:13:59 INFO - moztest == 0.7 16:13:59 INFO - mozversion == 1.4 16:13:59 INFO - psutil == 3.1.1 16:13:59 INFO - requests == 1.2.3 16:13:59 INFO - wsgiref == 0.1.2 16:13:59 INFO - Installing None into virtualenv /builds/slave/test/build/venv 16:13: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')]} 16:13:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:13:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13: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')]} 16:13:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:13:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:59 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 0x7f3eb7b53f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12a9790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12a6930>, '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 0x12a7830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12a7cc0>, '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': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:13:59 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 16:13:59 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 16:13:59 INFO - Using env: {'DISPLAY': ':0', 16:13:59 INFO - 'HOME': '/home/cltbld', 16:13:59 INFO - 'LANG': 'en_US.UTF-8', 16:13:59 INFO - 'LANGUAGE': 'en_US:en', 16:13:59 INFO - 'LOGNAME': 'cltbld', 16:13:59 INFO - 'MAIL': '/var/mail/cltbld', 16:13:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:13:59 INFO - 'MOZ_NO_REMOTE': '1', 16:13:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:13:59 INFO - 'NO_EM_RESTART': '1', 16:13:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:13:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:13:59 INFO - 'PWD': '/builds/slave/test', 16:13:59 INFO - 'SHELL': '/bin/bash', 16:13:59 INFO - 'SHLVL': '1', 16:13:59 INFO - 'TERM': 'linux', 16:13:59 INFO - 'TMOUT': '86400', 16:13:59 INFO - 'USER': 'cltbld', 16:13:59 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 16:13:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:13:59 INFO - '_': '/tools/buildbot/bin/python'} 16:13:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:13:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 16:13:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash>=0.15 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 2)) 16:13:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.2 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 3)) 16:13:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozhttpd>=0.7 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 16:13:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozinfo>=0.8 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 5)) 16:13:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess>=0.22 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 6)) 16:13:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozversion>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 7)) 16:13:59 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprofile>=0.25 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 8)) 16:13:59 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/talos/requirements.txt (line 9)) 16:13:59 INFO - Requirement already satisfied (use --upgrade to upgrade): blessings>=1.3 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozlog>=3.1->-r /builds/slave/test/build/tests/talos/requirements.txt (line 1)) 16:13:59 INFO - Requirement already satisfied (use --upgrade to upgrade): moznetwork>=0.24 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozhttpd>=0.7->-r /builds/slave/test/build/tests/talos/requirements.txt (line 4)) 16:13:59 INFO - Cleaning up... 16:13:59 INFO - Return code: 0 16:13:59 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 16:13: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')]} 16:13:59 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 16:13:59 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13: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')]} 16:13:59 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 16:13:59 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 16:13:59 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 0x7f3eb7b53f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x11dc8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x12a9790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x12a6930>, '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 0x12a7830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12a7cc0>, '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': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 'LANGUAGE': 'en_US:en', 'MAIL': '/var/mail/cltbld', 'SHLVL': '1', 'XPCOM_DEBUG_BREAK': 'warn', 'MOZ_CRASHREPORTER_NO_REPORT': '1', 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 'TMOUT': '86400', 'PWD': '/builds/slave/test', 'LOGNAME': 'cltbld', 'USER': 'cltbld', 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 'NO_EM_RESTART': '1', 'HOME': '/home/cltbld', 'DISPLAY': ':0', '_': '/tools/buildbot/bin/python'}}, attempt #1 16:13:59 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 16:13:59 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 16:13:59 INFO - Using env: {'DISPLAY': ':0', 16:13:59 INFO - 'HOME': '/home/cltbld', 16:13:59 INFO - 'LANG': 'en_US.UTF-8', 16:13:59 INFO - 'LANGUAGE': 'en_US:en', 16:13:59 INFO - 'LOGNAME': 'cltbld', 16:13:59 INFO - 'MAIL': '/var/mail/cltbld', 16:13:59 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:13:59 INFO - 'MOZ_NO_REMOTE': '1', 16:13:59 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:13:59 INFO - 'NO_EM_RESTART': '1', 16:13:59 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:13:59 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:13:59 INFO - 'PWD': '/builds/slave/test', 16:13:59 INFO - 'SHELL': '/bin/bash', 16:13:59 INFO - 'SHLVL': '1', 16:13:59 INFO - 'TERM': 'linux', 16:13:59 INFO - 'TMOUT': '86400', 16:13:59 INFO - 'USER': 'cltbld', 16:13:59 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 16:13:59 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:13:59 INFO - '_': '/tools/buildbot/bin/python'} 16:13:59 INFO - Ignoring indexes: https://pypi.python.org/simple/ 16:13:59 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 16:13:59 INFO - Cleaning up... 16:13:59 INFO - Return code: 0 16:13:59 INFO - Running post-action listener: _resource_record_post_action 16:13:59 INFO - Running post-action listener: _start_resource_monitoring 16:13:59 INFO - Starting resource monitoring. 16:13:59 INFO - [mozharness: 2016-10-14 23:13:59.718525Z] Finished create-virtualenv step (success) 16:13:59 INFO - [mozharness: 2016-10-14 23:13:59.718981Z] Running install step. 16:13:59 INFO - Running pre-action listener: _resource_record_pre_action 16:13:59 INFO - Running main action method: install 16:13:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 16:13:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 16:13:59 INFO - Reading from file tmpfile_stdout 16:13:59 INFO - Detecting whether we're running mozinstall >=1.0... 16:13:59 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 16:13:59 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 16:14:00 INFO - Reading from file tmpfile_stdout 16:14:00 INFO - Output received: 16:14:00 INFO - Usage: mozinstall [options] installer 16:14:00 INFO - Options: 16:14:00 INFO - -h, --help show this help message and exit 16:14:00 INFO - -d DEST, --destination=DEST 16:14:00 INFO - Directory to install application into. [default: 16:14:00 INFO - "/builds/slave/test"] 16:14:00 INFO - --app=APP Application being installed. [default: firefox] 16:14:00 INFO - mkdir: /builds/slave/test/build/application 16:14:00 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'] 16:14:00 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 16:14:16 INFO - Reading from file tmpfile_stdout 16:14:16 INFO - Output received: 16:14:16 INFO - /builds/slave/test/build/application/firefox/firefox 16:14:16 INFO - Running post-action listener: _resource_record_post_action 16:14:16 INFO - [mozharness: 2016-10-14 23:14:16.998587Z] Finished install step (success) 16:14:16 INFO - [mozharness: 2016-10-14 23:14:16.998857Z] Running run-tests step. 16:14:16 INFO - Running pre-action listener: _resource_record_pre_action 16:14:16 INFO - Running main action method: run_tests 16:14:16 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 16:14:16 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 16:14:17 INFO - Python 2.7.3 16:14:17 INFO - Return code: 0 16:14:17 INFO - grabbing minidump binary from tooltool 16:14: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')]} 16:14:17 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 0x12a6930>, '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 0x12a7830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x12a7cc0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 16:14:17 INFO - Running command: ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] in /builds/slave/test/build 16:14:17 INFO - Copy/paste: /tools/tooltool.py --url https://api.pub.build.mozilla.org/tooltool/ --authentication-file /builds/relengapi.tok fetch -m /builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest -o -c /builds/tooltool_cache 16:14:17 INFO - Calling ['/tools/tooltool.py', '--url', 'https://api.pub.build.mozilla.org/tooltool/', '--authentication-file', '/builds/relengapi.tok', 'fetch', '-m', '/builds/slave/test/build/tests/config/tooltool-manifests/linux64/releng.manifest', '-o', '-c', '/builds/tooltool_cache'] with output_timeout 600 16:14:17 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 16:14:17 INFO - Return code: 0 16:14:17 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 16:14:17 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 16:14:17 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 16:14:17 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 16:14:17 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 16:14:17 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-050', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] in /builds/slave/test/build 16:14:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Fx-Team --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-050 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log 16:14:17 INFO - Using env: {'DISPLAY': ':0', 16:14:17 INFO - 'HOME': '/home/cltbld', 16:14:17 INFO - 'LANG': 'en_US.UTF-8', 16:14:17 INFO - 'LANGUAGE': 'en_US:en', 16:14:17 INFO - 'LOGNAME': 'cltbld', 16:14:17 INFO - 'MAIL': '/var/mail/cltbld', 16:14:17 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 16:14:17 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 16:14:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 16:14:17 INFO - 'MOZ_NO_REMOTE': '1', 16:14:17 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 16:14:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 16:14:17 INFO - 'NO_EM_RESTART': '1', 16:14:17 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 16:14:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 16:14:17 INFO - 'PWD': '/builds/slave/test', 16:14:17 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 16:14:17 INFO - 'SHELL': '/bin/bash', 16:14:17 INFO - 'SHLVL': '1', 16:14:17 INFO - 'TERM': 'linux', 16:14:17 INFO - 'TMOUT': '86400', 16:14:17 INFO - 'USER': 'cltbld', 16:14:17 INFO - 'XDG_SESSION_COOKIE': '6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058', 16:14:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 16:14:17 INFO - '_': '/tools/buildbot/bin/python'} 16:14:17 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Fx-Team', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-050', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log'] with output_timeout 3600 16:14:17 INFO - mozversion application_buildid: 20161014123004 16:14:17 INFO - mozversion application_changeset: e412b386433b8c8ba83a28a1df310d9ad0b20285 16:14:17 INFO - mozversion application_display_name: Nightly 16:14:17 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 16:14:17 INFO - mozversion application_name: Firefox 16:14:17 INFO - mozversion application_remotingname: firefox 16:14:17 INFO - mozversion application_repository: https://hg.mozilla.org/integration/fx-team 16:14:17 INFO - mozversion application_vendor: Mozilla 16:14:17 INFO - mozversion application_version: 52.0a1 16:14:17 INFO - mozversion platform_buildid: 20161014123004 16:14:17 INFO - mozversion platform_changeset: e412b386433b8c8ba83a28a1df310d9ad0b20285 16:14:17 INFO - mozversion platform_repository: https://hg.mozilla.org/integration/fx-team 16:14:17 INFO - mozversion platform_version: 52.0a1 16:14:17 INFO - using testdate: 1476486857 16:14:17 INFO - actual date: 1476486857 16:14:17 INFO - starting webserver on 'localhost:39593' 16:14:17 INFO - SUITE-START | Running 2 tests 16:14:17 INFO - TEST-START | dromaeo_css 16:14:17 INFO - operating with platform_type : linux_ 16:14:17 INFO - Initialising browser for dromaeo_css test... 16:14:17 INFO - TEST-INFO | started process 9746 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp9hYYv_/profile http://localhost:39593/getInfo.html) 16:14:21 INFO - PROCESS | 9746 | __metrics Screen width/height:1600/1200 16:14:21 INFO - PROCESS | 9746 | colorDepth:24 16:14:21 INFO - PROCESS | 9746 | Browser inner width/height: 1024/697 16:14:21 INFO - PROCESS | 9746 | __metrics 16:14:22 ERROR - PROCESS | 9746 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3083: TypeError: this.tabs is undefined 16:14:23 INFO - TEST-INFO | 9746: exit 0 16:14:23 INFO - Browser initialized. 16:14:23 INFO - Running cycle 1/1 for dromaeo_css test... 16:14:23 INFO - TEST-INFO | started process 9870 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp9hYYv_/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:14:35 INFO - PROCESS | 9870 | RSS: Main: 182550528 16:14:35 INFO - PROCESS | 9870 | 16:15:25 INFO - PROCESS | 9870 | 1476486925215 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] 16:17:36 INFO - PROCESS | 9870 | Cycle 1(1): loaded http://localhost:39593/tests/dromaeo/cssquery-dojo.html (next: http://localhost:39593/tests/dromaeo/cssquery-ext.html) 16:17:37 INFO - PROCESS | 9870 | RSS: Main: 196333568 16:17:37 INFO - PROCESS | 9870 | 16:20:39 INFO - PROCESS | 9870 | Cycle 1(1): loaded http://localhost:39593/tests/dromaeo/cssquery-ext.html (next: http://localhost:39593/tests/dromaeo/cssquery-jquery.html) 16:20:40 INFO - PROCESS | 9870 | RSS: Main: 194887680 16:20:40 INFO - PROCESS | 9870 | 16:23:42 INFO - PROCESS | 9870 | Cycle 1(1): loaded http://localhost:39593/tests/dromaeo/cssquery-jquery.html (next: http://localhost:39593/tests/dromaeo/cssquery-mootools.html) 16:23:43 INFO - PROCESS | 9870 | RSS: Main: 196411392 16:23:43 INFO - PROCESS | 9870 | 16:26:45 INFO - PROCESS | 9870 | Cycle 1(1): loaded http://localhost:39593/tests/dromaeo/cssquery-mootools.html (next: http://localhost:39593/tests/dromaeo/cssquery-prototype.html) 16:26:45 INFO - PROCESS | 9870 | RSS: Main: 192823296 16:26:45 INFO - PROCESS | 9870 | 16:29:48 INFO - PROCESS | 9870 | Cycle 1(1): loaded http://localhost:39593/tests/dromaeo/cssquery-prototype.html (next: http://localhost:39593/tests/dromaeo/cssquery-yui.html) 16:29:48 INFO - PROCESS | 9870 | RSS: Main: 196222976 16:29:48 INFO - PROCESS | 9870 | 16:32:51 INFO - PROCESS | 9870 | Cycle 1(1): loaded http://localhost:39593/tests/dromaeo/cssquery-yui.html (next: http://localhost:39593/tests/dromaeo/cssquery-dojo.html) 16:32:52 INFO - PROCESS | 9870 | RSS: Main: 196370432 16:32:52 INFO - PROCESS | 9870 | 16:32:52 INFO - PROCESS | 9870 | __start_tp_report 16:32:52 INFO - PROCESS | 9870 | _x_x_mozilla_page_load 16:32:52 INFO - PROCESS | 9870 | _x_x_mozilla_page_load_details 16:32:52 INFO - PROCESS | 9870 | |i|pagename|runs| 16:32:52 INFO - PROCESS | 9870 | |0;dojo.html;3030.2424393901524;3052.969470305297;3086.1667349815552;3086.783925125242;3091.103579961811;5293.206019097137;5359.035373632744;5419.972900135504;5428.592855535836;5516.668999860011;5337.359516857973;5382.165764306529;5388.084025715628;5424.593155513333;5453.672779633225;4907.6564640475;4928.4825093365125;4978.601711863061;5003.924941125886;5019.397672279331;4930.285108659242;4991.7504124793795;5043.697378157304;5043.9912017596625;5085.74571271435;4790.640701947368;4976.154053810861;4989.226669866159;5063.316452278932;5064.189729643258;4790.952090479121;4816.555033489974;4824.324594556765;4826.1795494765975;4902.509749025105;4786.0667169901535;4793.520647935214;4802.735849528274;4815.759212039384;4844.5155484451625;5252.894942101137;5301.681899086028;5303.549198318109;5311.707856067915;5321.042212401766;5524.58565607577;5583.106702927553;5718.513926316268;5778.508826749731;5780.294813030124;5859.091840764689;5863.149843272744;5863.355030946593;5874.412558744091;5916.7337469813965;5398.082326004549;5423.322084739408;5424.864378390572;5463.644863083887;5473.151661492475;5646.520045796154;5688.317401911797;5846.532277417797;5866.823995280149;5902.3507414184405;5655.1517272409465;5667.1499275108235;5691.800786972436;5710.086386178192;5725.2843394575675;5663.093904975184;5680.14797780328;5719.971400143056;5726.828195154152;5751.5398768099285;5587.078132108238;5683.8010669626365;5730.656160630376;5762.94237057624;5771.192033115367;5749.9937510935415;5756.740946657411;5759.164921086419;5761.423857614205;5771.913421298684;4468.262736648417;4468.888277793016;4470.552944705503;4475.216837053503;4515.616172625298;3939.369700847908;3945.822437990297;3946.250212459681;3956.9604303956594;4026.7785271809744;5440.619156658996;5450.400455949843;5460.535854452337;5501.532369748536;5547.611667183339;5840.3575606683235;5841.328247251536;5846.093855452412;5851.414858514199;5855.531557475391;5332;5386.218998245311;5405.891882162335;5449.618526703092;5509.173623956439;4872.1717308057005;4875.488073752205;4881.438634557;4907.312976183266;4930.309756634074;5974.880502389928;5990.371011043865;6025.9096113558335;6028.5177185825905;6029.758809647653;5595.160725891149;5625.971870140623;5750.274917524809;5777;5837.6497410155525;5965.701714914324;6030.879382412415;6056.9091463628965;6101.60339577926;6107.69461526913;5666.716664166693;5679.5172410345585;5700.315962084576;5719.142128680564;5739.770409183753;5677.489025987681;5737.827865164052;5779.711014449176;5873.442023007808;5873.559483038704;5634.943650563606;5636.070048441961;5665.603407761417;5689.7439615218245;5754.827355179351;5640.5769567281795;5641.069223578228;5666.660000399989;5668.433156684298;5676.035074037341;5324.361076670824;5442.12925931849;5494.945050549443;5648.4633959773755;5654.773809047757;5659.26429564154;5664.122061080539;5694.857628559319;5730.914036289376;5733.082706766897;5494.148406996922;5525.475079867406;5527.917081243704;5559.11054231321;5578.386377498391 16:32:52 INFO - PROCESS | 9870 | |1;ext.html;557.0808166525234;587.556394921834;593.682379926739;602.2321540036451;626.7148447456408;40058.79970600147;43907.121857562866;43935.340969885474;44013.559864401344;44054.33918491225;43356.13287734243;43758.56241437585;43804;43821.34267985975;43824.56175438245;8684.869726954117;8929.642814287421;8932.151445612657;8948.910510894873;8981;8725.912740872573;8735.1701588349;8791.428557143798;8811.471311721318;8834.955825220897;8767.342449316295;8835.204831565157;8846.823063538724;8857.025727170007;8876.423032502867;8784.209421152094;8796.120387961217;8800.339974501905;8803.207711306013;8804.075572064905;8695.347848911357;8729.170728780755;8745.47527148373;8745.606447709868;8764.8685269721;40970.18059638791;41514.792426037675;41590.168196635896;41595.37606935899;41682.79158604187;3523.894283171509;3538.097785064818;3688.907777305562;4008.4146869109763;4157.812898419548;32281.51577726336;32300.192495187574;32406.837965810257;32641.183970400692;34063.14842128942;4281.700280980302;4294.947737804258;4351.608355248043;4478.350639157336;4494.595486406239;323056;325749;325970;326441;329331;56968.715156423954;57750.42249577535;57758;57844.71077644585;57851;60177.39822601806;60182;60249.397506024376;60358.698206508685;60464.395356045876;14900.552983410515;15081;15144.697106057818;15167.620809479631;15218.239088045553;10270.435126068138;10400.375977441377;10411.271211015157;10433.373997560171;10502.737431564272;14371.281435928162;15903.920480397524;16181.838181618034;16350.912271932017;16554.42059527911;5886.792452830188;5956.85107872298;5987.940120598738;6133.26400831903;6268.4671802897265;961.6345788600287;996.5366104761321;1058.6823952814125;1107.8781334053247;1142.5258517715056;32136.517952230733;32163.51754723681;32548.186295342333;32832.578464052756;33020.339593208;1104.1498046504146;1112.3437172068357;1128.0637071230858;1157.1032449851432;1159.7100724818795;16601.50195494137;16887.91556042212;17062.23219955105;17169.656606868044;17424.215910284067;499651;504255;506680;791065.759410445;792893;57507.424925751046;57771.71114144402;57829.42170578324;57869;58231.41768582345;1323.9404226809625;1350.628577141294;1370.9040367174402;1371.71879764648;1384.6676797568512;30104.548431773102;32795;34904.65095349014;35088.64911350956;37170;56247;57042;57102.428975709714;62639.06041409291;62777.68611156915;450060;456004;456016;456545;457626;43646;45425.772871135436;45804.77097614491;45871.28445595326;47805.28292075552;48816.511834881196;49329;50001;50167;50287.49712502828;41854.79072604617;43521.56478435175;43842.12315753731;44315.33526997033;44553;43009;43180.352294714976;43716.781416092716;43764.34353484637;44063.11873762571;42151;42598.57401425946;43763.12473750571;43834;44020.55979440165;37660.91577637094;39012.2197556053;39122.804385977885;39168.19511227901;39198.804005979786;28910.566341505313;29271.853640732512;29348.853255733586;29459.852700737218;29702.40595188041 16:32:52 INFO - PROCESS | 9870 | |2;jquery.html;389.16135727507225;389.5987133252749;392.2703770985967;404.55498951153737;411.11199808413835;19027.42917712469;19106.713399298987;19523.12145953432;19687.114079866424;19751.60496790065;18395.44813655589;18441.170147343368;18701.625967480642;18752.62494750104;18904.62190756184;5592.664440133605;5628.549716022729;5729.05470597353;5773.48038676519;5860;5673;5733.082706766918;5752.5110365618975;5753.482186603205;5761;5427.891442171154;5677.261955945722;5707.942920570783;5707.942920570804;5727.140928860684;5652.34997975234;5670.149477578355;5685.40303268155;5707.885842283131;5739.885202295952;4968.30443737877;5243.68537887728;5273.578113750891;5357.223202635596;5358.785648574052;21171.576568468543;21284.467888302763;21422.464438389008;21603.891980540153;21608.783912160834;2145.0990583954776;2247.9662805057937;2317.9420514487274;2395.7843794058617;2417.6131818909066;9781.657641982567;10144;10450.320729152656;10553.736156596147;14749.926250368679;1860.9720854187199;1944.1348599873063;1990.3033938121687;2003.4590660521724;2033.6847788592645;85317.57341213254;85793.57103214506;86290.56854715748;86559.13440865574;87827;10736.30214036085;10817.134629229642;10973.341599503896;11083.224174307721;11784;14419.85580144185;14835.332410041574;15082.095074295577;15170;15192.088474691554;6231.9688401557705;6403.679816009181;7052.224255331909;7721.266479684421;7896.052473703192;7343.853122937511;7377.40980721541;7572.280633339934;7637.6563054661565;7654.617269136521;4461.776911154429;4623.606993405599;4624.28323609841;4659.161350956861;4813.542713442217;1906.494778883597;1946.279876445696;1972.684370500713;1994.3717728915344;2006.2883665219229;893.4014210478995;975.7463059604412;991.8363470027365;1005.8792944846665;1008.324422636835;17158.742618860728;18714.625707485775;18982;19044.238230470626;19392.933388663758;939.3612343606277;956.6795123633522;968.8982656820932;976.5605477535138;1028.7273872423814;10078.899211007943;10504.317219380715;10656.254062215725;10687.198460115522;10838.729031774112;449282;452503;454560;455812;458100;83193;84453.57773211095;93759;95384.52307738418;97433;1016.9338992965434;1023.4013102335068;1060.151878497199;1074.6023971130576;1077.671310250381;16336;16404.75392869084;16960.491185263967;17211.397601083903;17529.737053943947;42435.363469548596;43205.351919721856;43457.13085738331;43506;43714.56285437232;51156.74421627868;57063.429365707474;57347.42652573421;57541.42458575361;59134.40865591461;5479.123340265538;6382.840428989312;7156.141263048467;8166.224208700164;8343.332533397435;10737.302075365076;12766.936165319114;12990.220586764824;13057.934710326768;13345.733085338434;11245.325280483197;11259.155563332619;11507.827382589436;11514;11705.239159454608;11252.099832013255;11342.60300889465;11368.147388945697;11436.94281528587;11478.598249061242;11205.887941120485;11275.379854108103;11525.942370288094;11856.52573897069;12193.329366884907;7455.291747283999;7664.501807382502;7724.1117271514495;7825.4130940178575;8125.553094579855;8284.130166332448;9584.233261339215;10256.743581410226;10537.841932371173;10643.148548116287 16:32:52 INFO - PROCESS | 9870 | |3;mootools.html;1520.6350475885783;1531.8238402583702;1678.2951160512591;1751.1331890714098;1757.2443849144863;8032.518048917054;8274.2966847818;8763.255123314519;9503.857442138373;9503.952480237598;8740.694075707352;9074.500902450363;9083.77290567736;9302.90697093029;9305.162535371815;2278.6809846621445;2306.4695120122383;2312.364099872532;2314.618088015475;2333.1717240379676;2297.574948634508;2321.628539433691;2373.750756170603;2374.513224788914;2376.4296568823443;2330.9650355244685;2365.562370961369;2366.1127077345996;2366.6095094309417;2371.8576885386847;2284.1434462076722;2304.827137964651;2317.478567322356;2320.6519022146645;2347.624380099176;2248.898799554008;2277.2826559633663;2279.4529312964933;2285.4172186092605;2287.348105789842;9294.814103717956;9321.114494123047;9345.906540934571;9348.766280842965;9355.532223388871;5440.183972404131;5533.142362933751;5564.026295398289;5593.077142271561;5607.495325420691;3328.683775041367;3345.2138747394342;3527.9118022049397;3529.8058606776617;3537.663921927413;1059.3190092083705;1064.8030114428855;1103.7902798468265;1110.566878917223;1114.1922106472744;12818.230906145662;12892.419841107172;12924.935375323157;12959.61121166357;12981.221126732426;4583.72497650142;4594.908101837945;4813.181759100961;4821.807127714922;4931.087748766489;10766.084882784895;10772.892271077346;10804.351738895692;10832.67501974942;10833.187510936554;5573.219749235111;5581.832545023656;5584.497395234448;5587.720613969285;5593.993081245333;4881.292212629149;5007.924881126786;5045.369328833895;5120.155174396257;5133.178691409356;3752.268307680031;3822.3310920588788;3862.613738626171;3953.8418463261723;3956.7823769692945;1129.9378534180698;1149.2242736153064;1153.6077733570626;1155.7688462307403;1177.1759768162322;819.9631016604147;853.8591132463198;928.962841486333;938.5870217104452;944.4805357053593;5907.9704601476715;6031.9396806032255;6082.75668973245;6322.209723784527;6390.041493775971;450.46169827056355;462.5420833375002;466.58007792985904;472.357593672605;1005.4319309590059;4009.2983727848095;4134.607212314825;4180.143070670505;4202.285611446062;4459.3979812724865;11271.38007409584;11689.415529223676;11740.823887641693;11745;11774.705632359088;11318.377489238172;11322.26405283654;11514.424278786028;11541.192116551929;11629.53481860716;8372.665093396317;8522.616482258314;8524.488530688302;8532.317414606816;8537.274331681752;6102.593751869099;6111.816645500642;6165.969170154121;6296.748130074746;6339.619622822645;10542.26204165701;10745.677629671123;10765;10822.621208257673;10850.782984340427;10703.464826758474;10737.731556711145;10785.298955567863;10832.620858269922;11008.229423940247;6921.134858142732;7234.421246300389;7456.2170972049325;7676.53940763556;7895.960520197362;8630.223279904838;8978.10218978097;8992.820143597222;9024.458532488072;9031.864522032307;7504.43716721259;7631.1987241341085;7828.217178282126;8182.509049457051;8238.83522329562;7707.113681926426;7818.374530037469;7856.332211762065;7910;7916.327112195528;7211.963940180265;7358.889616655862;7374;7374.151972523228;7384.889226661712;5119.897602048012;5231.8168864089575;5357.357117145812;5453.182022696468;5463.508284254436;5065.721385323843;5163.173892177234;5205.73971301441;5247.107991641354;5252.53131028416 16:32:52 INFO - PROCESS | 9870 | |4;prototype.html;304.83995902151366;308.07577268195416;318.0585467017627;318.6319800630273;321.30437602590393;5364.865878353043;5505.449455054492;5555.916661250085;5613.849160922012;5668.6315389499705;5234.6335756496965;5348.304720386354;5370.677759334442;5470.17947307904;5485.533729632986;4231.34414165804;4233.74597524148;4249;4259.403683484315;4261.3607958806115;4167.770507700236;4245.936310955338;4261.190373828978;4263.5523270056665;4280.143971205755;4224.260754367989;4231.767252801094;4240.194363071022;4241.809118589671;4247.5964783345535;4216.451861258048;4239.1945530349285;4252.192083504156;4255.787210639471;4255.957440425587;3622.1850083731215;3727.9748069280895;3731.8507259709577;3742.925141497182;3752.8123593820474;5295.205719142121;5306.62027872752;5326.147816349366;5359.177879520981;5361.3030306060355;4808.302796094582;4844.370231869834;4853.980664060551;4857.73282469464;4864.708117512961;5529.557635389159;5672.319321681383;5678.375378708339;5700.942990570083;5730.140478928152;4054.202600205878;4056.817443215062;4059.188162367538;4063.756174629532;4084.6323830855367;5962.555352305534;6033.577649564532;6042.244719410074;6042.546808989299;6048.213732214784;4075.2257071156387;4180.352045432963;4182.365109980693;4185.874423767292;4186.267403204488;4107.938380924288;4134.924919520886;4141.40555885986;4154.8423198369455;4157.210130075276;4766.4995175506765;4775.880602984953;4794.352762377104;4816.20532612115;4881.755912204376;5579.469950354791;5713.800016999468;5752.9424705753245;5788.479036886616;5795.275590551181;1400.1249219237977;1435.167602790379;1439.100387488505;1439.1149443092422;1439.1796675894848;887.9378443508892;907.804821963281;919.7194855568982;920.2591913509689;937.4328531238502;4875.24433712775;4876.561109500162;4878.829240976549;4903.53416425439;4980.683981948411;5207.557357624569;5215.852512447255;5224.712640804716;5263.105282098441;5264.842054738364;4650.790714417792;4860.829870954571;4895.33912921751;4897.902041959141;4906.533879281463;2775.34779326858;2778.4443111377805;2781.8748156333013;2804.8737806798335;2806.3975080867394;5348.91976620351;5352.705601191972;5461.290032295776;5470.863228419242;5501.5323697486165;5242.397124330674;5260.395054568697;5578.856334451428;6061.424164704346;6066.694656030769;6208.565400422018;6224.253089629183;6282.434580887742;6309.873802523924;6323.747050117944;5888.764449421975;5903.763849445974;6023.66869822164;6074.635521868702;6075.27096748393;5803.187553742395;5846.327672317738;5857.58996870215;5877.177195192762;5935.34711181761;6219.844503887439;6265.624062556261;6278.623282603058;6288.315205172176;6312.779052733133;3880.185161116084;3975.920481590294;4036.7174297798874;4059.8579049733116;4106.7125301228625;5930.318013428511;5956.970215148896;5993.160957466045;6001.059480854437;6033.637981721111;5555.861103472445;5887.411258874078;5901.734421950937;5908.852278693067;5909.720105341405;5782.971085144547;5783.421657834183;5794.391588883106;5797.333306669787;5848.771757930882;5739.512141468022;5771.307443106854;5786.42135786418;5844.912326315024;5850.853728656647;5546.334439867242;5739.799107031401;5789.710514474344;5814.680192589448;5823.242978412779;5665.235193249024;5719.828405147852;5771.422857714195;5781.8554536136935;5808.07070868659 16:32:52 INFO - PROCESS | 9870 | |5;yui.html;690.8272931767058;725.4124159430861;741.0514541387026;786.1391776005272;828.7306625346762;14781.334839932202;15622.76565851513;15644.296006679699;15647.061176329415;15702.685946281068;15359.84640153598;15419.845801541982;15479;15537;15547.611309717262;648.1541588227374;671.633959492078;774.8605251054807;803.1446509467398;805.3798575097171;821.3265122599471;822.0217940650637;824.2581676491146;826.1655727715021;827.2554700769325;850.5449584472309;856.7472595584318;859.1151114352227;864.775158458799;865.2040123086775;845.9450135741188;847.6397531049311;848.1052489623445;855.0124606079987;857.0829212742368;628.9025201093838;629.0155906007084;629.134939458245;629.512128100721;629.5184184099168;14835.109893406323;14931.70136597262;14933.25333733309;14944.850551494455;14955.102693838404;15401.460948866848;15850.207489625473;15889.523314300473;15912.124833134172;16031.118288494128;11917;12007.819882701766;12063.577774777841;12142.089343299287;12260.75478490434;3854.807259637035;3864.439656249828;3898.961010389888;3929.685625149981;3932.429797679349;79144;81126.59436702837;81564.59217703933;82829;83444;11145.609903653332;11334.149938754626;11356.091512678966;11389.202755807013;11619.302841829518;22863;23229;23282.417939551648;23301.7669823303;23303.417414564432;8327.583620818934;8384.455010424424;8716.346274029473;8822.426542274732;8832.735017949472;4413.911721765547;4683.648726345537;4690.742009189459;4824.638152138604;4846.660733748604;3444.9655503445147;3523.841427135785;3552.964470355315;3574.946375804365;3594.658507441789;557.8716895114065;605.6668832142304;609.7195290166574;671.7346648073983;723.3056265984609;642.2998931165052;658.6871236162784;664.3323459922747;675.7803713793037;783.2480818414272;9027.729168124966;9909.454979976026;9915.355501892354;9986.300958932805;10019.198464123;630.4893036640336;713.2279010792558;742.8217227865382;752.9962350188214;758.719273868661;4387.319965405367;4664.95335046652;4711.811527538928;4750.881227969328;4813.085513752446;73443.63278183575;101919;122613.38693306476;126630.36684816517;129586;106063.46968265109;108613.45693271483;109420;112328.43835780933;114030;60373.69813150906;60675;89708;91103;91176;7727.799871584984;8275.172482751677;8547.74356769298;8651.913480865363;8969.282457403522;48395.75802121108;48951.510484894694;49607.75196123996;49932.50067499424;50146;74235.8864617042;75615.62192189004;76110;76639;76643;11248.645370398013;11432.771344573228;11672.474738636613;11674.357910315015;11789;12702.87297127017;12754.553590624284;13001.739965200832;13203.471861125447;13630;11977.161598688008;11981.460834262654;12446.751064978469;12562.43469043877;12583.811242831182;12077.456514457046;12411.989339273667;12509.499620015098;12585.119041666996;12905.313571937062;11713.121515886512;12013.038956883604;12031.27812331263;12281.631551053482;12421.19262247951;9767.267454940766;9981.700548983543;10093.192544596268;10153.695389138338;10176.847347289648;9276.72169834906;9386.296027798078;9639.855402168832;9897.752556186153;10390.168786497214 16:32:52 INFO - PROCESS | 9870 | __end_tp_report 16:32:52 INFO - PROCESS | 9870 | __start_cc_report 16:32:52 INFO - PROCESS | 9870 | _x_x_mozilla_cycle_collect,317 16:32:52 INFO - PROCESS | 9870 | __end_cc_report 16:32:52 INFO - PROCESS | 9870 | __startTimestamp1476487972125__endTimestamp 16:32:52 INFO - PROCESS | 9870 | 16:32:52 INFO - PROCESS | 9870 | ------- Summary: start ------- 16:32:52 INFO - PROCESS | 9870 | Number of tests: 6 16:32:52 INFO - PROCESS | 9870 | 16:32:52 INFO - PROCESS | 9870 | [#0] dojo.html Cycles:165 Average:5358.99 Median:5559.11 stddev:612.51 (11.0%) stddev-sans-first:586.51 16:32:52 INFO - PROCESS | 9870 | Values: 3030.2 3053.0 3086.2 3086.8 3091.1 5293.2 5359.0 5420.0 5428.6 5516.7 5337.4 5382.2 5388.1 5424.6 5453.7 4907.7 4928.5 4978.6 5003.9 5019.4 4930.3 4991.8 5043.7 5044.0 5085.7 4790.6 4976.2 4989.2 5063.3 5064.2 4791.0 4816.6 4824.3 4826.2 4902.5 4786.1 4793.5 4802.7 4815.8 4844.5 5252.9 5301.7 5303.5 5311.7 5321.0 5524.6 5583.1 5718.5 5778.5 5780.3 5859.1 5863.1 5863.4 5874.4 5916.7 5398.1 5423.3 5424.9 5463.6 5473.2 5646.5 5688.3 5846.5 5866.8 5902.4 5655.2 5667.1 5691.8 5710.1 5725.3 5663.1 5680.1 5720.0 5726.8 5751.5 5587.1 5683.8 5730.7 5762.9 5771.2 5750.0 5756.7 5759.2 5761.4 5771.9 4468.3 4468.9 4470.6 4475.2 4515.6 3939.4 3945.8 3946.3 3957.0 4026.8 5440.6 5450.4 5460.5 5501.5 5547.6 5840.4 5841.3 5846.1 5851.4 5855.5 5332.0 5386.2 5405.9 5449.6 5509.2 4872.2 4875.5 4881.4 4907.3 4930.3 5974.9 5990.4 6025.9 6028.5 6029.8 5595.2 5626.0 5750.3 5777.0 5837.6 5965.7 6030.9 6056.9 6101.6 6107.7 5666.7 5679.5 5700.3 5719.1 5739.8 5677.5 5737.8 5779.7 5873.4 5873.6 5634.9 5636.1 5665.6 5689.7 5754.8 5640.6 5641.1 5666.7 5668.4 5676.0 5324.4 5442.1 5494.9 5648.5 5654.8 5659.3 5664.1 5694.9 5730.9 5733.1 5494.1 5525.5 5527.9 5559.1 5578.4 16:32:52 INFO - PROCESS | 9870 | 16:32:52 INFO - PROCESS | 9870 | [#1] ext.html Cycles:180 Average:63269.56 Median:43822.95 stddev:130434.95 (297.6%) stddev-sans-first:130715.87 16:32:52 INFO - PROCESS | 9870 | Values: 557.1 587.6 593.7 602.2 626.7 40058.8 43907.1 43935.3 44013.6 44054.3 43356.1 43758.6 43804.0 43821.3 43824.6 8684.9 8929.6 8932.2 8948.9 8981.0 8725.9 8735.2 8791.4 8811.5 8835.0 8767.3 8835.2 8846.8 8857.0 8876.4 8784.2 8796.1 8800.3 8803.2 8804.1 8695.3 8729.2 8745.5 8745.6 8764.9 40970.2 41514.8 41590.2 41595.4 41682.8 3523.9 3538.1 3688.9 4008.4 4157.8 32281.5 32300.2 32406.8 32641.2 34063.1 4281.7 4294.9 4351.6 4478.4 4494.6 323056.0 325749.0 325970.0 326441.0 329331.0 56968.7 57750.4 57758.0 57844.7 57851.0 60177.4 60182.0 60249.4 60358.7 60464.4 14900.6 15081.0 15144.7 15167.6 15218.2 10270.4 10400.4 10411.3 10433.4 10502.7 14371.3 15903.9 16181.8 16350.9 16554.4 5886.8 5956.9 5987.9 6133.3 6268.5 961.6 996.5 1058.7 1107.9 1142.5 32136.5 32163.5 32548.2 32832.6 33020.3 1104.1 1112.3 1128.1 1157.1 1159.7 16601.5 16887.9 17062.2 17169.7 17424.2 499651.0 504255.0 506680.0 791065.8 792893.0 57507.4 57771.7 57829.4 57869.0 58231.4 1323.9 1350.6 1370.9 1371.7 1384.7 30104.5 32795.0 34904.7 35088.6 37170.0 56247.0 57042.0 57102.4 62639.1 62777.7 450060.0 456004.0 456016.0 456545.0 457626.0 43646.0 45425.8 45804.8 45871.3 47805.3 48816.5 49329.0 50001.0 50167.0 50287.5 41854.8 43521.6 43842.1 44315.3 44553.0 43009.0 43180.4 43716.8 43764.3 44063.1 42151.0 42598.6 43763.1 43834.0 44020.6 37660.9 39012.2 39122.8 39168.2 39198.8 28910.6 29271.9 29348.9 29459.9 29702.4 16:32:52 INFO - PROCESS | 9870 | 16:32:52 INFO - PROCESS | 9870 | [#2] jquery.html Cycles:180 Average:27842.13 Median:389.38 stddev:75217.63 (19317.3%) stddev-sans-first:75400.39 16:32:52 INFO - PROCESS | 9870 | Values: 389.2 389.6 392.3 404.6 411.1 19027.4 19106.7 19523.1 19687.1 19751.6 18395.4 18441.2 18701.6 18752.6 18904.6 5592.7 5628.5 5729.1 5773.5 5860.0 5673.0 5733.1 5752.5 5753.5 5761.0 5427.9 5677.3 5707.9 5707.9 5727.1 5652.3 5670.1 5685.4 5707.9 5739.9 4968.3 5243.7 5273.6 5357.2 5358.8 21171.6 21284.5 21422.5 21603.9 21608.8 2145.1 2248.0 2317.9 2395.8 2417.6 9781.7 10144.0 10450.3 10553.7 14749.9 1861.0 1944.1 1990.3 2003.5 2033.7 85317.6 85793.6 86290.6 86559.1 87827.0 10736.3 10817.1 10973.3 11083.2 11784.0 14419.9 14835.3 15082.1 15170.0 15192.1 6232.0 6403.7 7052.2 7721.3 7896.1 7343.9 7377.4 7572.3 7637.7 7654.6 4461.8 4623.6 4624.3 4659.2 4813.5 1906.5 1946.3 1972.7 1994.4 2006.3 893.4 975.7 991.8 1005.9 1008.3 17158.7 18714.6 18982.0 19044.2 19392.9 939.4 956.7 968.9 976.6 1028.7 10078.9 10504.3 10656.3 10687.2 10838.7 449282.0 452503.0 454560.0 455812.0 458100.0 83193.0 84453.6 93759.0 95384.5 97433.0 1016.9 1023.4 1060.2 1074.6 1077.7 16336.0 16404.8 16960.5 17211.4 17529.7 42435.4 43205.4 43457.1 43506.0 43714.6 51156.7 57063.4 57347.4 57541.4 59134.4 5479.1 6382.8 7156.1 8166.2 8343.3 10737.3 12766.9 12990.2 13057.9 13345.7 11245.3 11259.2 11507.8 11514.0 11705.2 11252.1 11342.6 11368.1 11436.9 11478.6 11205.9 11275.4 11525.9 11856.5 12193.3 7455.3 7664.5 7724.1 7825.4 8125.6 8284.1 9584.2 10256.7 10537.8 10643.1 16:32:52 INFO - PROCESS | 9870 | 16:32:52 INFO - PROCESS | 9870 | [#3] mootools.html Cycles:180 Average:5995.31 Median:469.47 stddev:3511.75 (748.0%) stddev-sans-first:3505.51 16:32:52 INFO - PROCESS | 9870 | Values: 1520.6 1531.8 1678.3 1751.1 1757.2 8032.5 8274.3 8763.3 9503.9 9504.0 8740.7 9074.5 9083.8 9302.9 9305.2 2278.7 2306.5 2312.4 2314.6 2333.2 2297.6 2321.6 2373.8 2374.5 2376.4 2331.0 2365.6 2366.1 2366.6 2371.9 2284.1 2304.8 2317.5 2320.7 2347.6 2248.9 2277.3 2279.5 2285.4 2287.3 9294.8 9321.1 9345.9 9348.8 9355.5 5440.2 5533.1 5564.0 5593.1 5607.5 3328.7 3345.2 3527.9 3529.8 3537.7 1059.3 1064.8 1103.8 1110.6 1114.2 12818.2 12892.4 12924.9 12959.6 12981.2 4583.7 4594.9 4813.2 4821.8 4931.1 10766.1 10772.9 10804.4 10832.7 10833.2 5573.2 5581.8 5584.5 5587.7 5594.0 4881.3 5007.9 5045.4 5120.2 5133.2 3752.3 3822.3 3862.6 3953.8 3956.8 1129.9 1149.2 1153.6 1155.8 1177.2 820.0 853.9 929.0 938.6 944.5 5908.0 6031.9 6082.8 6322.2 6390.0 450.5 462.5 466.6 472.4 1005.4 4009.3 4134.6 4180.1 4202.3 4459.4 11271.4 11689.4 11740.8 11745.0 11774.7 11318.4 11322.3 11514.4 11541.2 11629.5 8372.7 8522.6 8524.5 8532.3 8537.3 6102.6 6111.8 6166.0 6296.7 6339.6 10542.3 10745.7 10765.0 10822.6 10850.8 10703.5 10737.7 10785.3 10832.6 11008.2 6921.1 7234.4 7456.2 7676.5 7896.0 8630.2 8978.1 8992.8 9024.5 9031.9 7504.4 7631.2 7828.2 8182.5 8238.8 7707.1 7818.4 7856.3 7910.0 7916.3 7212.0 7358.9 7374.0 7374.2 7384.9 5119.9 5231.8 5357.4 5453.2 5463.5 5065.7 5163.2 5205.7 5247.1 5252.5 16:32:52 INFO - PROCESS | 9870 | 16:32:52 INFO - PROCESS | 9870 | [#4] prototype.html Cycles:180 Average:4755.28 Median:5337.23 stddev:1437.05 (26.9%) stddev-sans-first:1401.72 16:32:52 INFO - PROCESS | 9870 | Values: 304.8 308.1 318.1 318.6 321.3 5364.9 5505.4 5555.9 5613.8 5668.6 5234.6 5348.3 5370.7 5470.2 5485.5 4231.3 4233.7 4249.0 4259.4 4261.4 4167.8 4245.9 4261.2 4263.6 4280.1 4224.3 4231.8 4240.2 4241.8 4247.6 4216.5 4239.2 4252.2 4255.8 4256.0 3622.2 3728.0 3731.9 3742.9 3752.8 5295.2 5306.6 5326.1 5359.2 5361.3 4808.3 4844.4 4854.0 4857.7 4864.7 5529.6 5672.3 5678.4 5700.9 5730.1 4054.2 4056.8 4059.2 4063.8 4084.6 5962.6 6033.6 6042.2 6042.5 6048.2 4075.2 4180.4 4182.4 4185.9 4186.3 4107.9 4134.9 4141.4 4154.8 4157.2 4766.5 4775.9 4794.4 4816.2 4881.8 5579.5 5713.8 5752.9 5788.5 5795.3 1400.1 1435.2 1439.1 1439.1 1439.2 887.9 907.8 919.7 920.3 937.4 4875.2 4876.6 4878.8 4903.5 4980.7 5207.6 5215.9 5224.7 5263.1 5264.8 4650.8 4860.8 4895.3 4897.9 4906.5 2775.3 2778.4 2781.9 2804.9 2806.4 5348.9 5352.7 5461.3 5470.9 5501.5 5242.4 5260.4 5578.9 6061.4 6066.7 6208.6 6224.3 6282.4 6309.9 6323.7 5888.8 5903.8 6023.7 6074.6 6075.3 5803.2 5846.3 5857.6 5877.2 5935.3 6219.8 6265.6 6278.6 6288.3 6312.8 3880.2 3975.9 4036.7 4059.9 4106.7 5930.3 5957.0 5993.2 6001.1 6033.6 5555.9 5887.4 5901.7 5908.9 5909.7 5783.0 5783.4 5794.4 5797.3 5848.8 5739.5 5771.3 5786.4 5844.9 5850.9 5546.3 5739.8 5789.7 5814.7 5823.2 5665.2 5719.8 5771.4 5781.9 5808.1 16:32:52 INFO - PROCESS | 9870 | 16:32:52 INFO - PROCESS | 9870 | [#5] yui.html Cycles:180 Average:20731.34 Median:4781.98 stddev:30671.23 (641.4%) stddev-sans-first:30720.36 16:32:52 INFO - PROCESS | 9870 | Values: 690.8 725.4 741.1 786.1 828.7 14781.3 15622.8 15644.3 15647.1 15702.7 15359.8 15419.8 15479.0 15537.0 15547.6 648.2 671.6 774.9 803.1 805.4 821.3 822.0 824.3 826.2 827.3 850.5 856.7 859.1 864.8 865.2 845.9 847.6 848.1 855.0 857.1 628.9 629.0 629.1 629.5 629.5 14835.1 14931.7 14933.3 14944.9 14955.1 15401.5 15850.2 15889.5 15912.1 16031.1 11917.0 12007.8 12063.6 12142.1 12260.8 3854.8 3864.4 3899.0 3929.7 3932.4 79144.0 81126.6 81564.6 82829.0 83444.0 11145.6 11334.1 11356.1 11389.2 11619.3 22863.0 23229.0 23282.4 23301.8 23303.4 8327.6 8384.5 8716.3 8822.4 8832.7 4413.9 4683.6 4690.7 4824.6 4846.7 3445.0 3523.8 3553.0 3574.9 3594.7 557.9 605.7 609.7 671.7 723.3 642.3 658.7 664.3 675.8 783.2 9027.7 9909.5 9915.4 9986.3 10019.2 630.5 713.2 742.8 753.0 758.7 4387.3 4665.0 4711.8 4750.9 4813.1 73443.6 101919.0 122613.4 126630.4 129586.0 106063.5 108613.5 109420.0 112328.4 114030.0 60373.7 60675.0 89708.0 91103.0 91176.0 7727.8 8275.2 8547.7 8651.9 8969.3 48395.8 48951.5 49607.8 49932.5 50146.0 74235.9 75615.6 76110.0 76639.0 76643.0 11248.6 11432.8 11672.5 11674.4 11789.0 12702.9 12754.6 13001.7 13203.5 13630.0 11977.2 11981.5 12446.8 12562.4 12583.8 12077.5 12412.0 12509.5 12585.1 12905.3 11713.1 12013.0 12031.3 12281.6 12421.2 9767.3 9981.7 10093.2 10153.7 10176.8 9276.7 9386.3 9639.9 9897.8 10390.2 16:32:52 INFO - PROCESS | 9870 | -------- Summary: end -------- 16:32:52 INFO - PROCESS | 9870 | 16:32:53 INFO - TEST-INFO | 9870: exit 0 16:32:53 INFO - TEST-OK | dromaeo_css | took 1115932ms 16:32:53 INFO - TEST-START | kraken 16:32:53 INFO - operating with platform_type : linux_ 16:32:53 INFO - Initialising browser for kraken test... 16:32:53 INFO - TEST-INFO | started process 10238 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHG8l94/profile http://localhost:39593/getInfo.html) 16:32:57 INFO - PROCESS | 10238 | __metrics Screen width/height:1600/1200 16:32:57 INFO - PROCESS | 10238 | colorDepth:24 16:32:57 INFO - PROCESS | 10238 | Browser inner width/height: 1024/697 16:32:57 INFO - PROCESS | 10238 | __metrics 16:32:58 ERROR - PROCESS | 10238 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3083: TypeError: this.tabs is undefined 16:32:59 INFO - TEST-INFO | 10238: exit 0 16:32:59 INFO - Browser initialized. 16:32:59 INFO - Running cycle 1/1 for kraken test... 16:32:59 INFO - TEST-INFO | started process 10359 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpHG8l94/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 16:33:11 INFO - PROCESS | 10359 | RSS: Main: 182456320 16:33:11 INFO - PROCESS | 10359 | 16:33:14 INFO - PROCESS | 10359 | Cycle 1(1): loaded http://localhost:39593/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:39593/tests/kraken/driver.html?testName=audio-beat-detection) 16:33:14 INFO - PROCESS | 10359 | RSS: Main: 196308992 16:33:14 INFO - PROCESS | 10359 | 16:33:17 INFO - PROCESS | 10359 | Cycle 1(1): loaded http://localhost:39593/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:39593/tests/kraken/driver.html?testName=audio-dft) 16:33:18 INFO - PROCESS | 10359 | RSS: Main: 194625536 16:33:18 INFO - PROCESS | 10359 | 16:33:21 INFO - PROCESS | 10359 | Cycle 1(1): loaded http://localhost:39593/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:39593/tests/kraken/driver.html?testName=audio-fft) 16:33:21 INFO - PROCESS | 10359 | RSS: Main: 190615552 16:33:21 INFO - PROCESS | 10359 | 16:33:23 INFO - PROCESS | 10359 | Cycle 1(1): loaded http://localhost:39593/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:39593/tests/kraken/driver.html?testName=audio-oscillator) 16:33:24 INFO - PROCESS | 10359 | RSS: Main: 191623168 16:33:24 INFO - PROCESS | 10359 | 16:33:26 INFO - PROCESS | 10359 | Cycle 1(1): loaded http://localhost:39593/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:39593/tests/kraken/driver.html?testName=imaging-gaussian-blur) 16:33:27 INFO - PROCESS | 10359 | RSS: Main: 191885312 16:33:27 INFO - PROCESS | 10359 | 16:33:30 INFO - PROCESS | 10359 | Cycle 1(1): loaded http://localhost:39593/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:39593/tests/kraken/driver.html?testName=imaging-darkroom) 16:33:30 INFO - PROCESS | 10359 | RSS: Main: 192385024 16:33:30 INFO - PROCESS | 10359 | 16:33:34 INFO - PROCESS | 10359 | Cycle 1(1): loaded http://localhost:39593/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:39593/tests/kraken/driver.html?testName=imaging-desaturate) 16:33:35 INFO - PROCESS | 10359 | RSS: Main: 190754816 16:33:35 INFO - PROCESS | 10359 | 16:33:37 INFO - PROCESS | 10359 | Cycle 1(1): loaded http://localhost:39593/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:39593/tests/kraken/driver.html?testName=json-parse-financial) 16:33:38 INFO - PROCESS | 10359 | RSS: Main: 191381504 16:33:38 INFO - PROCESS | 10359 | 16:33:39 INFO - PROCESS | 10359 | Cycle 1(1): loaded http://localhost:39593/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:39593/tests/kraken/driver.html?testName=json-stringify-tinderbox) 16:33:40 INFO - PROCESS | 10359 | RSS: Main: 191897600 16:33:40 INFO - PROCESS | 10359 | 16:33:42 INFO - PROCESS | 10359 | Cycle 1(1): loaded http://localhost:39593/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:39593/tests/kraken/driver.html?testName=stanford-crypto-aes) 16:33:43 INFO - PROCESS | 10359 | RSS: Main: 191688704 16:33:43 INFO - PROCESS | 10359 | 16:33:45 INFO - PROCESS | 10359 | Cycle 1(1): loaded http://localhost:39593/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:39593/tests/kraken/driver.html?testName=stanford-crypto-ccm) 16:33:45 INFO - PROCESS | 10359 | RSS: Main: 191631360 16:33:45 INFO - PROCESS | 10359 | 16:33:48 INFO - PROCESS | 10359 | Cycle 1(1): loaded http://localhost:39593/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:39593/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 16:33:49 INFO - PROCESS | 10359 | RSS: Main: 191688704 16:33:49 INFO - PROCESS | 10359 | 16:33:52 INFO - PROCESS | 10359 | Cycle 1(1): loaded http://localhost:39593/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:39593/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 16:33:52 INFO - PROCESS | 10359 | RSS: Main: 191930368 16:33:52 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | Cycle 1(1): loaded http://localhost:39593/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:39593/tests/kraken/driver.html?testName=ai-astar) 16:33:54 INFO - PROCESS | 10359 | RSS: Main: 193495040 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | __start_tp_report 16:33:54 INFO - PROCESS | 10359 | _x_x_mozilla_page_load 16:33:54 INFO - PROCESS | 10359 | _x_x_mozilla_page_load_details 16:33:54 INFO - PROCESS | 10359 | |i|pagename|runs| 16:33:54 INFO - PROCESS | 10359 | |0;ai-astar;105;112;112;113;111;112;111;112;113;112 16:33:54 INFO - PROCESS | 10359 | |1;audio-beat-detection;165;125;125;179;127;127;127;130;160;124 16:33:54 INFO - PROCESS | 10359 | |2;audio-dft;162;167;168;167;165;165;161;166;164;161 16:33:54 INFO - PROCESS | 10359 | |3;audio-fft;76;76;77;121;77;76;75;75;98;77 16:33:54 INFO - PROCESS | 10359 | |4;audio-oscillator;83;83;110;83;83;83;100;83;83;114 16:33:54 INFO - PROCESS | 10359 | |5;imaging-gaussian-blur;118;118;117;117;117;118;118;118;118;118 16:33:54 INFO - PROCESS | 10359 | |6;imaging-darkroom;146;147;148;147;146;148;147;147;147;148 16:33:54 INFO - PROCESS | 10359 | |7;imaging-desaturate;86;85;86;86;86;85;85;85;85;85 16:33:54 INFO - PROCESS | 10359 | |8;json-parse-financial;52;53;53;55;55;53;54;60;52;55 16:33:54 INFO - PROCESS | 10359 | |9;json-stringify-tinderbox;60;60;59;59;61;59;59;59;59;61 16:33:54 INFO - PROCESS | 10359 | |10;stanford-crypto-aes;87;81;82;80;81;82;83;82;81;79 16:33:54 INFO - PROCESS | 10359 | |11;stanford-crypto-ccm;148;133;130;130;140;137;136;130;176;142 16:33:54 INFO - PROCESS | 10359 | |12;stanford-crypto-pbkdf2;167;170;170;168;172;165;169;163;165;172 16:33:54 INFO - PROCESS | 10359 | |13;stanford-crypto-sha256-iterative;68;70;66;66;70;69;64;65;64;70 16:33:54 INFO - PROCESS | 10359 | __end_tp_report 16:33:54 INFO - PROCESS | 10359 | __start_cc_report 16:33:54 INFO - PROCESS | 10359 | _x_x_mozilla_cycle_collect,787 16:33:54 INFO - PROCESS | 10359 | __end_cc_report 16:33:54 INFO - PROCESS | 10359 | __startTimestamp1476488034694__endTimestamp 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | ------- Summary: start ------- 16:33:54 INFO - PROCESS | 10359 | Number of tests: 14 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [#0] ai-astar Cycles:10 Average:111.30 Median:112.00 stddev:2.31 (2.1%) stddev-sans-first:0.71 16:33:54 INFO - PROCESS | 10359 | Values: 105.0 112.0 112.0 113.0 111.0 112.0 111.0 112.0 113.0 112.0 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [#1] audio-beat-detection Cycles:10 Average:138.90 Median:128.50 stddev:20.67 (16.1%) stddev-sans-first:19.65 16:33:54 INFO - PROCESS | 10359 | Values: 165.0 125.0 125.0 179.0 127.0 127.0 127.0 130.0 160.0 124.0 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [#2] audio-dft Cycles:10 Average:164.60 Median:165.50 stddev:2.55 (1.5%) stddev-sans-first:2.52 16:33:54 INFO - PROCESS | 10359 | Values: 162.0 167.0 168.0 167.0 165.0 165.0 161.0 166.0 164.0 161.0 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [#3] audio-fft Cycles:10 Average:82.80 Median:76.50 stddev:15.10 (19.7%) stddev-sans-first:15.81 16:33:54 INFO - PROCESS | 10359 | Values: 76.0 76.0 77.0 121.0 77.0 76.0 75.0 75.0 98.0 77.0 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [#4] audio-oscillator Cycles:10 Average:90.50 Median:83.00 stddev:12.55 (15.1%) stddev-sans-first:13.01 16:33:54 INFO - PROCESS | 10359 | Values: 83.0 83.0 110.0 83.0 83.0 83.0 100.0 83.0 83.0 114.0 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [#5] imaging-gaussian-blur Cycles:10 Average:117.70 Median:118.00 stddev:0.48 (0.4%) stddev-sans-first:0.50 16:33:54 INFO - PROCESS | 10359 | Values: 118.0 118.0 117.0 117.0 117.0 118.0 118.0 118.0 118.0 118.0 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [#6] imaging-darkroom Cycles:10 Average:147.10 Median:147.00 stddev:0.74 (0.5%) stddev-sans-first:0.67 16:33:54 INFO - PROCESS | 10359 | Values: 146.0 147.0 148.0 147.0 146.0 148.0 147.0 147.0 147.0 148.0 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [#7] imaging-desaturate Cycles:10 Average:85.40 Median:85.50 stddev:0.52 (0.6%) stddev-sans-first:0.50 16:33:54 INFO - PROCESS | 10359 | Values: 86.0 85.0 86.0 86.0 86.0 85.0 85.0 85.0 85.0 85.0 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [#8] json-parse-financial Cycles:10 Average:54.20 Median:54.50 stddev:2.35 (4.3%) stddev-sans-first:2.35 16:33:54 INFO - PROCESS | 10359 | Values: 52.0 53.0 53.0 55.0 55.0 53.0 54.0 60.0 52.0 55.0 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [#9] json-stringify-tinderbox Cycles:10 Average:59.60 Median:59.50 stddev:0.84 (1.4%) stddev-sans-first:0.88 16:33:54 INFO - PROCESS | 10359 | Values: 60.0 60.0 59.0 59.0 61.0 59.0 59.0 59.0 59.0 61.0 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [#10] stanford-crypto-aes Cycles:10 Average:81.80 Median:82.00 stddev:2.15 (2.6%) stddev-sans-first:1.20 16:33:54 INFO - PROCESS | 10359 | Values: 87.0 81.0 82.0 80.0 81.0 82.0 83.0 82.0 81.0 79.0 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [#11] stanford-crypto-ccm Cycles:10 Average:140.20 Median:138.50 stddev:13.89 (10.0%) stddev-sans-first:14.45 16:33:54 INFO - PROCESS | 10359 | Values: 148.0 133.0 130.0 130.0 140.0 137.0 136.0 130.0 176.0 142.0 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:168.10 Median:169.50 stddev:3.07 (1.8%) stddev-sans-first:3.23 16:33:54 INFO - PROCESS | 10359 | Values: 167.0 170.0 170.0 168.0 172.0 165.0 169.0 163.0 165.0 172.0 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.20 Median:68.50 stddev:2.49 (3.6%) stddev-sans-first:2.62 16:33:54 INFO - PROCESS | 10359 | Values: 68.0 70.0 66.0 66.0 70.0 69.0 64.0 65.0 64.0 70.0 16:33:54 INFO - PROCESS | 10359 | -------- Summary: end -------- 16:33:54 INFO - PROCESS | 10359 | 16:33:54 INFO - PROCESS | 10359 | [Parent 10359] WARNING: pipe error (77): Connection reset by peer: file /builds/slave/fx-team-l64-pgo-00000000000000/build/src/ipc/chromium/src/chrome/common/ipc_channel_posix.cc, line 322 16:33:55 INFO - TEST-INFO | 10359: exit 0 16:33:55 INFO - TEST-OK | kraken | took 62660ms 16:33:55 INFO - SUITE-END | took 1178s 16:33:56 INFO - Completed test suite (00:19:39) 16:33:56 INFO - javascript benchmark 16:33:56 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7246.678698717681, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3030.2424393901524, 3052.969470305297, 3086.1667349815552, 3086.783925125242, 3091.103579961811, 5293.206019097137, 5359.035373632744, 5419.972900135504, 5428.592855535836, 5516.668999860011, 5337.359516857973, 5382.165764306529, 5388.084025715628, 5424.593155513333, 5453.672779633225, 4907.6564640475, 4928.4825093365125, 4978.601711863061, 5003.924941125886, 5019.397672279331, 4930.285108659242, 4991.7504124793795, 5043.697378157304, 5043.9912017596625, 5085.74571271435, 4790.640701947368, 4976.154053810861, 4989.226669866159, 5063.316452278932, 5064.189729643258, 4790.952090479121, 4816.555033489974, 4824.324594556765, 4826.1795494765975, 4902.509749025105, 4786.0667169901535, 4793.520647935214, 4802.735849528274, 4815.759212039384, 4844.5155484451625, 5252.894942101137, 5301.681899086028, 5303.549198318109, 5311.707856067915, 5321.042212401766, 5524.58565607577, 5583.106702927553, 5718.513926316268, 5778.508826749731, 5780.294813030124, 5859.091840764689, 5863.149843272744, 5863.355030946593, 5874.412558744091, 5916.7337469813965, 5398.082326004549, 5423.322084739408, 5424.864378390572, 5463.644863083887, 5473.151661492475, 5646.520045796154, 5688.317401911797, 5846.532277417797, 5866.823995280149, 5902.3507414184405, 5655.1517272409465, 5667.1499275108235, 5691.800786972436, 5710.086386178192, 5725.2843394575675, 5663.093904975184, 5680.14797780328, 5719.971400143056, 5726.828195154152, 5751.5398768099285, 5587.078132108238, 5683.8010669626365, 5730.656160630376, 5762.94237057624, 5771.192033115367, 5749.9937510935415, 5756.740946657411, 5759.164921086419, 5761.423857614205, 5771.913421298684, 4468.262736648417, 4468.888277793016, 4470.552944705503, 4475.216837053503, 4515.616172625298, 3939.369700847908, 3945.822437990297, 3946.250212459681, 3956.9604303956594, 4026.7785271809744, 5440.619156658996, 5450.400455949843, 5460.535854452337, 5501.532369748536, 5547.611667183339, 5840.3575606683235, 5841.328247251536, 5846.093855452412, 5851.414858514199, 5855.531557475391, 5332.0, 5386.218998245311, 5405.891882162335, 5449.618526703092, 5509.173623956439, 4872.1717308057005, 4875.488073752205, 4881.438634557, 4907.312976183266, 4930.309756634074, 5974.880502389928, 5990.371011043865, 6025.9096113558335, 6028.5177185825905, 6029.758809647653, 5595.160725891149, 5625.971870140623, 5750.274917524809, 5777.0, 5837.6497410155525, 5965.701714914324, 6030.879382412415, 6056.9091463628965, 6101.60339577926, 6107.69461526913, 5666.716664166693, 5679.5172410345585, 5700.315962084576, 5719.142128680564, 5739.770409183753, 5677.489025987681, 5737.827865164052, 5779.711014449176, 5873.442023007808, 5873.559483038704, 5634.943650563606, 5636.070048441961, 5665.603407761417, 5689.7439615218245, 5754.827355179351, 5640.5769567281795, 5641.069223578228, 5666.660000399989, 5668.433156684298, 5676.035074037341, 5324.361076670824, 5442.12925931849, 5494.945050549443, 5648.4633959773755, 5654.773809047757, 5659.26429564154, 5664.122061080539, 5694.857628559319, 5730.914036289376, 5733.082706766897, 5494.148406996922, 5525.475079867406, 5527.917081243704, 5559.11054231321, 5578.386377498391], "value": 5317.1451351092, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [557.0808166525234, 587.556394921834, 593.682379926739, 602.2321540036451, 626.7148447456408, 40058.79970600147, 43907.121857562866, 43935.340969885474, 44013.559864401344, 44054.33918491225, 43356.13287734243, 43758.56241437585, 43804.0, 43821.34267985975, 43824.56175438245, 8684.869726954117, 8929.642814287421, 8932.151445612657, 8948.910510894873, 8981.0, 8725.912740872573, 8735.1701588349, 8791.428557143798, 8811.471311721318, 8834.955825220897, 8767.342449316295, 8835.204831565157, 8846.823063538724, 8857.025727170007, 8876.423032502867, 8784.209421152094, 8796.120387961217, 8800.339974501905, 8803.207711306013, 8804.075572064905, 8695.347848911357, 8729.170728780755, 8745.47527148373, 8745.606447709868, 8764.8685269721, 40970.18059638791, 41514.792426037675, 41590.168196635896, 41595.37606935899, 41682.79158604187, 3523.894283171509, 3538.097785064818, 3688.907777305562, 4008.4146869109763, 4157.812898419548, 32281.51577726336, 32300.192495187574, 32406.837965810257, 32641.183970400692, 34063.14842128942, 4281.700280980302, 4294.947737804258, 4351.608355248043, 4478.350639157336, 4494.595486406239, 323056.0, 325749.0, 325970.0, 326441.0, 329331.0, 56968.715156423954, 57750.42249577535, 57758.0, 57844.71077644585, 57851.0, 60177.39822601806, 60182.0, 60249.397506024376, 60358.698206508685, 60464.395356045876, 14900.552983410515, 15081.0, 15144.697106057818, 15167.620809479631, 15218.239088045553, 10270.435126068138, 10400.375977441377, 10411.271211015157, 10433.373997560171, 10502.737431564272, 14371.281435928162, 15903.920480397524, 16181.838181618034, 16350.912271932017, 16554.42059527911, 5886.792452830188, 5956.85107872298, 5987.940120598738, 6133.26400831903, 6268.4671802897265, 961.6345788600287, 996.5366104761321, 1058.6823952814125, 1107.8781334053247, 1142.5258517715056, 32136.517952230733, 32163.51754723681, 32548.186295342333, 32832.578464052756, 33020.339593208, 1104.1498046504146, 1112.3437172068357, 1128.0637071230858, 1157.1032449851432, 1159.7100724818795, 16601.50195494137, 16887.91556042212, 17062.23219955105, 17169.656606868044, 17424.215910284067, 499651.0, 504255.0, 506680.0, 791065.759410445, 792893.0, 57507.424925751046, 57771.71114144402, 57829.42170578324, 57869.0, 58231.41768582345, 1323.9404226809625, 1350.628577141294, 1370.9040367174402, 1371.71879764648, 1384.6676797568512, 30104.548431773102, 32795.0, 34904.65095349014, 35088.64911350956, 37170.0, 56247.0, 57042.0, 57102.428975709714, 62639.06041409291, 62777.68611156915, 450060.0, 456004.0, 456016.0, 456545.0, 457626.0, 43646.0, 45425.772871135436, 45804.77097614491, 45871.28445595326, 47805.28292075552, 48816.511834881196, 49329.0, 50001.0, 50167.0, 50287.49712502828, 41854.79072604617, 43521.56478435175, 43842.12315753731, 44315.33526997033, 44553.0, 43009.0, 43180.352294714976, 43716.781416092716, 43764.34353484637, 44063.11873762571, 42151.0, 42598.57401425946, 43763.12473750571, 43834.0, 44020.55979440165, 37660.91577637094, 39012.2197556053, 39122.804385977885, 39168.19511227901, 39198.804005979786, 28910.566341505313, 29271.853640732512, 29348.853255733586, 29459.852700737218, 29702.40595188041], "value": 20415.342272089838, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [389.16135727507225, 389.5987133252749, 392.2703770985967, 404.55498951153737, 411.11199808413835, 19027.42917712469, 19106.713399298987, 19523.12145953432, 19687.114079866424, 19751.60496790065, 18395.44813655589, 18441.170147343368, 18701.625967480642, 18752.62494750104, 18904.62190756184, 5592.664440133605, 5628.549716022729, 5729.05470597353, 5773.48038676519, 5860.0, 5673.0, 5733.082706766918, 5752.5110365618975, 5753.482186603205, 5761.0, 5427.891442171154, 5677.261955945722, 5707.942920570783, 5707.942920570804, 5727.140928860684, 5652.34997975234, 5670.149477578355, 5685.40303268155, 5707.885842283131, 5739.885202295952, 4968.30443737877, 5243.68537887728, 5273.578113750891, 5357.223202635596, 5358.785648574052, 21171.576568468543, 21284.467888302763, 21422.464438389008, 21603.891980540153, 21608.783912160834, 2145.0990583954776, 2247.9662805057937, 2317.9420514487274, 2395.7843794058617, 2417.6131818909066, 9781.657641982567, 10144.0, 10450.320729152656, 10553.736156596147, 14749.926250368679, 1860.9720854187199, 1944.1348599873063, 1990.3033938121687, 2003.4590660521724, 2033.6847788592645, 85317.57341213254, 85793.57103214506, 86290.56854715748, 86559.13440865574, 87827.0, 10736.30214036085, 10817.134629229642, 10973.341599503896, 11083.224174307721, 11784.0, 14419.85580144185, 14835.332410041574, 15082.095074295577, 15170.0, 15192.088474691554, 6231.9688401557705, 6403.679816009181, 7052.224255331909, 7721.266479684421, 7896.052473703192, 7343.853122937511, 7377.40980721541, 7572.280633339934, 7637.6563054661565, 7654.617269136521, 4461.776911154429, 4623.606993405599, 4624.28323609841, 4659.161350956861, 4813.542713442217, 1906.494778883597, 1946.279876445696, 1972.684370500713, 1994.3717728915344, 2006.2883665219229, 893.4014210478995, 975.7463059604412, 991.8363470027365, 1005.8792944846665, 1008.324422636835, 17158.742618860728, 18714.625707485775, 18982.0, 19044.238230470626, 19392.933388663758, 939.3612343606277, 956.6795123633522, 968.8982656820932, 976.5605477535138, 1028.7273872423814, 10078.899211007943, 10504.317219380715, 10656.254062215725, 10687.198460115522, 10838.729031774112, 449282.0, 452503.0, 454560.0, 455812.0, 458100.0, 83193.0, 84453.57773211095, 93759.0, 95384.52307738418, 97433.0, 1016.9338992965434, 1023.4013102335068, 1060.151878497199, 1074.6023971130576, 1077.671310250381, 16336.0, 16404.75392869084, 16960.491185263967, 17211.397601083903, 17529.737053943947, 42435.363469548596, 43205.351919721856, 43457.13085738331, 43506.0, 43714.56285437232, 51156.74421627868, 57063.429365707474, 57347.42652573421, 57541.42458575361, 59134.40865591461, 5479.123340265538, 6382.840428989312, 7156.141263048467, 8166.224208700164, 8343.332533397435, 10737.302075365076, 12766.936165319114, 12990.220586764824, 13057.934710326768, 13345.733085338434, 11245.325280483197, 11259.155563332619, 11507.827382589436, 11514.0, 11705.239159454608, 11252.099832013255, 11342.60300889465, 11368.147388945697, 11436.94281528587, 11478.598249061242, 11205.887941120485, 11275.379854108103, 11525.942370288094, 11856.52573897069, 12193.329366884907, 7455.291747283999, 7664.501807382502, 7724.1117271514495, 7825.4130940178575, 8125.553094579855, 8284.130166332448, 9584.233261339215, 10256.743581410226, 10537.841932371173, 10643.148548116287], "value": 8978.091603814277, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1520.6350475885783, 1531.8238402583702, 1678.2951160512591, 1751.1331890714098, 1757.2443849144863, 8032.518048917054, 8274.2966847818, 8763.255123314519, 9503.857442138373, 9503.952480237598, 8740.694075707352, 9074.500902450363, 9083.77290567736, 9302.90697093029, 9305.162535371815, 2278.6809846621445, 2306.4695120122383, 2312.364099872532, 2314.618088015475, 2333.1717240379676, 2297.574948634508, 2321.628539433691, 2373.750756170603, 2374.513224788914, 2376.4296568823443, 2330.9650355244685, 2365.562370961369, 2366.1127077345996, 2366.6095094309417, 2371.8576885386847, 2284.1434462076722, 2304.827137964651, 2317.478567322356, 2320.6519022146645, 2347.624380099176, 2248.898799554008, 2277.2826559633663, 2279.4529312964933, 2285.4172186092605, 2287.348105789842, 9294.814103717956, 9321.114494123047, 9345.906540934571, 9348.766280842965, 9355.532223388871, 5440.183972404131, 5533.142362933751, 5564.026295398289, 5593.077142271561, 5607.495325420691, 3328.683775041367, 3345.2138747394342, 3527.9118022049397, 3529.8058606776617, 3537.663921927413, 1059.3190092083705, 1064.8030114428855, 1103.7902798468265, 1110.566878917223, 1114.1922106472744, 12818.230906145662, 12892.419841107172, 12924.935375323157, 12959.61121166357, 12981.221126732426, 4583.72497650142, 4594.908101837945, 4813.181759100961, 4821.807127714922, 4931.087748766489, 10766.084882784895, 10772.892271077346, 10804.351738895692, 10832.67501974942, 10833.187510936554, 5573.219749235111, 5581.832545023656, 5584.497395234448, 5587.720613969285, 5593.993081245333, 4881.292212629149, 5007.924881126786, 5045.369328833895, 5120.155174396257, 5133.178691409356, 3752.268307680031, 3822.3310920588788, 3862.613738626171, 3953.8418463261723, 3956.7823769692945, 1129.9378534180698, 1149.2242736153064, 1153.6077733570626, 1155.7688462307403, 1177.1759768162322, 819.9631016604147, 853.8591132463198, 928.962841486333, 938.5870217104452, 944.4805357053593, 5907.9704601476715, 6031.9396806032255, 6082.75668973245, 6322.209723784527, 6390.041493775971, 450.46169827056355, 462.5420833375002, 466.58007792985904, 472.357593672605, 1005.4319309590059, 4009.2983727848095, 4134.607212314825, 4180.143070670505, 4202.285611446062, 4459.3979812724865, 11271.38007409584, 11689.415529223676, 11740.823887641693, 11745.0, 11774.705632359088, 11318.377489238172, 11322.26405283654, 11514.424278786028, 11541.192116551929, 11629.53481860716, 8372.665093396317, 8522.616482258314, 8524.488530688302, 8532.317414606816, 8537.274331681752, 6102.593751869099, 6111.816645500642, 6165.969170154121, 6296.748130074746, 6339.619622822645, 10542.26204165701, 10745.677629671123, 10765.0, 10822.621208257673, 10850.782984340427, 10703.464826758474, 10737.731556711145, 10785.298955567863, 10832.620858269922, 11008.229423940247, 6921.134858142732, 7234.421246300389, 7456.2170972049325, 7676.53940763556, 7895.960520197362, 8630.223279904838, 8978.10218978097, 8992.820143597222, 9024.458532488072, 9031.864522032307, 7504.43716721259, 7631.1987241341085, 7828.217178282126, 8182.509049457051, 8238.83522329562, 7707.113681926426, 7818.374530037469, 7856.332211762065, 7910.0, 7916.327112195528, 7211.963940180265, 7358.889616655862, 7374.0, 7374.151972523228, 7384.889226661712, 5119.897602048012, 5231.8168864089575, 5357.357117145812, 5453.182022696468, 5463.508284254436, 5065.721385323843, 5163.173892177234, 5205.73971301441, 5247.107991641354, 5252.53131028416], "value": 4676.118655818059, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [304.83995902151366, 308.07577268195416, 318.0585467017627, 318.6319800630273, 321.30437602590393, 5364.865878353043, 5505.449455054492, 5555.916661250085, 5613.849160922012, 5668.6315389499705, 5234.6335756496965, 5348.304720386354, 5370.677759334442, 5470.17947307904, 5485.533729632986, 4231.34414165804, 4233.74597524148, 4249.0, 4259.403683484315, 4261.3607958806115, 4167.770507700236, 4245.936310955338, 4261.190373828978, 4263.5523270056665, 4280.143971205755, 4224.260754367989, 4231.767252801094, 4240.194363071022, 4241.809118589671, 4247.5964783345535, 4216.451861258048, 4239.1945530349285, 4252.192083504156, 4255.787210639471, 4255.957440425587, 3622.1850083731215, 3727.9748069280895, 3731.8507259709577, 3742.925141497182, 3752.8123593820474, 5295.205719142121, 5306.62027872752, 5326.147816349366, 5359.177879520981, 5361.3030306060355, 4808.302796094582, 4844.370231869834, 4853.980664060551, 4857.73282469464, 4864.708117512961, 5529.557635389159, 5672.319321681383, 5678.375378708339, 5700.942990570083, 5730.140478928152, 4054.202600205878, 4056.817443215062, 4059.188162367538, 4063.756174629532, 4084.6323830855367, 5962.555352305534, 6033.577649564532, 6042.244719410074, 6042.546808989299, 6048.213732214784, 4075.2257071156387, 4180.352045432963, 4182.365109980693, 4185.874423767292, 4186.267403204488, 4107.938380924288, 4134.924919520886, 4141.40555885986, 4154.8423198369455, 4157.210130075276, 4766.4995175506765, 4775.880602984953, 4794.352762377104, 4816.20532612115, 4881.755912204376, 5579.469950354791, 5713.800016999468, 5752.9424705753245, 5788.479036886616, 5795.275590551181, 1400.1249219237977, 1435.167602790379, 1439.100387488505, 1439.1149443092422, 1439.1796675894848, 887.9378443508892, 907.804821963281, 919.7194855568982, 920.2591913509689, 937.4328531238502, 4875.24433712775, 4876.561109500162, 4878.829240976549, 4903.53416425439, 4980.683981948411, 5207.557357624569, 5215.852512447255, 5224.712640804716, 5263.105282098441, 5264.842054738364, 4650.790714417792, 4860.829870954571, 4895.33912921751, 4897.902041959141, 4906.533879281463, 2775.34779326858, 2778.4443111377805, 2781.8748156333013, 2804.8737806798335, 2806.3975080867394, 5348.91976620351, 5352.705601191972, 5461.290032295776, 5470.863228419242, 5501.5323697486165, 5242.397124330674, 5260.395054568697, 5578.856334451428, 6061.424164704346, 6066.694656030769, 6208.565400422018, 6224.253089629183, 6282.434580887742, 6309.873802523924, 6323.747050117944, 5888.764449421975, 5903.763849445974, 6023.66869822164, 6074.635521868702, 6075.27096748393, 5803.187553742395, 5846.327672317738, 5857.58996870215, 5877.177195192762, 5935.34711181761, 6219.844503887439, 6265.624062556261, 6278.623282603058, 6288.315205172176, 6312.779052733133, 3880.185161116084, 3975.920481590294, 4036.7174297798874, 4059.8579049733116, 4106.7125301228625, 5930.318013428511, 5956.970215148896, 5993.160957466045, 6001.059480854437, 6033.637981721111, 5555.861103472445, 5887.411258874078, 5901.734421950937, 5908.852278693067, 5909.720105341405, 5782.971085144547, 5783.421657834183, 5794.391588883106, 5797.333306669787, 5848.771757930882, 5739.512141468022, 5771.307443106854, 5786.42135786418, 5844.912326315024, 5850.853728656647, 5546.334439867242, 5739.799107031401, 5789.710514474344, 5814.680192589448, 5823.242978412779, 5665.235193249024, 5719.828405147852, 5771.422857714195, 5781.8554536136935, 5808.07070868659], "value": 4287.351400664766, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [690.8272931767058, 725.4124159430861, 741.0514541387026, 786.1391776005272, 828.7306625346762, 14781.334839932202, 15622.76565851513, 15644.296006679699, 15647.061176329415, 15702.685946281068, 15359.84640153598, 15419.845801541982, 15479.0, 15537.0, 15547.611309717262, 648.1541588227374, 671.633959492078, 774.8605251054807, 803.1446509467398, 805.3798575097171, 821.3265122599471, 822.0217940650637, 824.2581676491146, 826.1655727715021, 827.2554700769325, 850.5449584472309, 856.7472595584318, 859.1151114352227, 864.775158458799, 865.2040123086775, 845.9450135741188, 847.6397531049311, 848.1052489623445, 855.0124606079987, 857.0829212742368, 628.9025201093838, 629.0155906007084, 629.134939458245, 629.512128100721, 629.5184184099168, 14835.109893406323, 14931.70136597262, 14933.25333733309, 14944.850551494455, 14955.102693838404, 15401.460948866848, 15850.207489625473, 15889.523314300473, 15912.124833134172, 16031.118288494128, 11917.0, 12007.819882701766, 12063.577774777841, 12142.089343299287, 12260.75478490434, 3854.807259637035, 3864.439656249828, 3898.961010389888, 3929.685625149981, 3932.429797679349, 79144.0, 81126.59436702837, 81564.59217703933, 82829.0, 83444.0, 11145.609903653332, 11334.149938754626, 11356.091512678966, 11389.202755807013, 11619.302841829518, 22863.0, 23229.0, 23282.417939551648, 23301.7669823303, 23303.417414564432, 8327.583620818934, 8384.455010424424, 8716.346274029473, 8822.426542274732, 8832.735017949472, 4413.911721765547, 4683.648726345537, 4690.742009189459, 4824.638152138604, 4846.660733748604, 3444.9655503445147, 3523.841427135785, 3552.964470355315, 3574.946375804365, 3594.658507441789, 557.8716895114065, 605.6668832142304, 609.7195290166574, 671.7346648073983, 723.3056265984609, 642.2998931165052, 658.6871236162784, 664.3323459922747, 675.7803713793037, 783.2480818414272, 9027.729168124966, 9909.454979976026, 9915.355501892354, 9986.300958932805, 10019.198464123, 630.4893036640336, 713.2279010792558, 742.8217227865382, 752.9962350188214, 758.719273868661, 4387.319965405367, 4664.95335046652, 4711.811527538928, 4750.881227969328, 4813.085513752446, 73443.63278183575, 101919.0, 122613.38693306476, 126630.36684816517, 129586.0, 106063.46968265109, 108613.45693271483, 109420.0, 112328.43835780933, 114030.0, 60373.69813150906, 60675.0, 89708.0, 91103.0, 91176.0, 7727.799871584984, 8275.172482751677, 8547.74356769298, 8651.913480865363, 8969.282457403522, 48395.75802121108, 48951.510484894694, 49607.75196123996, 49932.50067499424, 50146.0, 74235.8864617042, 75615.62192189004, 76110.0, 76639.0, 76643.0, 11248.645370398013, 11432.771344573228, 11672.474738636613, 11674.357910315015, 11789.0, 12702.87297127017, 12754.553590624284, 13001.739965200832, 13203.471861125447, 13630.0, 11977.161598688008, 11981.460834262654, 12446.751064978469, 12562.43469043877, 12583.811242831182, 12077.456514457046, 12411.989339273667, 12509.499620015098, 12585.119041666996, 12905.313571937062, 11713.121515886512, 12013.038956883604, 12031.27812331263, 12281.631551053482, 12421.19262247951, 9767.267454940766, 9981.700548983543, 10093.192544596268, 10153.695389138338, 10176.847347289648, 9276.72169834906, 9386.296027798078, 9639.855402168832, 9897.752556186153, 10390.168786497214], "value": 7411.3226247324465, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1509.3999999999999, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [105.0, 112.0, 112.0, 113.0, 111.0, 112.0, 111.0, 112.0, 113.0, 112.0], "value": 111.3, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [165.0, 125.0, 125.0, 179.0, 127.0, 127.0, 127.0, 130.0, 160.0, 124.0], "value": 138.9, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [162.0, 167.0, 168.0, 167.0, 165.0, 165.0, 161.0, 166.0, 164.0, 161.0], "value": 164.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [76.0, 76.0, 77.0, 121.0, 77.0, 76.0, 75.0, 75.0, 98.0, 77.0], "value": 82.8, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [83.0, 83.0, 110.0, 83.0, 83.0, 83.0, 100.0, 83.0, 83.0, 114.0], "value": 90.5, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 117.0, 117.0, 117.0, 118.0, 118.0, 118.0, 118.0, 118.0], "value": 117.7, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 147.0, 148.0, 147.0, 146.0, 148.0, 147.0, 147.0, 147.0, 148.0], "value": 147.1, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [86.0, 85.0, 86.0, 86.0, 86.0, 85.0, 85.0, 85.0, 85.0, 85.0], "value": 85.4, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [52.0, 53.0, 53.0, 55.0, 55.0, 53.0, 54.0, 60.0, 52.0, 55.0], "value": 54.2, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [60.0, 60.0, 59.0, 59.0, 61.0, 59.0, 59.0, 59.0, 59.0, 61.0], "value": 59.6, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [87.0, 81.0, 82.0, 80.0, 81.0, 82.0, 83.0, 82.0, 81.0, 79.0], "value": 81.8, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 133.0, 130.0, 130.0, 140.0, 137.0, 136.0, 130.0, 176.0, 142.0], "value": 140.2, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [167.0, 170.0, 170.0, 168.0, 172.0, 165.0, 169.0, 163.0, 165.0, 172.0], "value": 168.1, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [68.0, 70.0, 66.0, 66.0, 70.0, 69.0, 64.0, 65.0, 64.0, 70.0], "value": 67.2, "unit": "score"}]}]} 16:33:56 INFO - Return code: 0 16:33:56 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 16:33:56 ERROR - # TBPL SUCCESS # 16:33:56 INFO - Running post-action listener: _resource_record_post_action 16:33:56 INFO - [mozharness: 2016-10-14 23:33:56.494583Z] Finished run-tests step (success) 16:33:56 INFO - Running post-run listener: _resource_record_post_run 16:33:56 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 4096; Write bytes: 393748480; Read time: 8; Write time: 224940 16:33:56 INFO - TinderboxPrint: CPU usage
13.4% 16:33:56 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 16:33:56 INFO - TinderboxPrint: I/O write bytes / time
393,748,480 / 224,940 16:33:56 INFO - TinderboxPrint: CPU idle
8,256.4 (86.6%) 16:33:56 INFO - TinderboxPrint: CPU user
1,221.2 (12.8%) 16:33:56 INFO - TinderboxPrint: Swap in / out
0 / 0 16:33:56 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 103231488; Read time: 0; Write time: 67820 16:33:56 INFO - run-tests - Wall time: 1179s; CPU: 13.0%; Read bytes: 0; Write bytes: 289574912; Read time: 0; Write time: 157120 16:33:57 INFO - Running post-run listener: _upload_blobber_files 16:33:57 INFO - Blob upload gear active. 16:33:57 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 16:33:57 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 16:33:57 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', 'Fx-Team', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 16:33:57 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 Fx-Team -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 16:33:57 INFO - (blobuploader) - INFO - Open directory for files ... 16:33:57 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 16:33:57 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:33:57 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:33:58 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 16:33:58 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:33:58 INFO - (blobuploader) - INFO - Done attempting. 16:33:58 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 16:33:58 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:33:58 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:34:03 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 16:34:03 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:34:03 INFO - (blobuploader) - INFO - Done attempting. 16:34:03 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 16:34:03 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 16:34:03 INFO - (blobuploader) - INFO - Uploading, attempt #1. 16:34:04 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 16:34:04 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 16:34:04 INFO - (blobuploader) - INFO - Done attempting. 16:34:04 INFO - (blobuploader) - INFO - Iteration through files over. 16:34:04 INFO - Return code: 0 16:34:04 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 16:34:04 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 16:34:04 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ab6bc85af3c095a3f9acaecd4b0babe62d10ff8170d4bd1a3ec7dc344efe5be0fde76016a061f041b7c7e7db9931f833954670388622f2bafd886dc43f3bb516", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/bcb255d8921d8ea7b46ebe7d2fd3a6ccde4585247ec1e04cf802598c9d7485bc69d74fb9f49f765bbfb116000992616d8a7fd24bc615bac6f1069e1a96f58f70", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/339749237ab4d1fc0355d419acc79f2ab869dcdc4d43220e246ceeff54f08b23cef9fde3644d1b22b70a196b256ef26378e58fbf0cc97554e1b7cbcf2ca1beb3"} 16:34:04 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 16:34:04 INFO - Writing to file /builds/slave/test/properties/blobber_files 16:34:04 INFO - Contents: 16:34:04 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ab6bc85af3c095a3f9acaecd4b0babe62d10ff8170d4bd1a3ec7dc344efe5be0fde76016a061f041b7c7e7db9931f833954670388622f2bafd886dc43f3bb516", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/bcb255d8921d8ea7b46ebe7d2fd3a6ccde4585247ec1e04cf802598c9d7485bc69d74fb9f49f765bbfb116000992616d8a7fd24bc615bac6f1069e1a96f58f70", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/339749237ab4d1fc0355d419acc79f2ab869dcdc4d43220e246ceeff54f08b23cef9fde3644d1b22b70a196b256ef26378e58fbf0cc97554e1b7cbcf2ca1beb3"} 16:34:04 INFO - Running post-run listener: copy_logs_to_upload_dir 16:34:04 INFO - Copying logs to upload dir... 16:34:04 INFO - mkdir: /builds/slave/test/build/upload/logs 16:34:04 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1238.655728 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-10-14 16:34:04.583479) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-14 16:34:04.589131) ========= 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=6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ab6bc85af3c095a3f9acaecd4b0babe62d10ff8170d4bd1a3ec7dc344efe5be0fde76016a061f041b7c7e7db9931f833954670388622f2bafd886dc43f3bb516", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/bcb255d8921d8ea7b46ebe7d2fd3a6ccde4585247ec1e04cf802598c9d7485bc69d74fb9f49f765bbfb116000992616d8a7fd24bc615bac6f1069e1a96f58f70", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/339749237ab4d1fc0355d419acc79f2ab869dcdc4d43220e246ceeff54f08b23cef9fde3644d1b22b70a196b256ef26378e58fbf0cc97554e1b7cbcf2ca1beb3"} build_url:https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011427 build_url: 'https://archive.mozilla.org/pub/firefox/tinderbox-builds/fx-team-linux64-pgo/1476473404/firefox-52.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/ab6bc85af3c095a3f9acaecd4b0babe62d10ff8170d4bd1a3ec7dc344efe5be0fde76016a061f041b7c7e7db9931f833954670388622f2bafd886dc43f3bb516", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/bcb255d8921d8ea7b46ebe7d2fd3a6ccde4585247ec1e04cf802598c9d7485bc69d74fb9f49f765bbfb116000992616d8a7fd24bc615bac6f1069e1a96f58f70", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Fx-Team/sha512/339749237ab4d1fc0355d419acc79f2ab869dcdc4d43220e246ceeff54f08b23cef9fde3644d1b22b70a196b256ef26378e58fbf0cc97554e1b7cbcf2ca1beb3"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-14 16:34:04.615566) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 16:34:04.616008) ========= 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=6dbc10da6d83fee962c624be000001a8-1476486803.158704-1342268058 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004589 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-14 16:34:04.698815) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-14 16:34:04.699290) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-14 16:34:04.699730) ========= ========= Total master_lag: 0.36 =========