builder: mozilla-central_ubuntu64_hw_test-dromaeojs-e10s-pgo slave: talos-linux64-ix-065 starttime: 1475320498.63 results: success (0) buildid: 20161001013004 builduid: e54b6451ffa04428b8778668720cdeca revision: 87cd291d2db621da6b3eb1057027cc0725b6eb1d ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2016-10-01 04:14:58.630763) ========= master: http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2016-10-01 04:14:58.631337) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-01 04:14:58.631838) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2016-10-01 04:14:58.697046) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-01 04:14:58.697404) ========= 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=523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2016-10-01 04:14:58-- https://hg.mozilla.org/build/tools/raw-file/default/buildfarm/utils/archiver_client.py Resolving hg.mozilla.org (hg.mozilla.org)... 63.245.215.102, 63.245.215.25 Connecting to hg.mozilla.org (hg.mozilla.org)|63.245.215.102|:443... connected. HTTP request sent, awaiting response... 200 Script output follows Length: 12141 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 53.7K=0.2s 2016-10-01 04:14:59 (53.7 KB/s) - `archiver_client.py' saved [12141/12141] program finished with exit code 0 elapsedTime=0.390530 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-01 04:14:59.102966) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-01 04:14:59.103313) ========= 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=523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.017968 ========= master_lag: 0.04 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2016-10-01 04:14:59.161014) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-01 04:14:59.161396) ========= bash -c 'python archiver_client.py mozharness --repo mozilla-central --rev 87cd291d2db621da6b3eb1057027cc0725b6eb1d --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', u'python archiver_client.py mozharness --repo mozilla-central --rev 87cd291d2db621da6b3eb1057027cc0725b6eb1d --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=523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2016-10-01 04:14:59,454 truncating revision to first 12 chars 2016-10-01 04:14:59,454 Setting DEBUG logging. 2016-10-01 04:14:59,454 attempt 1/10 2016-10-01 04:14:59,454 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/mozilla-central/87cd291d2db6?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2016-10-01 04:14:59,761 unpacking tar archive at: mozilla-central-87cd291d2db6/testing/mozharness/ program finished with exit code 0 elapsedTime=0.625165 ========= master_lag: 0.02 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2016-10-01 04:14:59.805354) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-01 04:14:59.805677) ========= script_repo_revision: 87cd291d2db621da6b3eb1057027cc0725b6eb1d ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2016-10-01 04:14:59.806188) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-01 04:14:59.806515) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2016-10-01 04:14:59.817372) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-10-01 04:14:59.817761) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs-e10s', '--add-option', '--webServer,localhost', '--branch-name', 'Firefox', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Firefox'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 04:15:00 INFO - MultiFileLogger online at 20161001 04:15:00 in /builds/slave/test 04:15:00 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs-e10s --add-option --webServer,localhost --branch-name Firefox --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Firefox 04:15:00 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 04:15:00 INFO - {'append_to_log': False, 04:15:00 INFO - 'base_work_dir': '/builds/slave/test', 04:15:00 INFO - 'blob_upload_branch': 'Firefox', 04:15:00 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 04:15:00 INFO - 'branch': 'Firefox', 04:15:00 INFO - 'buildbot_json_path': 'buildprops.json', 04:15:00 INFO - 'config_files': ('talos/linux_config.py',), 04:15:00 INFO - 'default_actions': ('clobber', 04:15:00 INFO - 'read-buildbot-config', 04:15:00 INFO - 'download-and-extract', 04:15:00 INFO - 'populate-webroot', 04:15:00 INFO - 'create-virtualenv', 04:15:00 INFO - 'install', 04:15:00 INFO - 'run-tests'), 04:15:00 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 04:15:00 INFO - 'download_minidump_stackwalk': True, 04:15:00 INFO - 'download_symbols': 'ondemand', 04:15:00 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 04:15:00 INFO - 'tooltool.py': '/tools/tooltool.py', 04:15:00 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 04:15:00 INFO - '/tools/misc-python/virtualenv.py')}, 04:15:00 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 04:15:00 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 04:15:00 INFO - 'installer_path': 'installer.exe', 04:15:00 INFO - 'log_level': 'info', 04:15:00 INFO - 'log_name': 'talos', 04:15:00 INFO - 'log_to_console': True, 04:15:00 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 04:15:00 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 04:15:00 INFO - 'opt_config_files': (), 04:15:00 INFO - 'pip_index': False, 04:15:00 INFO - 'sps_profile': False, 04:15:00 INFO - 'sps_profile_interval': 0, 04:15:00 INFO - 'suite': 'dromaeojs-e10s', 04:15:00 INFO - 'system_bits': '32', 04:15:00 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 04:15:00 INFO - 'title': 'talos-linux64-ix-065', 04:15:00 INFO - 'tooltool_cache': '/builds/tooltool_cache', 04:15:00 INFO - 'use_talos_json': True, 04:15:00 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 04:15:00 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 04:15:00 INFO - 'work_dir': 'build'} 04:15:00 INFO - [mozharness: 2016-10-01 11:15:00.212314Z] Running clobber step. 04:15:00 INFO - Running pre-action listener: _resource_record_pre_action 04:15:00 INFO - Running main action method: clobber 04:15:00 INFO - rmtree: /builds/slave/test/build 04:15:00 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 04:15:00 INFO - Running post-action listener: _resource_record_post_action 04:15:00 INFO - [mozharness: 2016-10-01 11:15:00.666097Z] Finished clobber step (success) 04:15:00 INFO - [mozharness: 2016-10-01 11:15:00.666200Z] Running read-buildbot-config step. 04:15:00 INFO - Running pre-action listener: _resource_record_pre_action 04:15:00 INFO - Running main action method: read_buildbot_config 04:15:00 INFO - Using buildbot properties: 04:15:00 INFO - { 04:15:00 INFO - "project": "", 04:15:00 INFO - "product": "firefox", 04:15:00 INFO - "script_repo_revision": "production", 04:15:00 INFO - "builddir": "mozilla-central_ubuntu64_hw_test-dromaeojs-e10s", 04:15:00 INFO - "repository": "", 04:15:00 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-central pgo talos dromaeojs-e10s", 04:15:00 INFO - "buildid": "20161001013004", 04:15:00 INFO - "pgo_build": "True", 04:15:00 INFO - "basedir": "/builds/slave/test", 04:15:00 INFO - "buildnumber": 378, 04:15:00 INFO - "slavename": "talos-linux64-ix-065", 04:15:00 INFO - "master": "http://buildbot-master104.bb.releng.scl3.mozilla.com:8201/", 04:15:00 INFO - "platform": "ubuntu64_hw", 04:15:00 INFO - "scheduler": "tests-mozilla-central-linux64-pgo-talos", 04:15:00 INFO - "branch": "mozilla-central", 04:15:00 INFO - "repo_path": "mozilla-central", 04:15:00 INFO - "revision": "87cd291d2db621da6b3eb1057027cc0725b6eb1d", 04:15:00 INFO - "stage_platform": "linux64-pgo", 04:15:00 INFO - "builduid": "e54b6451ffa04428b8778668720cdeca", 04:15:00 INFO - "slavebuilddir": "test" 04:15:00 INFO - } 04:15:00 INFO - Found installer url https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2. 04:15:00 INFO - Running post-action listener: _resource_record_post_action 04:15:00 INFO - [mozharness: 2016-10-01 11:15:00.668654Z] Finished read-buildbot-config step (success) 04:15:00 INFO - [mozharness: 2016-10-01 11:15:00.668744Z] Running download-and-extract step. 04:15:00 INFO - Running pre-action listener: _resource_record_pre_action 04:15:00 INFO - Running main action method: download_and_extract 04:15:00 INFO - mkdir: /builds/slave/test/build/tests 04:15:00 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')]} 04:15:00 INFO - trying https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 04:15:00 INFO - Downloading https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 04:15:00 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json'}, attempt #1 04:15:01 INFO - Downloaded 1361 bytes. 04:15:01 INFO - Reading from file /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.test_packages.json 04:15:01 INFO - Using the following test package requirements: 04:15:01 INFO - {u'common': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 04:15:01 INFO - u'cppunittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:15:01 INFO - u'firefox-52.0a1.en-US.linux-x86_64.cppunittest.tests.zip'], 04:15:01 INFO - u'gtest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:15:01 INFO - u'firefox-52.0a1.en-US.linux-x86_64.gtest.tests.zip'], 04:15:01 INFO - u'jittest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:15:01 INFO - u'jsshell-linux-x86_64.zip'], 04:15:01 INFO - u'mochitest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:15:01 INFO - u'firefox-52.0a1.en-US.linux-x86_64.mochitest.tests.zip'], 04:15:01 INFO - u'mozbase': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'], 04:15:01 INFO - u'reftest': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:15:01 INFO - u'firefox-52.0a1.en-US.linux-x86_64.reftest.tests.zip'], 04:15:01 INFO - u'talos': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:15:01 INFO - u'firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'], 04:15:01 INFO - u'web-platform': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:15:01 INFO - u'firefox-52.0a1.en-US.linux-x86_64.web-platform.tests.zip'], 04:15:01 INFO - u'xpcshell': [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip', 04:15:01 INFO - u'firefox-52.0a1.en-US.linux-x86_64.xpcshell.tests.zip']} 04:15:01 INFO - Downloading packages: [u'firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'] for test suite category: common 04:15:01 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 04:15:01 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:15:01 INFO - Fetch https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 04:15:01 INFO - Http code: 200 04:15:01 INFO - via: 1.1 032d42677fbf05c24a4bb71369581429.cloudfront.net (CloudFront) 04:15:01 INFO - x-amz-cf-id: taKyFa3lLCuOPelR-YU6eXHhdrcr1LTGFAqABWw_VMk8Q5BhWaslpA== 04:15:01 INFO - x-amz-version-id: jw4eqE0G3vpacYQJYRuyOMAKEqqY_ycg 04:15:02 INFO - Expected file size: 21991284 04:15:02 INFO - Obtained file size: 21991284 04:15:06 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 04:15:06 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip 04:15:06 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip'}, attempt #1 04:15:06 INFO - Fetch https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.common.tests.zip into memory 04:15:06 INFO - Http code: 200 04:15:06 INFO - via: 1.1 455cf6ccbccc261c46d02110de1c0237.cloudfront.net (CloudFront) 04:15:06 INFO - x-amz-cf-id: bt2vxOUrSt8YinpYZl0RHMdFOWPThp4cSfNont477TC1BxDnIOlbHg== 04:15:06 INFO - x-amz-version-id: jw4eqE0G3vpacYQJYRuyOMAKEqqY_ycg 04:15:06 INFO - Expected file size: 21991284 04:15:06 INFO - Obtained file size: 21991284 04:15:11 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip 04:15:11 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip'}, attempt #1 04:15:11 INFO - Fetch https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.talos.tests.zip into memory 04:15:11 INFO - Http code: 200 04:15:11 INFO - via: 1.1 9baadab4e4d95afe7af7bcba342b29c6.cloudfront.net (CloudFront) 04:15:11 INFO - x-amz-cf-id: dkPJfwyI3hzc3AaznHo5lFjzCmSPmVoe2NSSjdaIiFiTRVa3JF9JIw== 04:15:11 INFO - x-amz-version-id: HWji34zZn2sMi4jMEtcjNK4eXtfud5Rq 04:15:12 INFO - Expected file size: 14408522 04:15:12 INFO - Obtained file size: 14408522 04:15:13 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:15:13 INFO - trying https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 04:15:13 INFO - Downloading https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 to /builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 04:15:13 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2', 'file_name': '/builds/slave/test/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2'}, attempt #1 04:15:14 INFO - Downloaded 59679836 bytes. 04:15:14 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 04:15:14 INFO - mkdir: /builds/slave/test/properties 04:15:14 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 04:15:14 INFO - Writing to file /builds/slave/test/properties/build_url 04:15:14 INFO - Contents: 04:15:14 INFO - build_url:https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 04:15:14 INFO - Running post-action listener: _resource_record_post_action 04:15:14 INFO - Running post-action listener: set_extra_try_arguments 04:15:14 INFO - [mozharness: 2016-10-01 11:15:14.825880Z] Finished download-and-extract step (success) 04:15:14 INFO - [mozharness: 2016-10-01 11:15:14.826109Z] Running populate-webroot step. 04:15:14 INFO - Running pre-action listener: _resource_record_pre_action 04:15:14 INFO - Running main action method: populate_webroot 04:15:14 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 04:15:14 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 04:15:14 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 04:15:14 INFO - '--tppagecycles', 04:15:14 INFO - '7'], 04:15:14 INFO - 'tests': ['tsvgm']}}, 04:15:14 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 04:15:14 INFO - 'tests': ['tresize', 'tcanvasmark']}, 04:15:14 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 04:15:14 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 04:15:14 INFO - 'tests': ['dromaeo_css', 'kraken']}, 04:15:14 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 04:15:14 INFO - 'g1': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:15:14 INFO - 'talos_options': ['--disable-e10s'], 04:15:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:15:14 INFO - 'g1-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:15:14 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 04:15:14 INFO - 'g2': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:15:14 INFO - 'talos_options': ['--disable-e10s'], 04:15:14 INFO - 'tests': ['damp', 'tps']}, 04:15:14 INFO - 'g2-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:15:14 INFO - 'tests': ['damp', 'tps']}, 04:15:14 INFO - 'g3': {'talos_options': ['--disable-e10s'], 04:15:14 INFO - 'tests': ['dromaeo_dom']}, 04:15:14 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 04:15:14 INFO - 'g4': {'talos_options': ['--disable-e10s'], 04:15:14 INFO - 'tests': ['basic_compositor_video']}, 04:15:14 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 04:15:14 INFO - 'other': {'talos_options': ['--disable-e10s'], 04:15:14 INFO - 'tests': ['a11yr', 04:15:14 INFO - 'ts_paint', 04:15:14 INFO - 'tpaint', 04:15:14 INFO - 'sessionrestore', 04:15:14 INFO - 'sessionrestore_no_auto_restore', 04:15:14 INFO - 'tabpaint']}, 04:15:14 INFO - 'other-e10s': {'tests': ['a11yr', 04:15:14 INFO - 'ts_paint', 04:15:14 INFO - 'tpaint', 04:15:14 INFO - 'sessionrestore', 04:15:14 INFO - 'sessionrestore_no_auto_restore', 04:15:14 INFO - 'tabpaint']}, 04:15:14 INFO - 'other-e10s_l64': {'tests': ['a11yr', 04:15:14 INFO - 'ts_paint', 04:15:14 INFO - 'tpaint', 04:15:14 INFO - 'sessionrestore', 04:15:14 INFO - 'sessionrestore_no_auto_restore', 04:15:14 INFO - 'tabpaint']}, 04:15:14 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 04:15:14 INFO - 'ts_paint', 04:15:14 INFO - 'tpaint', 04:15:14 INFO - 'sessionrestore', 04:15:14 INFO - 'sessionrestore_no_auto_restore', 04:15:14 INFO - 'tabpaint']}, 04:15:14 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 04:15:14 INFO - 'tests': ['a11yr', 04:15:14 INFO - 'ts_paint', 04:15:14 INFO - 'tpaint', 04:15:14 INFO - 'sessionrestore', 04:15:14 INFO - 'sessionrestore_no_auto_restore', 04:15:14 INFO - 'tabpaint']}, 04:15:14 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 04:15:14 INFO - 'tests': ['a11yr', 04:15:14 INFO - 'ts_paint', 04:15:14 INFO - 'tpaint', 04:15:14 INFO - 'sessionrestore', 04:15:14 INFO - 'sessionrestore_no_auto_restore', 04:15:14 INFO - 'tabpaint']}, 04:15:14 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 04:15:14 INFO - 'tests': ['tsvgx', 04:15:14 INFO - 'tsvgr_opacity', 04:15:14 INFO - 'tart', 04:15:14 INFO - 'tscrollx', 04:15:14 INFO - 'cart']}, 04:15:14 INFO - 'svgr-e10s': {'tests': ['tsvgx', 04:15:14 INFO - 'tsvgr_opacity', 04:15:14 INFO - 'tart', 04:15:14 INFO - 'tscrollx', 04:15:14 INFO - 'cart']}, 04:15:14 INFO - 'tp5o': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:15:14 INFO - 'talos_options': ['--disable-e10s'], 04:15:14 INFO - 'tests': ['tp5o']}, 04:15:14 INFO - 'tp5o-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:15:14 INFO - 'tests': ['tp5o']}, 04:15:14 INFO - 'xperf': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:15:14 INFO - 'talos_options': ['--disable-e10s', 04:15:14 INFO - '--xperf_path', 04:15:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:15:14 INFO - 'tests': ['tp5n']}, 04:15:14 INFO - 'xperf-e10s': {'pagesets_url': 'http://talos-bundles.pvt.build.mozilla.org/zips/tp5n.zip', 04:15:14 INFO - 'talos_options': ['--xperf_path', 04:15:14 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 04:15:14 INFO - 'tests': ['tp5n']}}, 04:15:14 INFO - 'talos.zip': {'path': '', 04:15:14 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 04:15:14 INFO - Running post-action listener: _resource_record_post_action 04:15:14 INFO - [mozharness: 2016-10-01 11:15:14.846523Z] Finished populate-webroot step (success) 04:15:14 INFO - [mozharness: 2016-10-01 11:15:14.846613Z] Running create-virtualenv step. 04:15:14 INFO - Running pre-action listener: _resource_record_pre_action 04:15:14 INFO - Running main action method: create_virtualenv 04:15:14 INFO - Creating virtualenv /builds/slave/test/build/venv 04:15:14 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 04:15:14 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 04:15:14 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 04:15:14 INFO - Using real prefix '/usr' 04:15:14 INFO - New python executable in /builds/slave/test/build/venv/bin/python 04:15:15 INFO - Installing distribute.............................................................................................................................................................................................done. 04:15:17 INFO - Installing pip.................done. 04:15:17 INFO - Return code: 0 04:15:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 04:15:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 04:15:17 INFO - Reading from file tmpfile_stdout 04:15:17 INFO - Output received: 04:15:17 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) 04:15:17 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 04:15: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')]} 04:15:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:15:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15: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')]} 04:15:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:15:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:17 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 0x7f35ef261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21e8790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21e5930>, '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 0x21e6830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21e6cc0>, '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': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', '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 04:15:17 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 04:15:17 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 04:15:17 INFO - Using env: {'DISPLAY': ':0', 04:15:17 INFO - 'HOME': '/home/cltbld', 04:15:17 INFO - 'LANG': 'en_US.UTF-8', 04:15:17 INFO - 'LANGUAGE': 'en_US:en', 04:15:17 INFO - 'LOGNAME': 'cltbld', 04:15:17 INFO - 'MAIL': '/var/mail/cltbld', 04:15:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:15:17 INFO - 'MOZ_NO_REMOTE': '1', 04:15:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:15:17 INFO - 'NO_EM_RESTART': '1', 04:15:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:15:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:15:17 INFO - 'PWD': '/builds/slave/test', 04:15:17 INFO - 'SHELL': '/bin/bash', 04:15:17 INFO - 'SHLVL': '1', 04:15:17 INFO - 'TERM': 'linux', 04:15:17 INFO - 'TMOUT': '86400', 04:15:17 INFO - 'USER': 'cltbld', 04:15:17 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', 04:15:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:15:17 INFO - '_': '/tools/buildbot/bin/python'} 04:15:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:15:17 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 04:15:17 INFO - Cleaning up... 04:15:17 INFO - Return code: 0 04:15:17 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 04:15: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')]} 04:15:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:15:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15: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')]} 04:15:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:15:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:17 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 0x7f35ef261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21e8790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21e5930>, '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 0x21e6830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21e6cc0>, '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': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', '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 04:15:17 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 04:15:17 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 04:15:17 INFO - Using env: {'DISPLAY': ':0', 04:15:17 INFO - 'HOME': '/home/cltbld', 04:15:17 INFO - 'LANG': 'en_US.UTF-8', 04:15:17 INFO - 'LANGUAGE': 'en_US:en', 04:15:17 INFO - 'LOGNAME': 'cltbld', 04:15:17 INFO - 'MAIL': '/var/mail/cltbld', 04:15:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:15:17 INFO - 'MOZ_NO_REMOTE': '1', 04:15:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:15:17 INFO - 'NO_EM_RESTART': '1', 04:15:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:15:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:15:17 INFO - 'PWD': '/builds/slave/test', 04:15:17 INFO - 'SHELL': '/bin/bash', 04:15:17 INFO - 'SHLVL': '1', 04:15:17 INFO - 'TERM': 'linux', 04:15:17 INFO - 'TMOUT': '86400', 04:15:17 INFO - 'USER': 'cltbld', 04:15:17 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', 04:15:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:15:17 INFO - '_': '/tools/buildbot/bin/python'} 04:15:18 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:15:18 INFO - Downloading/unpacking psutil>=3.1.1 04:15:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:15:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:15:18 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:15:18 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:15:18 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:15:18 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:15:20 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 04:15:20 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:15:20 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:15:20 INFO - Installing collected packages: psutil 04:15:20 INFO - Running setup.py install for psutil 04:15:20 INFO - building 'psutil._psutil_linux' extension 04:15:20 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 04:15:20 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 04:15:20 INFO - building 'psutil._psutil_posix' extension 04:15:20 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 04:15:20 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 04:15:20 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 04:15:20 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 04:15:20 INFO - Successfully installed psutil 04:15:20 INFO - Cleaning up... 04:15:20 INFO - Return code: 0 04:15:20 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 04:15:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:15:20 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:15:20 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:20 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:15:20 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:15:20 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:20 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 0x7f35ef261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21e8790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21e5930>, '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 0x21e6830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21e6cc0>, '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': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', '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 04:15:20 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 04:15:20 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 04:15:20 INFO - Using env: {'DISPLAY': ':0', 04:15:20 INFO - 'HOME': '/home/cltbld', 04:15:20 INFO - 'LANG': 'en_US.UTF-8', 04:15:20 INFO - 'LANGUAGE': 'en_US:en', 04:15:20 INFO - 'LOGNAME': 'cltbld', 04:15:20 INFO - 'MAIL': '/var/mail/cltbld', 04:15:20 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:15:20 INFO - 'MOZ_NO_REMOTE': '1', 04:15:20 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:15:20 INFO - 'NO_EM_RESTART': '1', 04:15:20 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:15:20 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:15:20 INFO - 'PWD': '/builds/slave/test', 04:15:20 INFO - 'SHELL': '/bin/bash', 04:15:20 INFO - 'SHLVL': '1', 04:15:20 INFO - 'TERM': 'linux', 04:15:20 INFO - 'TMOUT': '86400', 04:15:20 INFO - 'USER': 'cltbld', 04:15:20 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', 04:15:20 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:15:20 INFO - '_': '/tools/buildbot/bin/python'} 04:15:20 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:15:20 INFO - Downloading/unpacking mozsystemmonitor==0.3 04:15:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:15:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:15:20 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:15:20 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:15:20 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:15:20 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:15:22 INFO - Downloading mozsystemmonitor-0.3.tar.gz 04:15:22 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 04:15:22 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 04:15:22 INFO - Installing collected packages: mozsystemmonitor 04:15:22 INFO - Running setup.py install for mozsystemmonitor 04:15:22 INFO - Successfully installed mozsystemmonitor 04:15:22 INFO - Cleaning up... 04:15:22 INFO - Return code: 0 04:15:22 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 04:15:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:15:22 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:15:22 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:22 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:15:22 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:15:22 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:22 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 0x7f35ef261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21e8790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21e5930>, '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 0x21e6830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21e6cc0>, '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': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', '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 04:15:22 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 04:15:22 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 04:15:22 INFO - Using env: {'DISPLAY': ':0', 04:15:22 INFO - 'HOME': '/home/cltbld', 04:15:22 INFO - 'LANG': 'en_US.UTF-8', 04:15:22 INFO - 'LANGUAGE': 'en_US:en', 04:15:22 INFO - 'LOGNAME': 'cltbld', 04:15:22 INFO - 'MAIL': '/var/mail/cltbld', 04:15:22 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:15:22 INFO - 'MOZ_NO_REMOTE': '1', 04:15:22 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:15:22 INFO - 'NO_EM_RESTART': '1', 04:15:22 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:15:22 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:15:22 INFO - 'PWD': '/builds/slave/test', 04:15:22 INFO - 'SHELL': '/bin/bash', 04:15:22 INFO - 'SHLVL': '1', 04:15:22 INFO - 'TERM': 'linux', 04:15:22 INFO - 'TMOUT': '86400', 04:15:22 INFO - 'USER': 'cltbld', 04:15:22 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', 04:15:22 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:15:22 INFO - '_': '/tools/buildbot/bin/python'} 04:15:23 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:15:23 INFO - Downloading/unpacking jsonschema==2.5.1 04:15:23 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 04:15:23 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 04:15:23 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 04:15:23 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 04:15:23 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 04:15:23 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 04:15:25 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 04:15:25 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 04:15:25 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 04:15:25 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 04:15:25 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 04:15:25 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 04:15:25 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 04:15:25 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 04:15:25 INFO - Downloading functools32-3.2.3-2.tar.gz 04:15:25 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 04:15:25 INFO - warning: no files found matching '*.txt' 04:15:25 INFO - no previously-included directories found matching 'build' 04:15:25 INFO - no previously-included directories found matching 'dist' 04:15:25 INFO - no previously-included directories found matching '.git*' 04:15:25 INFO - Installing collected packages: jsonschema, functools32 04:15:25 INFO - Running setup.py install for functools32 04:15:25 INFO - warning: no files found matching '*.txt' 04:15:25 INFO - no previously-included directories found matching 'build' 04:15:25 INFO - no previously-included directories found matching 'dist' 04:15:25 INFO - no previously-included directories found matching '.git*' 04:15:25 INFO - Successfully installed jsonschema functools32 04:15:25 INFO - Cleaning up... 04:15:25 INFO - Return code: 0 04:15:25 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 04:15:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:15:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:15:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:15:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:15:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:25 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 0x7f35ef261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21e8790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21e5930>, '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 0x21e6830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21e6cc0>, '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': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', '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 04:15:25 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 04:15:25 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 04:15:25 INFO - Using env: {'DISPLAY': ':0', 04:15:25 INFO - 'HOME': '/home/cltbld', 04:15:25 INFO - 'LANG': 'en_US.UTF-8', 04:15:25 INFO - 'LANGUAGE': 'en_US:en', 04:15:25 INFO - 'LOGNAME': 'cltbld', 04:15:25 INFO - 'MAIL': '/var/mail/cltbld', 04:15:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:15:25 INFO - 'MOZ_NO_REMOTE': '1', 04:15:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:15:25 INFO - 'NO_EM_RESTART': '1', 04:15:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:15:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:15:25 INFO - 'PWD': '/builds/slave/test', 04:15:25 INFO - 'SHELL': '/bin/bash', 04:15:25 INFO - 'SHLVL': '1', 04:15:25 INFO - 'TERM': 'linux', 04:15:25 INFO - 'TMOUT': '86400', 04:15:25 INFO - 'USER': 'cltbld', 04:15:25 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', 04:15:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:15:25 INFO - '_': '/tools/buildbot/bin/python'} 04:15:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:15:25 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 04:15:25 INFO - Cleaning up... 04:15:25 INFO - Return code: 0 04:15:25 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 04:15:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:15:25 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:15:25 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:25 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:15:25 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:15:25 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:25 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 0x7f35ef261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21e8790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21e5930>, '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 0x21e6830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21e6cc0>, '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': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', '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 04:15:25 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 04:15:25 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 04:15:25 INFO - Using env: {'DISPLAY': ':0', 04:15:25 INFO - 'HOME': '/home/cltbld', 04:15:25 INFO - 'LANG': 'en_US.UTF-8', 04:15:25 INFO - 'LANGUAGE': 'en_US:en', 04:15:25 INFO - 'LOGNAME': 'cltbld', 04:15:25 INFO - 'MAIL': '/var/mail/cltbld', 04:15:25 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:15:25 INFO - 'MOZ_NO_REMOTE': '1', 04:15:25 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:15:25 INFO - 'NO_EM_RESTART': '1', 04:15:25 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:15:25 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:15:25 INFO - 'PWD': '/builds/slave/test', 04:15:25 INFO - 'SHELL': '/bin/bash', 04:15:25 INFO - 'SHLVL': '1', 04:15:25 INFO - 'TERM': 'linux', 04:15:25 INFO - 'TMOUT': '86400', 04:15:25 INFO - 'USER': 'cltbld', 04:15:25 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', 04:15:25 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:15:25 INFO - '_': '/tools/buildbot/bin/python'} 04:15:25 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:15:25 INFO - Downloading/unpacking blobuploader==1.2.4 04:15:25 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 04:15:25 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 04:15:25 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 04:15:25 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 04:15:25 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 04:15:25 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 04:15:27 INFO - Downloading blobuploader-1.2.4.tar.gz 04:15:27 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 04:15:27 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 04:15:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:15:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:15:27 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:15:27 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:15:27 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:15:27 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:15:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 04:15:28 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 04:15:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:15:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:15:28 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:15:28 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:15:28 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:15:28 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:15:28 INFO - Downloading docopt-0.6.1.tar.gz 04:15:28 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 04:15:28 INFO - Installing collected packages: blobuploader, requests, docopt 04:15:28 INFO - Running setup.py install for blobuploader 04:15:28 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 04:15:28 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 04:15:28 INFO - Running setup.py install for requests 04:15:29 INFO - Running setup.py install for docopt 04:15:29 INFO - Successfully installed blobuploader requests docopt 04:15:29 INFO - Cleaning up... 04:15:29 INFO - Return code: 0 04:15:29 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:15:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:15:29 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:15:29 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:29 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:15:29 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:15:29 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:29 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 0x7f35ef261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21e8790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21e5930>, '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 0x21e6830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21e6cc0>, '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': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', '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 04:15:29 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 04:15:29 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 04:15:29 INFO - Using env: {'DISPLAY': ':0', 04:15:29 INFO - 'HOME': '/home/cltbld', 04:15:29 INFO - 'LANG': 'en_US.UTF-8', 04:15:29 INFO - 'LANGUAGE': 'en_US:en', 04:15:29 INFO - 'LOGNAME': 'cltbld', 04:15:29 INFO - 'MAIL': '/var/mail/cltbld', 04:15:29 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:15:29 INFO - 'MOZ_NO_REMOTE': '1', 04:15:29 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:15:29 INFO - 'NO_EM_RESTART': '1', 04:15:29 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:15:29 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:15:29 INFO - 'PWD': '/builds/slave/test', 04:15:29 INFO - 'SHELL': '/bin/bash', 04:15:29 INFO - 'SHLVL': '1', 04:15:29 INFO - 'TERM': 'linux', 04:15:29 INFO - 'TMOUT': '86400', 04:15:29 INFO - 'USER': 'cltbld', 04:15:29 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', 04:15:29 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:15:29 INFO - '_': '/tools/buildbot/bin/python'} 04:15:29 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:15:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:15:29 INFO - Running setup.py (path:/tmp/pip-LYkuvH-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:15:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:15:29 INFO - Running setup.py (path:/tmp/pip-XQjC5z-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:15:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:15:29 INFO - Running setup.py (path:/tmp/pip-jxqU1v-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:15:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:15:29 INFO - Running setup.py (path:/tmp/pip-PoickM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:15:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:15:29 INFO - Running setup.py (path:/tmp/pip-975XJm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:15:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:15:29 INFO - Running setup.py (path:/tmp/pip-4v8lG6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:15:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:15:29 INFO - Running setup.py (path:/tmp/pip-gYeUO0-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:15:29 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:15:29 INFO - Running setup.py (path:/tmp/pip-VFYF_k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:15:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:15:30 INFO - Running setup.py (path:/tmp/pip-IJOfTO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:15:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:15:30 INFO - Running setup.py (path:/tmp/pip-eJhzet-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:15:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:15:30 INFO - Running setup.py (path:/tmp/pip-1PjYl5-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:15:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:15:30 INFO - Running setup.py (path:/tmp/pip-DgPjQb-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:15:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:15:30 INFO - Running setup.py (path:/tmp/pip-6V7_8i-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:15:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:15:30 INFO - Running setup.py (path:/tmp/pip-3iHqey-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:15:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:15:30 INFO - Running setup.py (path:/tmp/pip-FGw5HZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:15:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:15:30 INFO - Running setup.py (path:/tmp/pip-40tpLy-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:15:30 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:15:30 INFO - Running setup.py (path:/tmp/pip-LZRzHn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:15:30 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 04:15:30 INFO - Running setup.py install for manifestparser 04:15:30 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 04:15:30 INFO - Running setup.py install for mozcrash 04:15:30 INFO - Running setup.py install for mozdebug 04:15:30 INFO - Running setup.py install for mozdevice 04:15:31 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 04:15:31 INFO - Installing dm script to /builds/slave/test/build/venv/bin 04:15:31 INFO - Running setup.py install for mozfile 04:15:31 INFO - Running setup.py install for mozhttpd 04:15:31 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 04:15:31 INFO - Running setup.py install for mozinfo 04:15:31 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 04:15:31 INFO - Running setup.py install for mozInstall 04:15:31 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 04:15:31 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 04:15:31 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 04:15:31 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 04:15:31 INFO - Running setup.py install for mozleak 04:15:31 INFO - Running setup.py install for mozlog 04:15:31 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 04:15:31 INFO - Running setup.py install for moznetwork 04:15:31 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 04:15:31 INFO - Running setup.py install for mozprocess 04:15:31 INFO - Running setup.py install for mozprofile 04:15:32 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 04:15:32 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 04:15:32 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 04:15:32 INFO - Running setup.py install for mozrunner 04:15:32 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 04:15:32 INFO - Running setup.py install for mozscreenshot 04:15:32 INFO - Running setup.py install for moztest 04:15:32 INFO - Running setup.py install for mozversion 04:15:32 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 04:15:32 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 04:15:32 INFO - Cleaning up... 04:15:32 INFO - Return code: 0 04:15:32 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:15:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:15:32 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:15:32 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:32 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 04:15:32 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:15:32 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:32 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 0x7f35ef261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21e8790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21e5930>, '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 0x21e6830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21e6cc0>, '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': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', '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 04:15:32 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 04:15:32 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 04:15:32 INFO - Using env: {'DISPLAY': ':0', 04:15:32 INFO - 'HOME': '/home/cltbld', 04:15:32 INFO - 'LANG': 'en_US.UTF-8', 04:15:32 INFO - 'LANGUAGE': 'en_US:en', 04:15:32 INFO - 'LOGNAME': 'cltbld', 04:15:32 INFO - 'MAIL': '/var/mail/cltbld', 04:15:32 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:15:32 INFO - 'MOZ_NO_REMOTE': '1', 04:15:32 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:15:32 INFO - 'NO_EM_RESTART': '1', 04:15:32 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:15:32 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:15:32 INFO - 'PWD': '/builds/slave/test', 04:15:32 INFO - 'SHELL': '/bin/bash', 04:15:32 INFO - 'SHLVL': '1', 04:15:32 INFO - 'TERM': 'linux', 04:15:32 INFO - 'TMOUT': '86400', 04:15:32 INFO - 'USER': 'cltbld', 04:15:32 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', 04:15:32 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:15:32 INFO - '_': '/tools/buildbot/bin/python'} 04:15:32 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:15:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 04:15:32 INFO - Running setup.py (path:/tmp/pip-N2zBpz-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 04:15:32 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)) 04:15:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 04:15:32 INFO - Running setup.py (path:/tmp/pip-e3t6YZ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 04:15:32 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)) 04:15:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 04:15:32 INFO - Running setup.py (path:/tmp/pip-LEhl46-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 04:15:32 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)) 04:15:32 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 04:15:32 INFO - Running setup.py (path:/tmp/pip-1vdvPk-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 04:15:33 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)) 04:15:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 04:15:33 INFO - Running setup.py (path:/tmp/pip-o4b3BP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 04:15:33 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)) 04:15:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 04:15:33 INFO - Running setup.py (path:/tmp/pip-y_LRTf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 04:15:33 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)) 04:15:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 04:15:33 INFO - Running setup.py (path:/tmp/pip-bP7vU3-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 04:15:33 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)) 04:15:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 04:15:33 INFO - Running setup.py (path:/tmp/pip-IitpH8-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 04:15:33 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)) 04:15:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 04:15:33 INFO - Running setup.py (path:/tmp/pip-UwZxAc-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 04:15:33 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)) 04:15:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 04:15:33 INFO - Running setup.py (path:/tmp/pip-2uMbG4-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 04:15:33 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)) 04:15:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 04:15:33 INFO - Running setup.py (path:/tmp/pip-oG8Lsp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 04:15:33 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)) 04:15:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 04:15:33 INFO - Running setup.py (path:/tmp/pip-SseYrp-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 04:15:33 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)) 04:15:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 04:15:33 INFO - Running setup.py (path:/tmp/pip-_PKGbm-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 04:15:33 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)) 04:15:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 04:15:33 INFO - Running setup.py (path:/tmp/pip-Noh3LG-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 04:15:33 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)) 04:15:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 04:15:33 INFO - Running setup.py (path:/tmp/pip-FoZ6kM-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 04:15:33 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)) 04:15:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 04:15:33 INFO - Running setup.py (path:/tmp/pip-5krNpL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 04:15:33 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)) 04:15:33 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 04:15:33 INFO - Running setup.py (path:/tmp/pip-Jm72aU-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 04:15:33 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)) 04:15:33 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)) 04:15:33 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)) 04:15:33 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)) 04:15:33 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)) 04:15:33 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)) 04:15:33 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 04:15:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:15:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:15:33 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:15:33 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 04:15:33 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 04:15:33 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 04:15:35 INFO - Downloading blessings-1.6.tar.gz 04:15:35 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 04:15:35 INFO - Installing collected packages: blessings 04:15:35 INFO - Running setup.py install for blessings 04:15:36 INFO - Successfully installed blessings 04:15:36 INFO - Cleaning up... 04:15:36 INFO - Return code: 0 04:15:36 INFO - Done creating virtualenv /builds/slave/test/build/venv. 04:15:36 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:15:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:15:36 INFO - Reading from file tmpfile_stdout 04:15:36 INFO - Current package versions: 04:15:36 INFO - argparse == 1.2.1 04:15:36 INFO - blessings == 1.6 04:15:36 INFO - blobuploader == 1.2.4 04:15:36 INFO - docopt == 0.6.1 04:15:36 INFO - functools32 == 3.2.3-2 04:15:36 INFO - jsonschema == 2.5.1 04:15:36 INFO - manifestparser == 1.1 04:15:36 INFO - mozInstall == 1.12 04:15:36 INFO - mozcrash == 0.17 04:15:36 INFO - mozdebug == 0.1 04:15:36 INFO - mozdevice == 0.48 04:15:36 INFO - mozfile == 1.2 04:15:36 INFO - mozhttpd == 0.7 04:15:36 INFO - mozinfo == 0.9 04:15:36 INFO - mozleak == 0.1 04:15:36 INFO - mozlog == 3.4 04:15:36 INFO - moznetwork == 0.27 04:15:36 INFO - mozprocess == 0.23 04:15:36 INFO - mozprofile == 0.28 04:15:36 INFO - mozrunner == 6.12 04:15:36 INFO - mozscreenshot == 0.1 04:15:36 INFO - mozsystemmonitor == 0.3 04:15:36 INFO - moztest == 0.7 04:15:36 INFO - mozversion == 1.4 04:15:36 INFO - psutil == 3.1.1 04:15:36 INFO - requests == 1.2.3 04:15:36 INFO - wsgiref == 0.1.2 04:15:36 INFO - Installing None into virtualenv /builds/slave/test/build/venv 04:15: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')]} 04:15:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:15:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15: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')]} 04:15:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:15:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:36 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 0x7f35ef261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21e8790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21e5930>, '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 0x21e6830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21e6cc0>, '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': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', '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 04:15:36 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 04:15:36 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 04:15:36 INFO - Using env: {'DISPLAY': ':0', 04:15:36 INFO - 'HOME': '/home/cltbld', 04:15:36 INFO - 'LANG': 'en_US.UTF-8', 04:15:36 INFO - 'LANGUAGE': 'en_US:en', 04:15:36 INFO - 'LOGNAME': 'cltbld', 04:15:36 INFO - 'MAIL': '/var/mail/cltbld', 04:15:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:15:36 INFO - 'MOZ_NO_REMOTE': '1', 04:15:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:15:36 INFO - 'NO_EM_RESTART': '1', 04:15:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:15:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:15:36 INFO - 'PWD': '/builds/slave/test', 04:15:36 INFO - 'SHELL': '/bin/bash', 04:15:36 INFO - 'SHLVL': '1', 04:15:36 INFO - 'TERM': 'linux', 04:15:36 INFO - 'TMOUT': '86400', 04:15:36 INFO - 'USER': 'cltbld', 04:15:36 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', 04:15:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:15:36 INFO - '_': '/tools/buildbot/bin/python'} 04:15:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:15:36 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)) 04:15:36 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)) 04:15:36 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)) 04:15:36 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)) 04:15:36 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)) 04:15:36 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)) 04:15:36 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)) 04:15:36 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)) 04:15:36 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)) 04:15:36 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)) 04:15:36 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)) 04:15:36 INFO - Cleaning up... 04:15:36 INFO - Return code: 0 04:15:36 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 04:15: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')]} 04:15:36 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 04:15:36 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15: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')]} 04:15:36 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 04:15:36 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 04:15:36 INFO - retry: Calling run_command with args: [['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x7f35ef261f10>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x211b8a0>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x21e8790>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x21e5930>, '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 0x21e6830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21e6cc0>, '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': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', '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 04:15:36 INFO - Running command: ['/builds/slave/test/build/venv/bin/pip', 'install', '--timeout', '120', '--no-index', '--find-links', 'http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub', '--find-links', 'http://pypi.pvt.build.mozilla.org/pub', '--find-links', 'http://pypi.pub.build.mozilla.org/pub', 'jsonschema'] in /builds/slave/test/build 04:15:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip install --timeout 120 --no-index --find-links http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub --find-links http://pypi.pvt.build.mozilla.org/pub --find-links http://pypi.pub.build.mozilla.org/pub jsonschema 04:15:36 INFO - Using env: {'DISPLAY': ':0', 04:15:36 INFO - 'HOME': '/home/cltbld', 04:15:36 INFO - 'LANG': 'en_US.UTF-8', 04:15:36 INFO - 'LANGUAGE': 'en_US:en', 04:15:36 INFO - 'LOGNAME': 'cltbld', 04:15:36 INFO - 'MAIL': '/var/mail/cltbld', 04:15:36 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:15:36 INFO - 'MOZ_NO_REMOTE': '1', 04:15:36 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:15:36 INFO - 'NO_EM_RESTART': '1', 04:15:36 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:15:36 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:15:36 INFO - 'PWD': '/builds/slave/test', 04:15:36 INFO - 'SHELL': '/bin/bash', 04:15:36 INFO - 'SHLVL': '1', 04:15:36 INFO - 'TERM': 'linux', 04:15:36 INFO - 'TMOUT': '86400', 04:15:36 INFO - 'USER': 'cltbld', 04:15:36 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', 04:15:36 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:15:36 INFO - '_': '/tools/buildbot/bin/python'} 04:15:36 INFO - Ignoring indexes: https://pypi.python.org/simple/ 04:15:36 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 04:15:36 INFO - Cleaning up... 04:15:36 INFO - Return code: 0 04:15:36 INFO - Running post-action listener: _resource_record_post_action 04:15:36 INFO - Running post-action listener: _start_resource_monitoring 04:15:36 INFO - Starting resource monitoring. 04:15:36 INFO - [mozharness: 2016-10-01 11:15:36.810851Z] Finished create-virtualenv step (success) 04:15:36 INFO - [mozharness: 2016-10-01 11:15:36.811365Z] Running install step. 04:15:36 INFO - Running pre-action listener: _resource_record_pre_action 04:15:36 INFO - Running main action method: install 04:15:36 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 04:15:36 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 04:15:37 INFO - Reading from file tmpfile_stdout 04:15:37 INFO - Detecting whether we're running mozinstall >=1.0... 04:15:37 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 04:15:37 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 04:15:37 INFO - Reading from file tmpfile_stdout 04:15:37 INFO - Output received: 04:15:37 INFO - Usage: mozinstall [options] installer 04:15:37 INFO - Options: 04:15:37 INFO - -h, --help show this help message and exit 04:15:37 INFO - -d DEST, --destination=DEST 04:15:37 INFO - Directory to install application into. [default: 04:15:37 INFO - "/builds/slave/test"] 04:15:37 INFO - --app=APP Application being installed. [default: firefox] 04:15:37 INFO - mkdir: /builds/slave/test/build/application 04:15:37 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'] 04:15:37 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 04:15:54 INFO - Reading from file tmpfile_stdout 04:15:54 INFO - Output received: 04:15:54 INFO - /builds/slave/test/build/application/firefox/firefox 04:15:54 INFO - Running post-action listener: _resource_record_post_action 04:15:54 INFO - [mozharness: 2016-10-01 11:15:54.134315Z] Finished install step (success) 04:15:54 INFO - [mozharness: 2016-10-01 11:15:54.134561Z] Running run-tests step. 04:15:54 INFO - Running pre-action listener: _resource_record_pre_action 04:15:54 INFO - Running main action method: run_tests 04:15:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 04:15:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 04:15:54 INFO - Python 2.7.3 04:15:54 INFO - Return code: 0 04:15:54 INFO - grabbing minidump binary from tooltool 04:15:54 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')]} 04:15:54 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 0x21e5930>, '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 0x21e6830>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x21e6cc0>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 04:15:54 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 04:15:54 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 04:15:54 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 04:15:54 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 04:15:54 INFO - Return code: 0 04:15:54 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 04:15:54 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 04:15:54 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 04:15:54 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 04:15:54 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 04:15:54 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-065', '--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 04:15:54 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Firefox --suite dromaeojs-e10s --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip --title talos-linux64-ix-065 --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 04:15:54 INFO - Using env: {'DISPLAY': ':0', 04:15:54 INFO - 'HOME': '/home/cltbld', 04:15:54 INFO - 'LANG': 'en_US.UTF-8', 04:15:54 INFO - 'LANGUAGE': 'en_US:en', 04:15:54 INFO - 'LOGNAME': 'cltbld', 04:15:54 INFO - 'MAIL': '/var/mail/cltbld', 04:15:54 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 04:15:54 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 04:15:54 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 04:15:54 INFO - 'MOZ_NO_REMOTE': '1', 04:15:54 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 04:15:54 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 04:15:54 INFO - 'NO_EM_RESTART': '1', 04:15:54 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 04:15:54 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 04:15:54 INFO - 'PWD': '/builds/slave/test', 04:15:54 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 04:15:54 INFO - 'SHELL': '/bin/bash', 04:15:54 INFO - 'SHLVL': '1', 04:15:54 INFO - 'TERM': 'linux', 04:15:54 INFO - 'TMOUT': '86400', 04:15:54 INFO - 'USER': 'cltbld', 04:15:54 INFO - 'XDG_SESSION_COOKIE': '523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728', 04:15:54 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 04:15:54 INFO - '_': '/tools/buildbot/bin/python'} 04:15:54 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Firefox', '--suite', 'dromaeojs-e10s', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-065', '--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 04:15:54 INFO - mozversion application_buildid: 20161001013004 04:15:54 INFO - mozversion application_changeset: 87cd291d2db621da6b3eb1057027cc0725b6eb1d 04:15:54 INFO - mozversion application_display_name: Nightly 04:15:54 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 04:15:54 INFO - mozversion application_name: Firefox 04:15:54 INFO - mozversion application_remotingname: firefox 04:15:54 INFO - mozversion application_repository: https://hg.mozilla.org/mozilla-central 04:15:54 INFO - mozversion application_vendor: Mozilla 04:15:54 INFO - mozversion application_version: 52.0a1 04:15:54 INFO - mozversion platform_buildid: 20161001013004 04:15:54 INFO - mozversion platform_changeset: 87cd291d2db621da6b3eb1057027cc0725b6eb1d 04:15:54 INFO - mozversion platform_repository: https://hg.mozilla.org/mozilla-central 04:15:54 INFO - mozversion platform_version: 52.0a1 04:15:54 INFO - using testdate: 1475320554 04:15:54 INFO - actual date: 1475320554 04:15:54 INFO - starting webserver on 'localhost:42962' 04:15:54 INFO - SUITE-START | Running 2 tests 04:15:54 INFO - TEST-START | dromaeo_css 04:15:54 INFO - operating with platform_type : linux_ 04:15:54 INFO - Initialising browser for dromaeo_css test... 04:15:54 INFO - TEST-INFO | started process 15436 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpuHGCSA/profile http://localhost:42962/getInfo.html) 04:15:59 INFO - PROCESS | 15436 | __metrics Screen width/height:1600/1200 04:15:59 INFO - PROCESS | 15436 | colorDepth:24 04:15:59 INFO - PROCESS | 15436 | Browser inner width/height: 1024/697 04:15:59 INFO - PROCESS | 15436 | __metrics 04:15:59 ERROR - PROCESS | 15436 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3079: TypeError: this.tabs is undefined 04:16:00 INFO - TEST-INFO | 15436: exit 0 04:16:00 INFO - Browser initialized. 04:16:00 INFO - Running cycle 1/1 for dromaeo_css test... 04:16:00 INFO - TEST-INFO | started process 15559 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpuHGCSA/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:16:12 INFO - PROCESS | 15559 | RSS: Main: 185221120 04:16:12 INFO - PROCESS | 15559 | 04:17:02 INFO - PROCESS | 15559 | 1475320622354 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] 04:19:13 INFO - PROCESS | 15559 | Cycle 1(1): loaded http://localhost:42962/tests/dromaeo/cssquery-dojo.html (next: http://localhost:42962/tests/dromaeo/cssquery-ext.html) 04:19:14 INFO - PROCESS | 15559 | RSS: Main: 202702848 04:19:14 INFO - PROCESS | 15559 | 04:22:17 INFO - PROCESS | 15559 | Cycle 1(1): loaded http://localhost:42962/tests/dromaeo/cssquery-ext.html (next: http://localhost:42962/tests/dromaeo/cssquery-jquery.html) 04:22:17 INFO - PROCESS | 15559 | RSS: Main: 199426048 04:22:17 INFO - PROCESS | 15559 | 04:25:19 INFO - PROCESS | 15559 | Cycle 1(1): loaded http://localhost:42962/tests/dromaeo/cssquery-jquery.html (next: http://localhost:42962/tests/dromaeo/cssquery-mootools.html) 04:25:20 INFO - PROCESS | 15559 | RSS: Main: 200847360 04:25:20 INFO - PROCESS | 15559 | 04:28:21 INFO - PROCESS | 15559 | Cycle 1(1): loaded http://localhost:42962/tests/dromaeo/cssquery-mootools.html (next: http://localhost:42962/tests/dromaeo/cssquery-prototype.html) 04:28:22 INFO - PROCESS | 15559 | RSS: Main: 194969600 04:28:22 INFO - PROCESS | 15559 | 04:31:25 INFO - PROCESS | 15559 | Cycle 1(1): loaded http://localhost:42962/tests/dromaeo/cssquery-prototype.html (next: http://localhost:42962/tests/dromaeo/cssquery-yui.html) 04:31:25 INFO - PROCESS | 15559 | RSS: Main: 198680576 04:31:25 INFO - PROCESS | 15559 | 04:34:28 INFO - PROCESS | 15559 | Cycle 1(1): loaded http://localhost:42962/tests/dromaeo/cssquery-yui.html (next: http://localhost:42962/tests/dromaeo/cssquery-dojo.html) 04:34:28 INFO - PROCESS | 15559 | RSS: Main: 198856704 04:34:28 INFO - PROCESS | 15559 | 04:34:28 INFO - PROCESS | 15559 | __start_tp_report 04:34:28 INFO - PROCESS | 15559 | _x_x_mozilla_page_load 04:34:28 INFO - PROCESS | 15559 | _x_x_mozilla_page_load_details 04:34:28 INFO - PROCESS | 15559 | |i|pagename|runs| 04:34:28 INFO - PROCESS | 15559 | |0;dojo.html;3056.6332040155185;3057.80124291921;3074.246809531662;3086.0433265687625;3099.442100421923;5211.5830733541225;5409.702466364349;5441.782328706847;5451.754671039803;5529.3364796224505;5245.68525888446;5419.891602167954;5421.186821976706;5492.148716948869;5497.285352904117;4916.754162291889;4996.900061998758;5009.674371165881;5050.823221187259;5073.061483625541;5033.823816166435;5079.2635067915135;5100.948990510103;5104.310918026056;5109.69341839489;4867.9269810952865;4914.582260507861;4932.358793356877;4998.175301075336;5037.2192310191795;4921.040397122562;4969;4972.925406118875;5019.824306149304;5025.69845809249;4874.341963834872;4918.483559226265;4932.432770231398;4958.628102892298;5000.04999050183;5306.867328316785;5355.571554275649;5422.295101636762;5440.265564148868;5443.074677304868;5709.77160913563;5717.685527295997;5747.597668163188;5777.220075289824;5793.478586927196;5752.683602401867;5755.971220143914;5838.883222335529;5846.093855452412;5859.824205273849;5369.27514785499;5440.755166017539;5446.183072539111;5451.890962180813;5460.890782184413;5935.0207215808905;5960.254968128984;5964.045752679551;5970.76116955317;6069.393060693896;5710.600257981901;5723;5779.566532509994;5781.248437703071;5789.160571717078;5597.944020559824;5631.746571404296;5634.774609015675;5884.352721200665;5886.676232807236;5778.248827652378;5848.883022339614;5860.443257890493;5875.4124587541755;5945.078512830518;5881.647101173858;5900.232969713909;5902.2622172228475;5906.8818623627285;5912.113183022581;4395.802188901507;4515.887102822456;4518.864434066983;4536.727796332165;4572.291294849304;3940.5074365704286;3943.467631869661;3948.980255098706;3994.8801535953967;4067.2678917794487;5542.889142217133;5551.306086739158;5578.832635020955;5583.972080139573;5584.553235741131;5824.94175058244;5856.765729370863;5890.558208134407;5895.29256489224;5965.224520812267;5376.516113549799;5414.7834086636885;5417.241586177938;5447;5477.4796394342475;4928.728919909439;4932.728699921467;4935.284383764334;4938.08645400602;4941.851744447672;5954.940450595439;5957.851053723692;5962.105684147413;5963.224780778471;5964.701764911737;5744.569157313134;5745;5762.654240745569;5762.798302059407;5764.654120752768;5913.58604897653;5957.761689532544;5963.493103086113;5964.165016897551;5974.522038237017;5669.092945128759;5680.545556355399;5686.175504551899;5686.914696279642;5692.117721753135;5750.878578677118;5784.595078344475;5890.4993075589055;5894.086416605433;5903.852403689943;5718.199452076629;5776.855578610568;5786.1899334094105;5792.82621521355;5801.564882633735;5667.603267771216;5704.515116215002;5734.741936612946;5774.335951365647;5788.565857560784;5619.80330688424;5654.519365853948;5656.3495198051105;5702.6863522505;5745.253117094751;5793.073108302651;5799.4780469757925;5834.562407819515;5835.79574714883;5850.853728656818;5577.330720313588;5644.6613203207935;5666.263385759825;5673.461021202979;5681.119426488901 04:34:28 INFO - PROCESS | 15559 | |1;ext.html;555.4972749661556;566.6515093217672;577.5697105656285;578.6585914310556;581.7498475655469;42223;44276.557234427644;44356.999999999956;47196.2920556192;47255.76372118135;44977.55022449775;45474.31788523175;45513.772431137884;45603.77198114013;46001;8878.77803054924;9016.459012459274;9037;9041.457512549236;9044.502552359618;8825.823483530325;8872.467651940871;8960.910390896106;8969.237614802749;8987.910120898772;8884;8917.68788092417;8941.195292423681;8946.031872987965;8981.371304008722;8899.199072083478;8907.68823091192;8939.865902011476;8950.686725964593;8953.373263871532;8767.561621918878;8896.644134234622;8903.421277616933;8971.596278167499;8995.415298005673;43092.35361469581;43428.13143737139;43450.56549434497;43581.12837743259;43589;3436.398630239723;3439.466882633171;3458.8443520041405;3509.9649003509894;3837.1558257183374;31892.362152756814;32159.839200803846;32732.836335818407;32765.18087047819;32902.177445563815;4264.637505811978;4287.164003019412;4322.805473753689;4373.169097871394;4454.465464144323;308261;309042;312277;313792;314353;56941.43058569444;57974;58206.70896645574;58246;58267.70866145642;60626.39373606296;60646.69676651589;60675.393246067855;60724.08913866295;60793.69603151956;16156.596085097966;16157.59606009859;16201.270942807601;16222.756658650129;16236.675266494603;12263;12359.196652217577;12409.62771116868;12478.688032799071;12540.05949553769;16717.164141792862;17294.82705172932;17405.912970435067;17409;17415.73876391855;6032.969835150796;6053.788117415869;6120.469882529368;6180.690965451709;6227.377262273736;865.8701194820701;954.9188318992824;955.3551352836807;999.0858364596313;1065.4832406282947;31202.53196202059;31239;31606.841965790023;31744.36511269808;32009.679903201137;1008.9445080520495;1022.3201570955232;1081.561967403203;1102.2780079048237;1123.4045955643358;15389.461368852037;15919.761203581955;15994.600134996486;16140.757888631446;16284.016577620117;512349;512741;514757;515602;517379;56792.71603641955;57064.71467642635;57202.427975720544;57207.14189287164;57352.42647573554;1229.975400491985;1250.031225799994;1358.5380970470087;1364.379207460603;1397.224540380099;28020.439591207654;29290.85354573299;29752.55371169391;31485.212869678442;31854.36291274208;54969;55454.72272638611;55837;55868.16197756956;55891.16163257473;450259;454220;454714;455849;457536;27753.861230693718;27951.72048279491;28293.15120546387;28777.280567985967;28781.56827647545;46177.769111155576;46674;46896.531034689215;47176.76411618057;47751.5224847761;39469.21061578695;40051.198976020896;41299.96750081272;41742;41835;39526.60473395344;39754.80122599369;39896.60103398929;41452.58547414487;41637.79181104075;35197.472037919964;35514.28971420609;40257;40377.596224038556;41608.583914160474;34352.82823585866;37400.6259937408;37484.43773343456;38441;38779;26917.192484225503;27213.455730884874;27261.59107613427;27398.589021164298;27472.58791118175 04:34:28 INFO - PROCESS | 15559 | |2;jquery.html;399.1179493319763;405.4323946474935;408.218262028216;413.0726518964924;424.62208634315465;13815.342158940915;15188.620284492894;18441.815581844196;20311.289104881314;20331.085101170447;17899.463016109537;19366;19388.418347449562;19994.400167994947;20214;5647.322321321447;5659.4340565943385;5835.328937172216;5849.093390524476;5913.231279933624;5766.135079738052;5787;5824.097264923944;5871.266091738533;5871.677057761822;5577.6653400796085;5654.264945557072;5719.342275638313;5742.052561327376;5799.246098007275;5623.212750214973;5689.9146512802345;5746.109353050284;5746.310442746897;5776.451237132465;4914.852554423373;5158.277841102249;5203.895922081575;5280.788768449257;5298.258243845865;13843.515476958259;14131.646708832259;14143.151410915276;14177.14937103777;14202.928985355007;2126.107035045269;2142.996298460944;2184.049938276839;2238.798508134276;2341.0869760793303;9467.147956683863;9942.552585133686;10331.121854642364;10493.213009024277;12872.806907896389;1846.4183782108594;1949.4541528371938;1950.6878899376031;1950.756155480565;2007.9698804517798;75999;83396;86644.56677716572;91118.54440727754;92417.53791231068;11313.83029254562;11316.20786544934;11461.911118443735;11510.827337589943;11694.590689325832;16199.757003644954;16209.351625935067;16230.594235144215;16232.107234102237;16284.674306513803;7977;8004.399670024772;8041.557714325651;8234.670613175525;8282.71010514629;7549.849003020019;7553.32020118192;7743.806404839811;7842.686292548348;7980.720674776355;4633.930491042637;4694.859154225379;4718.693284936468;4815.807367705253;5018.146915024382;2005.2680771518292;2036.9388918332475;2053.6098141353095;2083.9791602084088;2089.122568521225;851.6976473351995;882.4749274181852;951.9952400238093;980.2158273381267;1009.5759780892043;18666.906665466584;19926;20084.397468075982;20102.99485025772;20277.594448110955;906.6373450619805;968.651285537206;980.122790102854;983.5770618633914;997.2620261006948;8390.580470976427;11121.610743623934;11159.330440173615;11166.888331116585;11348.14888883337;485941;489976;495728;498028;510954;85673.57163214144;86253.68731563522;95577.522112389;97435;99311;1031.200819364998;1057.5241141486363;1058.2222066781064;1061.4692653673164;1072.2547829258747;17440.389586364417;17730.468085957444;17847;18016.639667206844;18078.728819067463;41413.1717365657;41560.95806947831;41964.790176048926;42062;42244.577554224066;53476.46523534715;53615.90648888349;55084.72457637847;56954.7152264236;59107.70446147742;8157.306628936607;8349.83300334002;8360.163983601591;8465.407421480684;8562.229399354088;9426.481543514898;11801.704957376134;11872.525098995944;11916.702082448008;12063.336516491678;9748;10043.397396156253;10191.388516689023;10359.63741269052;10570.841437378293;10263.281570290008;10413.583456661649;10425.218108641731;10433.165346772088;10689.732756681145;10063;10249.33379330341;10266;10392.844107338246;10734.14126869833;7255.891161632474;7633.427492937941;7771.145174030965;7778.49439786412;7967.203279672218;8124.22819832115;9822.65620703272;10520.526576303932;10678;11181.385023823443 04:34:28 INFO - PROCESS | 15559 | |3;mootools.html;1453.4258967707756;1499.7150541397136;1655.3130450862893;1742.2769550636488;1796.5329014456245;8059.113497515269;8288.792780180484;8734.432261902979;9305.581248843793;9313;8663.220310172082;8904.243139333148;8912.197902188802;9153.08469153086;9179.357444978854;2340.6137987232087;2372.3120295114395;2374.1809075868796;2374.976250237493;2377.0372998935372;2338.777816107467;2346.9765302346927;2402.8197885158597;2410.0841680161516;2418.286605451396;2370.2059809963685;2382.9046838126455;2388.534235824015;2404.651325557793;2405.218304051182;2288.4438581764393;2292.266474728071;2301.528186721718;2304.700388949434;2361.8700971446565;2250.5161390301;2283.223703940668;2286.6570014497793;2288.4622113803243;2302.5970455170277;9282.535873206312;9288.303377246666;9292.256619470427;9293.395929264643;9331.113544213356;5192.896142077175;5258.1849813279005;5270.367555893279;5332.440093790174;5334.0665383557725;3284.901452956391;3418.418868792311;3455.568053993251;3491.9650803491895;3527.735419843522;1076.95692172313;1110.3837370259503;1142.6229344316355;1166.2535976974743;1173.530587764901;12929.159604625764;12934.935325323313;12945.093843430963;12987.155834870704;12995.610131696065;4253.234417804825;4523.36672865799;4608.815647374067;4654.976725116353;4718.457377401574;10635.734106647396;10657.413842238751;10671.466426678635;10675.679729608124;10681.946590266998;5088.847334579968;5127.974360128175;5129.461406552333;5144.511271429208;5156.639035267495;4349.217140914602;4493.662975276802;4741.217699079613;4773.737444440589;4854.077725232195;3913.4521167036637;3917.334053210961;3992.680585553149;4099.713020088565;4186.309258972296;1320.2078752748275;1324.715186234945;1333.200079952021;1334.0794851552398;1338.1636477201748;825.2366560931115;903.9819203615891;918.8437965545874;921.8432866412726;925.3707478914268;5718.549470228274;5745.1382292656435;5793.362730099686;5794.797182098607;5989.431004054608;442.18417020596945;448.67919437602274;449.1062785057712;451.4920714196529;459.3546067774782;3724.765140915429;3936.9212615748097;3937.8621748239248;3999.3001224786126;4035.414864844581;11091.944540277409;11380.374079425712;11481.425928703531;11588.478518466689;11607.6517704469;10928.235023548275;10951.233413661126;11480.368579728029;11498.42507874603;11515;8360.58197090143;8484.660613575512;8527.062023177445;8530.616122274512;8533;5543.584231182596;5652.265205523256;5663.915041274302;5732.828015159552;5751.798687045934;10318.968103189622;10372.17022638172;10390.844137338097;10577.788444230919;10602.681919542427;10315.793684126425;10380.429076400871;10423.843642345522;10486;10585.682429527127;7886;8050.637721302438;8128.918710813053;8425.95787021061;8427.283680887193;8516.616752246287;8802.779930501532;8814.867776983223;8824.073472285574;8831.558422078999;7717.652705628372;7736.4584479085925;7757.92242077572;7848;7906;7579.696812127453;7661.15727270011;7728.961355193413;7754.224577542201;7782.260685234894;7120.572765634079;7124.145102587722;7185.640717964186;7204.783856484314;7224.169220539705;4784.138855006132;4806.927896081492;4852.902941941212;4862.7325497098;4868.610511159028;5024.698518088926;5086.64393492452;5150.304708864405;5200.271961925409;5200.557952574073 04:34:28 INFO - PROCESS | 15559 | |4;prototype.html;328.34837859827206;333.99999999999994;348.39901170480914;351.52017496117776;352.16009816587433;5230.607704422174;5401.70290634015;5488.862778430536;5577.944220557798;5579.163125531168;5218.973905130479;5378.2470454136455;5398.190271459273;5418.6379964128955;5444.373897001846;4233.830646774133;4295.7852107394665;4317.661524927267;4338.609525142737;4350.847720329789;4225.9788701056605;4246.108317253365;4313.978430107845;4340.43574335336;4341.826326946918;4235.258829704805;4237.936430953539;4250.574942505756;4254;4260.7656578888145;4230.534641189467;4232.862404485746;4261.936070958938;4264.1471705659;4267.125239325931;3697.4084146536693;3841.327767640652;3844.75009124406;3851.595582463829;3862.7489213201334;5205.349331333583;5216.8695782605355;5226.1778639534605;5295.152775555931;5303.840884773463;4857.441394239637;4861.854144375674;4862.829800956985;4867.123917694814;4867.8783030424165;5457.317835270591;5617.4382561743905;5645.294338207724;5662.546996240291;5706.201131841545;4108.342665173588;4110.979445102786;4111.48606424197;4111.835526578933;4129.504459464853;5786.623869448473;5867;5873.882522349571;5901.380355062743;5903.527717782567;4149.1578268885905;4261.700181444628;4267.978660106742;4279.807408666617;4284.657227421799;4253.128108737701;4259.552746961586;4277.016286254179;4289.91420171601;4293.3989241506215;4822.348982887265;4830.178869592178;4837.395325584302;4852.8301509447;4879.243717223836;5497.945020549823;5567.944320556823;5664.235328230636;5683.318001839806;5692.31692196939;1481.9333130009175;1512.780646806229;1518.476125736619;1527.8854085943376;1531.1731664901051;938.3619138985418;971.2909576009412;981.71395471932;984.4044353166374;990.8612794208816;4808.8797780055775;4835.854924352275;4837.516248375205;4895.339129217581;4901.730404827697;4983.9252411213865;4992.350994370709;5132.897342053138;5150.48495150482;5173.224016397495;4741.340530814256;4890.975545122323;4912.435069966999;4923.606111511142;4965.47862474435;2690.3274181454635;2704.350955770601;2714.3078514978947;2718.334008167972;2723.2783312422225;5214.601283409598;5262.894742105136;5295.72283917919;5302.416734159239;5319.973400132974;4899.510048995072;5170.681476223539;5200.92198617021;5217.295665085241;5263.605229607795;5232.607554433433;5267.629566695003;5289.942011597619;5304.549113325334;5308.256844041837;5088.888111433714;5090.134677104827;5101.872453188552;5120.26066054659;5131.769070391916;5056.9013859248;5374.247605335335;5793.826185214281;5800.883982320414;5814.418558144152;6113.388661134029;6168.599041062316;6190.288116866438;6196.256449226122;6199.628022318495;4029.5164580250557;4051.39229115635;4104.302268614402;4117.155983023533;4206.348016057516;5738.512226460631;5760.646248131769;5768.567357448124;5826.76692932278;5829.59192856496;5541.196526503554;5663.858403539944;5678.375378708256;5684.8010319638615;5685.175649530712;5625.606207565431;5636.464535869086;5647.29408823897;5678.659280443187;5684.488396044376;5568.716826101441;5570.777168913198;5611.775528978958;5630.4369563045;5656.2929633795775;5568;5690.914636280542;5700.401457846866;5719.28508936383;5737.569682273763;5589.161625756169;5592.636478628876;5604.8879022418505;5614.24207731951;5618 04:34:28 INFO - PROCESS | 15559 | |5;yui.html;692.9514933954625;738.1253214940297;739.5045319635846;775.2054144501885;816.297983733989;14934.25328733563;15721.720350549163;15815.920920395381;15840.128792916385;15910.681786364266;13432.66418339542;13451.730965380686;13464.326783660827;13517.121387109832;13588.660283492918;795.252462685077;812.695239285268;812.772423721359;814.9714759983402;815.1725998111921;798.1499702816511;799.532273619933;799.6121880887765;802.2939812964612;802.7993001749562;852.6461518469828;855.4311382930343;855.7603870916154;856.7858035491128;858.8024754306513;839.2656425627575;843.843888880559;844.2907957315854;847.7965288330818;849.0999540487103;630.0737915264599;631.5137344244906;631.5863109663178;632.4150161100963;635.0188958059808;13377.331133443386;13455.192688438725;13476.25880576568;13560;13578.864211357859;11509.5971640993;12681.302528360937;12967.935160324232;13194.934025329909;13592.388342524511;12576.245425274421;12663.240205587694;12983.522668107917;13337.733245335136;13478.258695771827;4479.3057076153245;4511.932321015187;4513.638908887281;4526.818927242906;4590.977045114786;83217;84446.57776711139;84490;85133;86838.92127551074;11152.386618736047;11160.441977901073;11229.157813164045;11522.193446458836;11585.768284634429;20559.280425185047;20565.280215192397;20568.382948511568;20580.382588522367;20635.277765278144;7792.220777922163;7854.607269636495;8033.3974951878845;8135.511869287861;8158.306543943712;4430.401895744033;4522.525134860858;4525.592696657251;4557;4680.508546602626;3355.8489867956;3424.4520876660113;3466.4280393735257;3472.8958131256104;3484.982575087108;609.1715267236555;610.0940103945637;624.0639041437843;624.3382015064046;643.4755674125572;573.4007961680054;640.286081019669;654.4273760459598;657.6547312660891;663.5521023309343;8412.789680258042;8721.345899057596;8984.416012959136;9130.81738365229;9288.628454861864;503.8261799679105;538.9974647156287;612.1063247658379;645.2192846655505;663.2339647706906;3968.6031396860662;4146.979265103655;4200.327947528381;4211.936820947688;4331.4152589400655;68664;69329;69529.30470695329;100033;104751.47624261983;99341.50329248451;101705;103405;103761;106104.46947765212;53764.73117634465;69388;86386;87777;90629;9056.773580660536;9231.123043310874;9366.641836933743;9701.805963880543;9702.499325451823;47800.52199477961;50814;51297.487025129274;51972.48027519828;53215.733921330146;47548;47761.76119119382;61508.384916152056;71568.28431715617;73401.6329918347;12148.574799881962;12855.29295888735;12931.741365172831;13062.673433164247;13401.262930538524;14271.357788899317;14706.63233419173;14867.702645946803;14891.255437228312;16402.671946560764;12858.357082146042;13288.335583220995;13513.189208647513;13926.791098133739;14284.142951422948;14171.858281417053;14805.629859253604;14892.106473611619;15006.2496875158;15112.319945602254;12995.48018079304;13648.727025459237;14085.295735213404;14096.718065638835;14167.362468688727;10758.645340005336;11582.336936172069;12051.469191469889;12093.09301802386;12419.130660853654;11345.716357091138;11944.283342999448;11979.28124312544;12039.337836419081;12156.878431215928 04:34:28 INFO - PROCESS | 15559 | __end_tp_report 04:34:28 INFO - PROCESS | 15559 | __start_cc_report 04:34:28 INFO - PROCESS | 15559 | _x_x_mozilla_cycle_collect,302 04:34:28 INFO - PROCESS | 15559 | __end_cc_report 04:34:28 INFO - PROCESS | 15559 | __startTimestamp1475321668758__endTimestamp 04:34:28 INFO - PROCESS | 15559 | 04:34:28 INFO - PROCESS | 15559 | ------- Summary: start ------- 04:34:28 INFO - PROCESS | 15559 | Number of tests: 6 04:34:28 INFO - PROCESS | 15559 | 04:34:28 INFO - PROCESS | 15559 | [#0] dojo.html Cycles:165 Average:5413.17 Median:5656.35 stddev:618.41 (10.9%) stddev-sans-first:592.04 04:34:28 INFO - PROCESS | 15559 | Values: 3056.6 3057.8 3074.2 3086.0 3099.4 5211.6 5409.7 5441.8 5451.8 5529.3 5245.7 5419.9 5421.2 5492.1 5497.3 4916.8 4996.9 5009.7 5050.8 5073.1 5033.8 5079.3 5100.9 5104.3 5109.7 4867.9 4914.6 4932.4 4998.2 5037.2 4921.0 4969.0 4972.9 5019.8 5025.7 4874.3 4918.5 4932.4 4958.6 5000.0 5306.9 5355.6 5422.3 5440.3 5443.1 5709.8 5717.7 5747.6 5777.2 5793.5 5752.7 5756.0 5838.9 5846.1 5859.8 5369.3 5440.8 5446.2 5451.9 5460.9 5935.0 5960.3 5964.0 5970.8 6069.4 5710.6 5723.0 5779.6 5781.2 5789.2 5597.9 5631.7 5634.8 5884.4 5886.7 5778.2 5848.9 5860.4 5875.4 5945.1 5881.6 5900.2 5902.3 5906.9 5912.1 4395.8 4515.9 4518.9 4536.7 4572.3 3940.5 3943.5 3949.0 3994.9 4067.3 5542.9 5551.3 5578.8 5584.0 5584.6 5824.9 5856.8 5890.6 5895.3 5965.2 5376.5 5414.8 5417.2 5447.0 5477.5 4928.7 4932.7 4935.3 4938.1 4941.9 5954.9 5957.9 5962.1 5963.2 5964.7 5744.6 5745.0 5762.7 5762.8 5764.7 5913.6 5957.8 5963.5 5964.2 5974.5 5669.1 5680.5 5686.2 5686.9 5692.1 5750.9 5784.6 5890.5 5894.1 5903.9 5718.2 5776.9 5786.2 5792.8 5801.6 5667.6 5704.5 5734.7 5774.3 5788.6 5619.8 5654.5 5656.3 5702.7 5745.3 5793.1 5799.5 5834.6 5835.8 5850.9 5577.3 5644.7 5666.3 5673.5 5681.1 04:34:28 INFO - PROCESS | 15559 | 04:34:28 INFO - PROCESS | 15559 | [#1] ext.html Cycles:180 Average:59006.96 Median:23875.47 stddev:115408.57 (483.4%) stddev-sans-first:115648.87 04:34:28 INFO - PROCESS | 15559 | Values: 555.5 566.7 577.6 578.7 581.7 42223.0 44276.6 44357.0 47196.3 47255.8 44977.6 45474.3 45513.8 45603.8 46001.0 8878.8 9016.5 9037.0 9041.5 9044.5 8825.8 8872.5 8960.9 8969.2 8987.9 8884.0 8917.7 8941.2 8946.0 8981.4 8899.2 8907.7 8939.9 8950.7 8953.4 8767.6 8896.6 8903.4 8971.6 8995.4 43092.4 43428.1 43450.6 43581.1 43589.0 3436.4 3439.5 3458.8 3510.0 3837.2 31892.4 32159.8 32732.8 32765.2 32902.2 4264.6 4287.2 4322.8 4373.2 4454.5 308261.0 309042.0 312277.0 313792.0 314353.0 56941.4 57974.0 58206.7 58246.0 58267.7 60626.4 60646.7 60675.4 60724.1 60793.7 16156.6 16157.6 16201.3 16222.8 16236.7 12263.0 12359.2 12409.6 12478.7 12540.1 16717.2 17294.8 17405.9 17409.0 17415.7 6033.0 6053.8 6120.5 6180.7 6227.4 865.9 954.9 955.4 999.1 1065.5 31202.5 31239.0 31606.8 31744.4 32009.7 1008.9 1022.3 1081.6 1102.3 1123.4 15389.5 15919.8 15994.6 16140.8 16284.0 512349.0 512741.0 514757.0 515602.0 517379.0 56792.7 57064.7 57202.4 57207.1 57352.4 1230.0 1250.0 1358.5 1364.4 1397.2 28020.4 29290.9 29752.6 31485.2 31854.4 54969.0 55454.7 55837.0 55868.2 55891.2 450259.0 454220.0 454714.0 455849.0 457536.0 27753.9 27951.7 28293.2 28777.3 28781.6 46177.8 46674.0 46896.5 47176.8 47751.5 39469.2 40051.2 41300.0 41742.0 41835.0 39526.6 39754.8 39896.6 41452.6 41637.8 35197.5 35514.3 40257.0 40377.6 41608.6 34352.8 37400.6 37484.4 38441.0 38779.0 26917.2 27213.5 27261.6 27398.6 27472.6 04:34:28 INFO - PROCESS | 15559 | 04:34:28 INFO - PROCESS | 15559 | [#2] jquery.html Cycles:180 Average:28804.20 Median:42013.40 stddev:81962.82 (195.1%) stddev-sans-first:82164.99 04:34:28 INFO - PROCESS | 15559 | Values: 399.1 405.4 408.2 413.1 424.6 13815.3 15188.6 18441.8 20311.3 20331.1 17899.5 19366.0 19388.4 19994.4 20214.0 5647.3 5659.4 5835.3 5849.1 5913.2 5766.1 5787.0 5824.1 5871.3 5871.7 5577.7 5654.3 5719.3 5742.1 5799.2 5623.2 5689.9 5746.1 5746.3 5776.5 4914.9 5158.3 5203.9 5280.8 5298.3 13843.5 14131.6 14143.2 14177.1 14202.9 2126.1 2143.0 2184.0 2238.8 2341.1 9467.1 9942.6 10331.1 10493.2 12872.8 1846.4 1949.5 1950.7 1950.8 2008.0 75999.0 83396.0 86644.6 91118.5 92417.5 11313.8 11316.2 11461.9 11510.8 11694.6 16199.8 16209.4 16230.6 16232.1 16284.7 7977.0 8004.4 8041.6 8234.7 8282.7 7549.8 7553.3 7743.8 7842.7 7980.7 4633.9 4694.9 4718.7 4815.8 5018.1 2005.3 2036.9 2053.6 2084.0 2089.1 851.7 882.5 952.0 980.2 1009.6 18666.9 19926.0 20084.4 20103.0 20277.6 906.6 968.7 980.1 983.6 997.3 8390.6 11121.6 11159.3 11166.9 11348.1 485941.0 489976.0 495728.0 498028.0 510954.0 85673.6 86253.7 95577.5 97435.0 99311.0 1031.2 1057.5 1058.2 1061.5 1072.3 17440.4 17730.5 17847.0 18016.6 18078.7 41413.2 41561.0 41964.8 42062.0 42244.6 53476.5 53615.9 55084.7 56954.7 59107.7 8157.3 8349.8 8360.2 8465.4 8562.2 9426.5 11801.7 11872.5 11916.7 12063.3 9748.0 10043.4 10191.4 10359.6 10570.8 10263.3 10413.6 10425.2 10433.2 10689.7 10063.0 10249.3 10266.0 10392.8 10734.1 7255.9 7633.4 7771.1 7778.5 7967.2 8124.2 9822.7 10520.5 10678.0 11181.4 04:34:28 INFO - PROCESS | 15559 | 04:34:28 INFO - PROCESS | 15559 | [#3] mootools.html Cycles:180 Average:5886.68 Median:2472.58 stddev:3468.97 (140.3%) stddev-sans-first:3462.70 04:34:28 INFO - PROCESS | 15559 | Values: 1453.4 1499.7 1655.3 1742.3 1796.5 8059.1 8288.8 8734.4 9305.6 9313.0 8663.2 8904.2 8912.2 9153.1 9179.4 2340.6 2372.3 2374.2 2375.0 2377.0 2338.8 2347.0 2402.8 2410.1 2418.3 2370.2 2382.9 2388.5 2404.7 2405.2 2288.4 2292.3 2301.5 2304.7 2361.9 2250.5 2283.2 2286.7 2288.5 2302.6 9282.5 9288.3 9292.3 9293.4 9331.1 5192.9 5258.2 5270.4 5332.4 5334.1 3284.9 3418.4 3455.6 3492.0 3527.7 1077.0 1110.4 1142.6 1166.3 1173.5 12929.2 12934.9 12945.1 12987.2 12995.6 4253.2 4523.4 4608.8 4655.0 4718.5 10635.7 10657.4 10671.5 10675.7 10681.9 5088.8 5128.0 5129.5 5144.5 5156.6 4349.2 4493.7 4741.2 4773.7 4854.1 3913.5 3917.3 3992.7 4099.7 4186.3 1320.2 1324.7 1333.2 1334.1 1338.2 825.2 904.0 918.8 921.8 925.4 5718.5 5745.1 5793.4 5794.8 5989.4 442.2 448.7 449.1 451.5 459.4 3724.8 3936.9 3937.9 3999.3 4035.4 11091.9 11380.4 11481.4 11588.5 11607.7 10928.2 10951.2 11480.4 11498.4 11515.0 8360.6 8484.7 8527.1 8530.6 8533.0 5543.6 5652.3 5663.9 5732.8 5751.8 10319.0 10372.2 10390.8 10577.8 10602.7 10315.8 10380.4 10423.8 10486.0 10585.7 7886.0 8050.6 8128.9 8426.0 8427.3 8516.6 8802.8 8814.9 8824.1 8831.6 7717.7 7736.5 7757.9 7848.0 7906.0 7579.7 7661.2 7729.0 7754.2 7782.3 7120.6 7124.1 7185.6 7204.8 7224.2 4784.1 4806.9 4852.9 4862.7 4868.6 5024.7 5086.6 5150.3 5200.3 5200.6 04:34:28 INFO - PROCESS | 15559 | 04:34:28 INFO - PROCESS | 15559 | [#4] prototype.html Cycles:180 Average:4651.72 Median:5160.58 stddev:1335.70 (25.9%) stddev-sans-first:1299.44 04:34:28 INFO - PROCESS | 15559 | Values: 328.3 334.0 348.4 351.5 352.2 5230.6 5401.7 5488.9 5577.9 5579.2 5219.0 5378.2 5398.2 5418.6 5444.4 4233.8 4295.8 4317.7 4338.6 4350.8 4226.0 4246.1 4314.0 4340.4 4341.8 4235.3 4237.9 4250.6 4254.0 4260.8 4230.5 4232.9 4261.9 4264.1 4267.1 3697.4 3841.3 3844.8 3851.6 3862.7 5205.3 5216.9 5226.2 5295.2 5303.8 4857.4 4861.9 4862.8 4867.1 4867.9 5457.3 5617.4 5645.3 5662.5 5706.2 4108.3 4111.0 4111.5 4111.8 4129.5 5786.6 5867.0 5873.9 5901.4 5903.5 4149.2 4261.7 4268.0 4279.8 4284.7 4253.1 4259.6 4277.0 4289.9 4293.4 4822.3 4830.2 4837.4 4852.8 4879.2 5497.9 5567.9 5664.2 5683.3 5692.3 1481.9 1512.8 1518.5 1527.9 1531.2 938.4 971.3 981.7 984.4 990.9 4808.9 4835.9 4837.5 4895.3 4901.7 4983.9 4992.4 5132.9 5150.5 5173.2 4741.3 4891.0 4912.4 4923.6 4965.5 2690.3 2704.4 2714.3 2718.3 2723.3 5214.6 5262.9 5295.7 5302.4 5320.0 4899.5 5170.7 5200.9 5217.3 5263.6 5232.6 5267.6 5289.9 5304.5 5308.3 5088.9 5090.1 5101.9 5120.3 5131.8 5056.9 5374.2 5793.8 5800.9 5814.4 6113.4 6168.6 6190.3 6196.3 6199.6 4029.5 4051.4 4104.3 4117.2 4206.3 5738.5 5760.6 5768.6 5826.8 5829.6 5541.2 5663.9 5678.4 5684.8 5685.2 5625.6 5636.5 5647.3 5678.7 5684.5 5568.7 5570.8 5611.8 5630.4 5656.3 5568.0 5690.9 5700.4 5719.3 5737.6 5589.2 5592.6 5604.9 5614.2 5618.0 04:34:28 INFO - PROCESS | 15559 | 04:34:28 INFO - PROCESS | 15559 | [#5] yui.html Cycles:180 Average:19520.72 Median:4524.06 stddev:27355.97 (604.7%) stddev-sans-first:27396.18 04:34:28 INFO - PROCESS | 15559 | Values: 693.0 738.1 739.5 775.2 816.3 14934.3 15721.7 15815.9 15840.1 15910.7 13432.7 13451.7 13464.3 13517.1 13588.7 795.3 812.7 812.8 815.0 815.2 798.1 799.5 799.6 802.3 802.8 852.6 855.4 855.8 856.8 858.8 839.3 843.8 844.3 847.8 849.1 630.1 631.5 631.6 632.4 635.0 13377.3 13455.2 13476.3 13560.0 13578.9 11509.6 12681.3 12967.9 13194.9 13592.4 12576.2 12663.2 12983.5 13337.7 13478.3 4479.3 4511.9 4513.6 4526.8 4591.0 83217.0 84446.6 84490.0 85133.0 86838.9 11152.4 11160.4 11229.2 11522.2 11585.8 20559.3 20565.3 20568.4 20580.4 20635.3 7792.2 7854.6 8033.4 8135.5 8158.3 4430.4 4522.5 4525.6 4557.0 4680.5 3355.8 3424.5 3466.4 3472.9 3485.0 609.2 610.1 624.1 624.3 643.5 573.4 640.3 654.4 657.7 663.6 8412.8 8721.3 8984.4 9130.8 9288.6 503.8 539.0 612.1 645.2 663.2 3968.6 4147.0 4200.3 4211.9 4331.4 68664.0 69329.0 69529.3 100033.0 104751.5 99341.5 101705.0 103405.0 103761.0 106104.5 53764.7 69388.0 86386.0 87777.0 90629.0 9056.8 9231.1 9366.6 9701.8 9702.5 47800.5 50814.0 51297.5 51972.5 53215.7 47548.0 47761.8 61508.4 71568.3 73401.6 12148.6 12855.3 12931.7 13062.7 13401.3 14271.4 14706.6 14867.7 14891.3 16402.7 12858.4 13288.3 13513.2 13926.8 14284.1 14171.9 14805.6 14892.1 15006.2 15112.3 12995.5 13648.7 14085.3 14096.7 14167.4 10758.6 11582.3 12051.5 12093.1 12419.1 11345.7 11944.3 11979.3 12039.3 12156.9 04:34:28 INFO - PROCESS | 15559 | -------- Summary: end -------- 04:34:28 INFO - PROCESS | 15559 | 04:34:29 INFO - TEST-INFO | 15559: exit 0 04:34:29 INFO - TEST-OK | dromaeo_css | took 1115362ms 04:34:29 INFO - TEST-START | kraken 04:34:29 INFO - operating with platform_type : linux_ 04:34:29 INFO - Initialising browser for kraken test... 04:34:29 INFO - TEST-INFO | started process 15926 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpB9Y2tq/profile http://localhost:42962/getInfo.html) 04:34:34 INFO - PROCESS | 15926 | __metrics Screen width/height:1600/1200 04:34:34 INFO - PROCESS | 15926 | colorDepth:24 04:34:34 INFO - PROCESS | 15926 | Browser inner width/height: 1024/697 04:34:34 INFO - PROCESS | 15926 | __metrics 04:34:34 ERROR - PROCESS | 15926 | JavaScript error: chrome://browser/content/tabbrowser.xml, line 3079: TypeError: this.tabs is undefined 04:34:35 INFO - TEST-INFO | 15926: exit 0 04:34:35 INFO - Browser initialized. 04:34:35 INFO - Running cycle 1/1 for kraken test... 04:34:35 INFO - TEST-INFO | started process 16049 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpB9Y2tq/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 04:34:47 INFO - PROCESS | 16049 | RSS: Main: 185614336 04:34:47 INFO - PROCESS | 16049 | 04:34:50 INFO - PROCESS | 16049 | Cycle 1(1): loaded http://localhost:42962/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:42962/tests/kraken/driver.html?testName=audio-beat-detection) 04:34:51 INFO - PROCESS | 16049 | RSS: Main: 199598080 04:34:51 INFO - PROCESS | 16049 | 04:34:54 INFO - PROCESS | 16049 | Cycle 1(1): loaded http://localhost:42962/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:42962/tests/kraken/driver.html?testName=audio-dft) 04:34:54 INFO - PROCESS | 16049 | RSS: Main: 197525504 04:34:54 INFO - PROCESS | 16049 | 04:34:57 INFO - PROCESS | 16049 | Cycle 1(1): loaded http://localhost:42962/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:42962/tests/kraken/driver.html?testName=audio-fft) 04:34:58 INFO - PROCESS | 16049 | RSS: Main: 193449984 04:34:58 INFO - PROCESS | 16049 | 04:35:00 INFO - PROCESS | 16049 | Cycle 1(1): loaded http://localhost:42962/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:42962/tests/kraken/driver.html?testName=audio-oscillator) 04:35:01 INFO - PROCESS | 16049 | RSS: Main: 194002944 04:35:01 INFO - PROCESS | 16049 | 04:35:03 INFO - PROCESS | 16049 | Cycle 1(1): loaded http://localhost:42962/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:42962/tests/kraken/driver.html?testName=imaging-gaussian-blur) 04:35:03 INFO - PROCESS | 16049 | RSS: Main: 194252800 04:35:03 INFO - PROCESS | 16049 | 04:35:06 INFO - PROCESS | 16049 | Cycle 1(1): loaded http://localhost:42962/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:42962/tests/kraken/driver.html?testName=imaging-darkroom) 04:35:07 INFO - PROCESS | 16049 | RSS: Main: 194592768 04:35:07 INFO - PROCESS | 16049 | 04:35:10 INFO - PROCESS | 16049 | Cycle 1(1): loaded http://localhost:42962/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:42962/tests/kraken/driver.html?testName=imaging-desaturate) 04:35:11 INFO - PROCESS | 16049 | RSS: Main: 192729088 04:35:11 INFO - PROCESS | 16049 | 04:35:14 INFO - PROCESS | 16049 | Cycle 1(1): loaded http://localhost:42962/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:42962/tests/kraken/driver.html?testName=json-parse-financial) 04:35:15 INFO - PROCESS | 16049 | RSS: Main: 193736704 04:35:15 INFO - PROCESS | 16049 | 04:35:16 INFO - PROCESS | 16049 | Cycle 1(1): loaded http://localhost:42962/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:42962/tests/kraken/driver.html?testName=json-stringify-tinderbox) 04:35:17 INFO - PROCESS | 16049 | RSS: Main: 193794048 04:35:17 INFO - PROCESS | 16049 | 04:35:19 INFO - PROCESS | 16049 | Cycle 1(1): loaded http://localhost:42962/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:42962/tests/kraken/driver.html?testName=stanford-crypto-aes) 04:35:19 INFO - PROCESS | 16049 | RSS: Main: 193781760 04:35:19 INFO - PROCESS | 16049 | 04:35:21 INFO - PROCESS | 16049 | Cycle 1(1): loaded http://localhost:42962/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:42962/tests/kraken/driver.html?testName=stanford-crypto-ccm) 04:35:22 INFO - PROCESS | 16049 | RSS: Main: 193839104 04:35:22 INFO - PROCESS | 16049 | 04:35:25 INFO - PROCESS | 16049 | Cycle 1(1): loaded http://localhost:42962/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:42962/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 04:35:25 INFO - PROCESS | 16049 | RSS: Main: 193056768 04:35:25 INFO - PROCESS | 16049 | 04:35:28 INFO - PROCESS | 16049 | Cycle 1(1): loaded http://localhost:42962/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:42962/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 04:35:29 INFO - PROCESS | 16049 | RSS: Main: 194674688 04:35:29 INFO - PROCESS | 16049 | 04:35:30 INFO - PROCESS | 16049 | Cycle 1(1): loaded http://localhost:42962/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:42962/tests/kraken/driver.html?testName=ai-astar) 04:35:31 INFO - PROCESS | 16049 | RSS: Main: 195575808 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | __start_tp_report 04:35:31 INFO - PROCESS | 16049 | _x_x_mozilla_page_load 04:35:31 INFO - PROCESS | 16049 | _x_x_mozilla_page_load_details 04:35:31 INFO - PROCESS | 16049 | |i|pagename|runs| 04:35:31 INFO - PROCESS | 16049 | |0;ai-astar;107;113;111;111;112;113;112;112;113;114 04:35:31 INFO - PROCESS | 16049 | |1;audio-beat-detection;154;125;126;174;126;126;129;124;157;127 04:35:31 INFO - PROCESS | 16049 | |2;audio-dft;163;164;162;165;166;161;160;164;162;160 04:35:31 INFO - PROCESS | 16049 | |3;audio-fft;78;76;75;100;77;77;75;76;112;77 04:35:31 INFO - PROCESS | 16049 | |4;audio-oscillator;82;81;126;82;81;82;103;82;82;110 04:35:31 INFO - PROCESS | 16049 | |5;imaging-gaussian-blur;118;118;118;117;117;118;118;119;119;119 04:35:31 INFO - PROCESS | 16049 | |6;imaging-darkroom;148;147;147;147;151;148;147;147;150;148 04:35:31 INFO - PROCESS | 16049 | |7;imaging-desaturate;98;97;96;96;96;97;97;96;96;96 04:35:31 INFO - PROCESS | 16049 | |8;json-parse-financial;52;57;53;56;54;53;56;53;55;55 04:35:31 INFO - PROCESS | 16049 | |9;json-stringify-tinderbox;62;62;61;61;61;60;62;60;60;64 04:35:31 INFO - PROCESS | 16049 | |10;stanford-crypto-aes;82;81;81;81;86;82;80;88;81;83 04:35:31 INFO - PROCESS | 16049 | |11;stanford-crypto-ccm;132;136;137;132;135;137;132;132;163;131 04:35:31 INFO - PROCESS | 16049 | |12;stanford-crypto-pbkdf2;175;176;170;172;176;172;170;168;166;172 04:35:31 INFO - PROCESS | 16049 | |13;stanford-crypto-sha256-iterative;73;67;67;67;66;66;67;66;65;67 04:35:31 INFO - PROCESS | 16049 | __end_tp_report 04:35:31 INFO - PROCESS | 16049 | __start_cc_report 04:35:31 INFO - PROCESS | 16049 | _x_x_mozilla_cycle_collect,747 04:35:31 INFO - PROCESS | 16049 | __end_cc_report 04:35:31 INFO - PROCESS | 16049 | __startTimestamp1475321731235__endTimestamp 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | ------- Summary: start ------- 04:35:31 INFO - PROCESS | 16049 | Number of tests: 14 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | [#0] ai-astar Cycles:10 Average:111.80 Median:112.50 stddev:1.93 (1.7%) stddev-sans-first:1.00 04:35:31 INFO - PROCESS | 16049 | Values: 107.0 113.0 111.0 111.0 112.0 113.0 112.0 112.0 113.0 114.0 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | [#1] audio-beat-detection Cycles:10 Average:136.80 Median:128.00 stddev:17.94 (14.0%) stddev-sans-first:17.92 04:35:31 INFO - PROCESS | 16049 | Values: 154.0 125.0 126.0 174.0 126.0 126.0 129.0 124.0 157.0 127.0 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | [#2] audio-dft Cycles:10 Average:162.70 Median:163.50 stddev:2.06 (1.3%) stddev-sans-first:2.18 04:35:31 INFO - PROCESS | 16049 | Values: 163.0 164.0 162.0 165.0 166.0 161.0 160.0 164.0 162.0 160.0 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | [#3] audio-fft Cycles:10 Average:82.30 Median:76.50 stddev:12.84 (16.8%) stddev-sans-first:13.53 04:35:31 INFO - PROCESS | 16049 | Values: 78.0 76.0 75.0 100.0 77.0 77.0 75.0 76.0 112.0 77.0 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | [#4] audio-oscillator Cycles:10 Average:91.10 Median:82.00 stddev:16.11 (19.6%) stddev-sans-first:16.74 04:35:31 INFO - PROCESS | 16049 | Values: 82.0 81.0 126.0 82.0 81.0 82.0 103.0 82.0 82.0 110.0 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | [#5] imaging-gaussian-blur Cycles:10 Average:118.10 Median:118.00 stddev:0.74 (0.6%) stddev-sans-first:0.78 04:35:31 INFO - PROCESS | 16049 | Values: 118.0 118.0 118.0 117.0 117.0 118.0 118.0 119.0 119.0 119.0 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | [#6] imaging-darkroom Cycles:10 Average:148.00 Median:148.00 stddev:1.41 (1.0%) stddev-sans-first:1.50 04:35:31 INFO - PROCESS | 16049 | Values: 148.0 147.0 147.0 147.0 151.0 148.0 147.0 147.0 150.0 148.0 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | [#7] imaging-desaturate Cycles:10 Average:96.50 Median:96.50 stddev:0.71 (0.7%) stddev-sans-first:0.50 04:35:31 INFO - PROCESS | 16049 | Values: 98.0 97.0 96.0 96.0 96.0 97.0 97.0 96.0 96.0 96.0 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | [#8] json-parse-financial Cycles:10 Average:54.40 Median:55.00 stddev:1.65 (3.0%) stddev-sans-first:1.50 04:35:31 INFO - PROCESS | 16049 | Values: 52.0 57.0 53.0 56.0 54.0 53.0 56.0 53.0 55.0 55.0 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | [#9] json-stringify-tinderbox Cycles:10 Average:61.30 Median:61.50 stddev:1.25 (2.0%) stddev-sans-first:1.30 04:35:31 INFO - PROCESS | 16049 | Values: 62.0 62.0 61.0 61.0 61.0 60.0 62.0 60.0 60.0 64.0 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | [#10] stanford-crypto-aes Cycles:10 Average:82.50 Median:82.00 stddev:2.55 (3.1%) stddev-sans-first:2.70 04:35:31 INFO - PROCESS | 16049 | Values: 82.0 81.0 81.0 81.0 86.0 82.0 80.0 88.0 81.0 83.0 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | [#11] stanford-crypto-ccm Cycles:10 Average:136.70 Median:135.50 stddev:9.52 (7.0%) stddev-sans-first:9.95 04:35:31 INFO - PROCESS | 16049 | Values: 132.0 136.0 137.0 132.0 135.0 137.0 132.0 132.0 163.0 131.0 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:171.70 Median:172.00 stddev:3.33 (1.9%) stddev-sans-first:3.32 04:35:31 INFO - PROCESS | 16049 | Values: 175.0 176.0 170.0 172.0 176.0 172.0 170.0 168.0 166.0 172.0 04:35:31 INFO - PROCESS | 16049 | 04:35:31 INFO - PROCESS | 16049 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:67.10 Median:67.00 stddev:2.18 (3.3%) stddev-sans-first:0.73 04:35:31 INFO - PROCESS | 16049 | Values: 73.0 67.0 67.0 67.0 66.0 66.0 67.0 66.0 65.0 67.0 04:35:31 INFO - PROCESS | 16049 | -------- Summary: end -------- 04:35:31 INFO - PROCESS | 16049 | 04:35:32 INFO - TEST-INFO | 16049: exit 0 04:35:32 INFO - TEST-OK | kraken | took 62651ms 04:35:32 INFO - SUITE-END | took 1178s 04:35:32 INFO - Completed test suite (00:19:38) 04:35:32 INFO - javascript benchmark 04:35:32 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"extraOptions": ["e10s"], "name": "dromaeo_css", "lowerIsBetter": false, "alertThreshold": 5.0, "value": 7162.145090780296, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3056.6332040155185, 3057.80124291921, 3074.246809531662, 3086.0433265687625, 3099.442100421923, 5211.5830733541225, 5409.702466364349, 5441.782328706847, 5451.754671039803, 5529.3364796224505, 5245.68525888446, 5419.891602167954, 5421.186821976706, 5492.148716948869, 5497.285352904117, 4916.754162291889, 4996.900061998758, 5009.674371165881, 5050.823221187259, 5073.061483625541, 5033.823816166435, 5079.2635067915135, 5100.948990510103, 5104.310918026056, 5109.69341839489, 4867.9269810952865, 4914.582260507861, 4932.358793356877, 4998.175301075336, 5037.2192310191795, 4921.040397122562, 4969.0, 4972.925406118875, 5019.824306149304, 5025.69845809249, 4874.341963834872, 4918.483559226265, 4932.432770231398, 4958.628102892298, 5000.04999050183, 5306.867328316785, 5355.571554275649, 5422.295101636762, 5440.265564148868, 5443.074677304868, 5709.77160913563, 5717.685527295997, 5747.597668163188, 5777.220075289824, 5793.478586927196, 5752.683602401867, 5755.971220143914, 5838.883222335529, 5846.093855452412, 5859.824205273849, 5369.27514785499, 5440.755166017539, 5446.183072539111, 5451.890962180813, 5460.890782184413, 5935.0207215808905, 5960.254968128984, 5964.045752679551, 5970.76116955317, 6069.393060693896, 5710.600257981901, 5723.0, 5779.566532509994, 5781.248437703071, 5789.160571717078, 5597.944020559824, 5631.746571404296, 5634.774609015675, 5884.352721200665, 5886.676232807236, 5778.248827652378, 5848.883022339614, 5860.443257890493, 5875.4124587541755, 5945.078512830518, 5881.647101173858, 5900.232969713909, 5902.2622172228475, 5906.8818623627285, 5912.113183022581, 4395.802188901507, 4515.887102822456, 4518.864434066983, 4536.727796332165, 4572.291294849304, 3940.5074365704286, 3943.467631869661, 3948.980255098706, 3994.8801535953967, 4067.2678917794487, 5542.889142217133, 5551.306086739158, 5578.832635020955, 5583.972080139573, 5584.553235741131, 5824.94175058244, 5856.765729370863, 5890.558208134407, 5895.29256489224, 5965.224520812267, 5376.516113549799, 5414.7834086636885, 5417.241586177938, 5447.0, 5477.4796394342475, 4928.728919909439, 4932.728699921467, 4935.284383764334, 4938.08645400602, 4941.851744447672, 5954.940450595439, 5957.851053723692, 5962.105684147413, 5963.224780778471, 5964.701764911737, 5744.569157313134, 5745.0, 5762.654240745569, 5762.798302059407, 5764.654120752768, 5913.58604897653, 5957.761689532544, 5963.493103086113, 5964.165016897551, 5974.522038237017, 5669.092945128759, 5680.545556355399, 5686.175504551899, 5686.914696279642, 5692.117721753135, 5750.878578677118, 5784.595078344475, 5890.4993075589055, 5894.086416605433, 5903.852403689943, 5718.199452076629, 5776.855578610568, 5786.1899334094105, 5792.82621521355, 5801.564882633735, 5667.603267771216, 5704.515116215002, 5734.741936612946, 5774.335951365647, 5788.565857560784, 5619.80330688424, 5654.519365853948, 5656.3495198051105, 5702.6863522505, 5745.253117094751, 5793.073108302651, 5799.4780469757925, 5834.562407819515, 5835.79574714883, 5850.853728656818, 5577.330720313588, 5644.6613203207935, 5666.263385759825, 5673.461021202979, 5681.119426488901], "value": 5370.527344210209, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [555.4972749661556, 566.6515093217672, 577.5697105656285, 578.6585914310556, 581.7498475655469, 42223.0, 44276.557234427644, 44356.999999999956, 47196.2920556192, 47255.76372118135, 44977.55022449775, 45474.31788523175, 45513.772431137884, 45603.77198114013, 46001.0, 8878.77803054924, 9016.459012459274, 9037.0, 9041.457512549236, 9044.502552359618, 8825.823483530325, 8872.467651940871, 8960.910390896106, 8969.237614802749, 8987.910120898772, 8884.0, 8917.68788092417, 8941.195292423681, 8946.031872987965, 8981.371304008722, 8899.199072083478, 8907.68823091192, 8939.865902011476, 8950.686725964593, 8953.373263871532, 8767.561621918878, 8896.644134234622, 8903.421277616933, 8971.596278167499, 8995.415298005673, 43092.35361469581, 43428.13143737139, 43450.56549434497, 43581.12837743259, 43589.0, 3436.398630239723, 3439.466882633171, 3458.8443520041405, 3509.9649003509894, 3837.1558257183374, 31892.362152756814, 32159.839200803846, 32732.836335818407, 32765.18087047819, 32902.177445563815, 4264.637505811978, 4287.164003019412, 4322.805473753689, 4373.169097871394, 4454.465464144323, 308261.0, 309042.0, 312277.0, 313792.0, 314353.0, 56941.43058569444, 57974.0, 58206.70896645574, 58246.0, 58267.70866145642, 60626.39373606296, 60646.69676651589, 60675.393246067855, 60724.08913866295, 60793.69603151956, 16156.596085097966, 16157.59606009859, 16201.270942807601, 16222.756658650129, 16236.675266494603, 12263.0, 12359.196652217577, 12409.62771116868, 12478.688032799071, 12540.05949553769, 16717.164141792862, 17294.82705172932, 17405.912970435067, 17409.0, 17415.73876391855, 6032.969835150796, 6053.788117415869, 6120.469882529368, 6180.690965451709, 6227.377262273736, 865.8701194820701, 954.9188318992824, 955.3551352836807, 999.0858364596313, 1065.4832406282947, 31202.53196202059, 31239.0, 31606.841965790023, 31744.36511269808, 32009.679903201137, 1008.9445080520495, 1022.3201570955232, 1081.561967403203, 1102.2780079048237, 1123.4045955643358, 15389.461368852037, 15919.761203581955, 15994.600134996486, 16140.757888631446, 16284.016577620117, 512349.0, 512741.0, 514757.0, 515602.0, 517379.0, 56792.71603641955, 57064.71467642635, 57202.427975720544, 57207.14189287164, 57352.42647573554, 1229.975400491985, 1250.031225799994, 1358.5380970470087, 1364.379207460603, 1397.224540380099, 28020.439591207654, 29290.85354573299, 29752.55371169391, 31485.212869678442, 31854.36291274208, 54969.0, 55454.72272638611, 55837.0, 55868.16197756956, 55891.16163257473, 450259.0, 454220.0, 454714.0, 455849.0, 457536.0, 27753.861230693718, 27951.72048279491, 28293.15120546387, 28777.280567985967, 28781.56827647545, 46177.769111155576, 46674.0, 46896.531034689215, 47176.76411618057, 47751.5224847761, 39469.21061578695, 40051.198976020896, 41299.96750081272, 41742.0, 41835.0, 39526.60473395344, 39754.80122599369, 39896.60103398929, 41452.58547414487, 41637.79181104075, 35197.472037919964, 35514.28971420609, 40257.0, 40377.596224038556, 41608.583914160474, 34352.82823585866, 37400.6259937408, 37484.43773343456, 38441.0, 38779.0, 26917.192484225503, 27213.455730884874, 27261.59107613427, 27398.589021164298, 27472.58791118175], "value": 19763.845713866693, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [399.1179493319763, 405.4323946474935, 408.218262028216, 413.0726518964924, 424.62208634315465, 13815.342158940915, 15188.620284492894, 18441.815581844196, 20311.289104881314, 20331.085101170447, 17899.463016109537, 19366.0, 19388.418347449562, 19994.400167994947, 20214.0, 5647.322321321447, 5659.4340565943385, 5835.328937172216, 5849.093390524476, 5913.231279933624, 5766.135079738052, 5787.0, 5824.097264923944, 5871.266091738533, 5871.677057761822, 5577.6653400796085, 5654.264945557072, 5719.342275638313, 5742.052561327376, 5799.246098007275, 5623.212750214973, 5689.9146512802345, 5746.109353050284, 5746.310442746897, 5776.451237132465, 4914.852554423373, 5158.277841102249, 5203.895922081575, 5280.788768449257, 5298.258243845865, 13843.515476958259, 14131.646708832259, 14143.151410915276, 14177.14937103777, 14202.928985355007, 2126.107035045269, 2142.996298460944, 2184.049938276839, 2238.798508134276, 2341.0869760793303, 9467.147956683863, 9942.552585133686, 10331.121854642364, 10493.213009024277, 12872.806907896389, 1846.4183782108594, 1949.4541528371938, 1950.6878899376031, 1950.756155480565, 2007.9698804517798, 75999.0, 83396.0, 86644.56677716572, 91118.54440727754, 92417.53791231068, 11313.83029254562, 11316.20786544934, 11461.911118443735, 11510.827337589943, 11694.590689325832, 16199.757003644954, 16209.351625935067, 16230.594235144215, 16232.107234102237, 16284.674306513803, 7977.0, 8004.399670024772, 8041.557714325651, 8234.670613175525, 8282.71010514629, 7549.849003020019, 7553.32020118192, 7743.806404839811, 7842.686292548348, 7980.720674776355, 4633.930491042637, 4694.859154225379, 4718.693284936468, 4815.807367705253, 5018.146915024382, 2005.2680771518292, 2036.9388918332475, 2053.6098141353095, 2083.9791602084088, 2089.122568521225, 851.6976473351995, 882.4749274181852, 951.9952400238093, 980.2158273381267, 1009.5759780892043, 18666.906665466584, 19926.0, 20084.397468075982, 20102.99485025772, 20277.594448110955, 906.6373450619805, 968.651285537206, 980.122790102854, 983.5770618633914, 997.2620261006948, 8390.580470976427, 11121.610743623934, 11159.330440173615, 11166.888331116585, 11348.14888883337, 485941.0, 489976.0, 495728.0, 498028.0, 510954.0, 85673.57163214144, 86253.68731563522, 95577.522112389, 97435.0, 99311.0, 1031.200819364998, 1057.5241141486363, 1058.2222066781064, 1061.4692653673164, 1072.2547829258747, 17440.389586364417, 17730.468085957444, 17847.0, 18016.639667206844, 18078.728819067463, 41413.1717365657, 41560.95806947831, 41964.790176048926, 42062.0, 42244.577554224066, 53476.46523534715, 53615.90648888349, 55084.72457637847, 56954.7152264236, 59107.70446147742, 8157.306628936607, 8349.83300334002, 8360.163983601591, 8465.407421480684, 8562.229399354088, 9426.481543514898, 11801.704957376134, 11872.525098995944, 11916.702082448008, 12063.336516491678, 9748.0, 10043.397396156253, 10191.388516689023, 10359.63741269052, 10570.841437378293, 10263.281570290008, 10413.583456661649, 10425.218108641731, 10433.165346772088, 10689.732756681145, 10063.0, 10249.33379330341, 10266.0, 10392.844107338246, 10734.14126869833, 7255.891161632474, 7633.427492937941, 7771.145174030965, 7778.49439786412, 7967.203279672218, 8124.22819832115, 9822.65620703272, 10520.526576303932, 10678.0, 11181.385023823443], "value": 8911.128880775339, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1453.4258967707756, 1499.7150541397136, 1655.3130450862893, 1742.2769550636488, 1796.5329014456245, 8059.113497515269, 8288.792780180484, 8734.432261902979, 9305.581248843793, 9313.0, 8663.220310172082, 8904.243139333148, 8912.197902188802, 9153.08469153086, 9179.357444978854, 2340.6137987232087, 2372.3120295114395, 2374.1809075868796, 2374.976250237493, 2377.0372998935372, 2338.777816107467, 2346.9765302346927, 2402.8197885158597, 2410.0841680161516, 2418.286605451396, 2370.2059809963685, 2382.9046838126455, 2388.534235824015, 2404.651325557793, 2405.218304051182, 2288.4438581764393, 2292.266474728071, 2301.528186721718, 2304.700388949434, 2361.8700971446565, 2250.5161390301, 2283.223703940668, 2286.6570014497793, 2288.4622113803243, 2302.5970455170277, 9282.535873206312, 9288.303377246666, 9292.256619470427, 9293.395929264643, 9331.113544213356, 5192.896142077175, 5258.1849813279005, 5270.367555893279, 5332.440093790174, 5334.0665383557725, 3284.901452956391, 3418.418868792311, 3455.568053993251, 3491.9650803491895, 3527.735419843522, 1076.95692172313, 1110.3837370259503, 1142.6229344316355, 1166.2535976974743, 1173.530587764901, 12929.159604625764, 12934.935325323313, 12945.093843430963, 12987.155834870704, 12995.610131696065, 4253.234417804825, 4523.36672865799, 4608.815647374067, 4654.976725116353, 4718.457377401574, 10635.734106647396, 10657.413842238751, 10671.466426678635, 10675.679729608124, 10681.946590266998, 5088.847334579968, 5127.974360128175, 5129.461406552333, 5144.511271429208, 5156.639035267495, 4349.217140914602, 4493.662975276802, 4741.217699079613, 4773.737444440589, 4854.077725232195, 3913.4521167036637, 3917.334053210961, 3992.680585553149, 4099.713020088565, 4186.309258972296, 1320.2078752748275, 1324.715186234945, 1333.200079952021, 1334.0794851552398, 1338.1636477201748, 825.2366560931115, 903.9819203615891, 918.8437965545874, 921.8432866412726, 925.3707478914268, 5718.549470228274, 5745.1382292656435, 5793.362730099686, 5794.797182098607, 5989.431004054608, 442.18417020596945, 448.67919437602274, 449.1062785057712, 451.4920714196529, 459.3546067774782, 3724.765140915429, 3936.9212615748097, 3937.8621748239248, 3999.3001224786126, 4035.414864844581, 11091.944540277409, 11380.374079425712, 11481.425928703531, 11588.478518466689, 11607.6517704469, 10928.235023548275, 10951.233413661126, 11480.368579728029, 11498.42507874603, 11515.0, 8360.58197090143, 8484.660613575512, 8527.062023177445, 8530.616122274512, 8533.0, 5543.584231182596, 5652.265205523256, 5663.915041274302, 5732.828015159552, 5751.798687045934, 10318.968103189622, 10372.17022638172, 10390.844137338097, 10577.788444230919, 10602.681919542427, 10315.793684126425, 10380.429076400871, 10423.843642345522, 10486.0, 10585.682429527127, 7886.0, 8050.637721302438, 8128.918710813053, 8425.95787021061, 8427.283680887193, 8516.616752246287, 8802.779930501532, 8814.867776983223, 8824.073472285574, 8831.558422078999, 7717.652705628372, 7736.4584479085925, 7757.92242077572, 7848.0, 7906.0, 7579.696812127453, 7661.15727270011, 7728.961355193413, 7754.224577542201, 7782.260685234894, 7120.572765634079, 7124.145102587722, 7185.640717964186, 7204.783856484314, 7224.169220539705, 4784.138855006132, 4806.927896081492, 4852.902941941212, 4862.7325497098, 4868.610511159028, 5024.698518088926, 5086.64393492452, 5150.304708864405, 5200.271961925409, 5200.557952574073], "value": 4589.721174349607, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [328.34837859827206, 333.99999999999994, 348.39901170480914, 351.52017496117776, 352.16009816587433, 5230.607704422174, 5401.70290634015, 5488.862778430536, 5577.944220557798, 5579.163125531168, 5218.973905130479, 5378.2470454136455, 5398.190271459273, 5418.6379964128955, 5444.373897001846, 4233.830646774133, 4295.7852107394665, 4317.661524927267, 4338.609525142737, 4350.847720329789, 4225.9788701056605, 4246.108317253365, 4313.978430107845, 4340.43574335336, 4341.826326946918, 4235.258829704805, 4237.936430953539, 4250.574942505756, 4254.0, 4260.7656578888145, 4230.534641189467, 4232.862404485746, 4261.936070958938, 4264.1471705659, 4267.125239325931, 3697.4084146536693, 3841.327767640652, 3844.75009124406, 3851.595582463829, 3862.7489213201334, 5205.349331333583, 5216.8695782605355, 5226.1778639534605, 5295.152775555931, 5303.840884773463, 4857.441394239637, 4861.854144375674, 4862.829800956985, 4867.123917694814, 4867.8783030424165, 5457.317835270591, 5617.4382561743905, 5645.294338207724, 5662.546996240291, 5706.201131841545, 4108.342665173588, 4110.979445102786, 4111.48606424197, 4111.835526578933, 4129.504459464853, 5786.623869448473, 5867.0, 5873.882522349571, 5901.380355062743, 5903.527717782567, 4149.1578268885905, 4261.700181444628, 4267.978660106742, 4279.807408666617, 4284.657227421799, 4253.128108737701, 4259.552746961586, 4277.016286254179, 4289.91420171601, 4293.3989241506215, 4822.348982887265, 4830.178869592178, 4837.395325584302, 4852.8301509447, 4879.243717223836, 5497.945020549823, 5567.944320556823, 5664.235328230636, 5683.318001839806, 5692.31692196939, 1481.9333130009175, 1512.780646806229, 1518.476125736619, 1527.8854085943376, 1531.1731664901051, 938.3619138985418, 971.2909576009412, 981.71395471932, 984.4044353166374, 990.8612794208816, 4808.8797780055775, 4835.854924352275, 4837.516248375205, 4895.339129217581, 4901.730404827697, 4983.9252411213865, 4992.350994370709, 5132.897342053138, 5150.48495150482, 5173.224016397495, 4741.340530814256, 4890.975545122323, 4912.435069966999, 4923.606111511142, 4965.47862474435, 2690.3274181454635, 2704.350955770601, 2714.3078514978947, 2718.334008167972, 2723.2783312422225, 5214.601283409598, 5262.894742105136, 5295.72283917919, 5302.416734159239, 5319.973400132974, 4899.510048995072, 5170.681476223539, 5200.92198617021, 5217.295665085241, 5263.605229607795, 5232.607554433433, 5267.629566695003, 5289.942011597619, 5304.549113325334, 5308.256844041837, 5088.888111433714, 5090.134677104827, 5101.872453188552, 5120.26066054659, 5131.769070391916, 5056.9013859248, 5374.247605335335, 5793.826185214281, 5800.883982320414, 5814.418558144152, 6113.388661134029, 6168.599041062316, 6190.288116866438, 6196.256449226122, 6199.628022318495, 4029.5164580250557, 4051.39229115635, 4104.302268614402, 4117.155983023533, 4206.348016057516, 5738.512226460631, 5760.646248131769, 5768.567357448124, 5826.76692932278, 5829.59192856496, 5541.196526503554, 5663.858403539944, 5678.375378708256, 5684.8010319638615, 5685.175649530712, 5625.606207565431, 5636.464535869086, 5647.29408823897, 5678.659280443187, 5684.488396044376, 5568.716826101441, 5570.777168913198, 5611.775528978958, 5630.4369563045, 5656.2929633795775, 5568.0, 5690.914636280542, 5700.401457846866, 5719.28508936383, 5737.569682273763, 5589.161625756169, 5592.636478628876, 5604.8879022418505, 5614.24207731951, 5618.0], "value": 4232.8812901928495, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [692.9514933954625, 738.1253214940297, 739.5045319635846, 775.2054144501885, 816.297983733989, 14934.25328733563, 15721.720350549163, 15815.920920395381, 15840.128792916385, 15910.681786364266, 13432.66418339542, 13451.730965380686, 13464.326783660827, 13517.121387109832, 13588.660283492918, 795.252462685077, 812.695239285268, 812.772423721359, 814.9714759983402, 815.1725998111921, 798.1499702816511, 799.532273619933, 799.6121880887765, 802.2939812964612, 802.7993001749562, 852.6461518469828, 855.4311382930343, 855.7603870916154, 856.7858035491128, 858.8024754306513, 839.2656425627575, 843.843888880559, 844.2907957315854, 847.7965288330818, 849.0999540487103, 630.0737915264599, 631.5137344244906, 631.5863109663178, 632.4150161100963, 635.0188958059808, 13377.331133443386, 13455.192688438725, 13476.25880576568, 13560.0, 13578.864211357859, 11509.5971640993, 12681.302528360937, 12967.935160324232, 13194.934025329909, 13592.388342524511, 12576.245425274421, 12663.240205587694, 12983.522668107917, 13337.733245335136, 13478.258695771827, 4479.3057076153245, 4511.932321015187, 4513.638908887281, 4526.818927242906, 4590.977045114786, 83217.0, 84446.57776711139, 84490.0, 85133.0, 86838.92127551074, 11152.386618736047, 11160.441977901073, 11229.157813164045, 11522.193446458836, 11585.768284634429, 20559.280425185047, 20565.280215192397, 20568.382948511568, 20580.382588522367, 20635.277765278144, 7792.220777922163, 7854.607269636495, 8033.3974951878845, 8135.511869287861, 8158.306543943712, 4430.401895744033, 4522.525134860858, 4525.592696657251, 4557.0, 4680.508546602626, 3355.8489867956, 3424.4520876660113, 3466.4280393735257, 3472.8958131256104, 3484.982575087108, 609.1715267236555, 610.0940103945637, 624.0639041437843, 624.3382015064046, 643.4755674125572, 573.4007961680054, 640.286081019669, 654.4273760459598, 657.6547312660891, 663.5521023309343, 8412.789680258042, 8721.345899057596, 8984.416012959136, 9130.81738365229, 9288.628454861864, 503.8261799679105, 538.9974647156287, 612.1063247658379, 645.2192846655505, 663.2339647706906, 3968.6031396860662, 4146.979265103655, 4200.327947528381, 4211.936820947688, 4331.4152589400655, 68664.0, 69329.0, 69529.30470695329, 100033.0, 104751.47624261983, 99341.50329248451, 101705.0, 103405.0, 103761.0, 106104.46947765212, 53764.73117634465, 69388.0, 86386.0, 87777.0, 90629.0, 9056.773580660536, 9231.123043310874, 9366.641836933743, 9701.805963880543, 9702.499325451823, 47800.52199477961, 50814.0, 51297.487025129274, 51972.48027519828, 53215.733921330146, 47548.0, 47761.76119119382, 61508.384916152056, 71568.28431715617, 73401.6329918347, 12148.574799881962, 12855.29295888735, 12931.741365172831, 13062.673433164247, 13401.262930538524, 14271.357788899317, 14706.63233419173, 14867.702645946803, 14891.255437228312, 16402.671946560764, 12858.357082146042, 13288.335583220995, 13513.189208647513, 13926.791098133739, 14284.142951422948, 14171.858281417053, 14805.629859253604, 14892.106473611619, 15006.2496875158, 15112.319945602254, 12995.48018079304, 13648.727025459237, 14085.295735213404, 14096.718065638835, 14167.362468688727, 10758.645340005336, 11582.336936172069, 12051.469191469889, 12093.09301802386, 12419.130660853654, 11345.716357091138, 11944.283342999448, 11979.28124312544, 12039.337836419081, 12156.878431215928], "value": 7344.649753591607, "unit": "score"}]}, {"extraOptions": ["e10s"], "name": "kraken", "lowerIsBetter": true, "alertThreshold": 2.0, "value": 1521.0, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [107.0, 113.0, 111.0, 111.0, 112.0, 113.0, 112.0, 112.0, 113.0, 114.0], "value": 111.8, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [154.0, 125.0, 126.0, 174.0, 126.0, 126.0, 129.0, 124.0, 157.0, 127.0], "value": 136.8, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [163.0, 164.0, 162.0, 165.0, 166.0, 161.0, 160.0, 164.0, 162.0, 160.0], "value": 162.7, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [78.0, 76.0, 75.0, 100.0, 77.0, 77.0, 75.0, 76.0, 112.0, 77.0], "value": 82.3, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 81.0, 126.0, 82.0, 81.0, 82.0, 103.0, 82.0, 82.0, 110.0], "value": 91.1, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 118.0, 118.0, 117.0, 117.0, 118.0, 118.0, 119.0, 119.0, 119.0], "value": 118.1, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [148.0, 147.0, 147.0, 147.0, 151.0, 148.0, 147.0, 147.0, 150.0, 148.0], "value": 148.0, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [98.0, 97.0, 96.0, 96.0, 96.0, 97.0, 97.0, 96.0, 96.0, 96.0], "value": 96.5, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [52.0, 57.0, 53.0, 56.0, 54.0, 53.0, 56.0, 53.0, 55.0, 55.0], "value": 54.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [62.0, 62.0, 61.0, 61.0, 61.0, 60.0, 62.0, 60.0, 60.0, 64.0], "value": 61.3, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 81.0, 81.0, 81.0, 86.0, 82.0, 80.0, 88.0, 81.0, 83.0], "value": 82.5, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [132.0, 136.0, 137.0, 132.0, 135.0, 137.0, 132.0, 132.0, 163.0, 131.0], "value": 136.7, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [175.0, 176.0, 170.0, 172.0, 176.0, 172.0, 170.0, 168.0, 166.0, 172.0], "value": 171.7, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [73.0, 67.0, 67.0, 67.0, 66.0, 66.0, 67.0, 66.0, 65.0, 67.0], "value": 67.1, "unit": "score"}]}]} 04:35:32 INFO - Return code: 0 04:35:33 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 04:35:33 ERROR - # TBPL SUCCESS # 04:35:33 INFO - Running post-action listener: _resource_record_post_action 04:35:33 INFO - [mozharness: 2016-10-01 11:35:33.033054Z] Finished run-tests step (success) 04:35:33 INFO - Running post-run listener: _resource_record_post_run 04:35:33 INFO - Total resource usage - Wall time: 1196s; CPU: 13.0%; Read bytes: 4096; Write bytes: 403955712; Read time: 8; Write time: 245224 04:35:33 INFO - TinderboxPrint: CPU usage
13.4% 04:35:33 INFO - TinderboxPrint: I/O read bytes / time
4,096 / 8 04:35:33 INFO - TinderboxPrint: I/O write bytes / time
403,955,712 / 245,224 04:35:33 INFO - TinderboxPrint: CPU idle
8,260.1 (86.6%) 04:35:33 INFO - TinderboxPrint: CPU user
1,215.0 (12.7%) 04:35:33 INFO - TinderboxPrint: Swap in / out
0 / 0 04:35:33 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 114458624; Read time: 0; Write time: 61516 04:35:33 INFO - run-tests - Wall time: 1179s; CPU: 13.0%; Read bytes: 0; Write bytes: 288595968; Read time: 0; Write time: 183680 04:35:33 INFO - Running post-run listener: _upload_blobber_files 04:35:33 INFO - Blob upload gear active. 04:35:33 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 04:35:33 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 04:35:33 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Firefox', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 04:35:33 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Firefox -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 04:35:34 INFO - (blobuploader) - INFO - Open directory for files ... 04:35:34 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_errorsummary.log ... 04:35:34 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:35:34 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:35:34 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_errorsummary.log: uploaded 04:35:34 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:35:34 INFO - (blobuploader) - INFO - Done attempting. 04:35:34 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs-e10s_raw.log ... 04:35:34 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:35:34 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:35:35 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs-e10s_raw.log: uploaded 04:35:35 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:35:35 INFO - (blobuploader) - INFO - Done attempting. 04:35:35 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 04:35:35 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 04:35:35 INFO - (blobuploader) - INFO - Uploading, attempt #1. 04:35:38 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 04:35:38 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 04:35:38 INFO - (blobuploader) - INFO - Done attempting. 04:35:38 INFO - (blobuploader) - INFO - Iteration through files over. 04:35:38 INFO - Return code: 0 04:35:38 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 04:35:38 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 04:35:38 INFO - Setting buildbot property blobber_files to {"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f567eb13615789364469bce1fca67c31abf186ab2248fd64dc735bc52e94cca0f756cb9b3da94b3453a5997176758fc094eeef6f4510d20ec10639f0ee81b0a4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b90372328931da94049455ebf5cf1478feac1a3f72af2e83da45b1c452677e5bd97dd5d7d372e5eb110e61b9610fe7290635284921222b4b0252d0292841aa04", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/221ecda4a8f3d77961107a9c28e90cf92a60841cb81ff11afbcb661074d3e02b802bda04da204b2d928e85ab1b60a81d69a7c222e3bd992799ff9d7274aa816a"} 04:35:38 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 04:35:38 INFO - Writing to file /builds/slave/test/properties/blobber_files 04:35:38 INFO - Contents: 04:35:38 INFO - blobber_files:{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f567eb13615789364469bce1fca67c31abf186ab2248fd64dc735bc52e94cca0f756cb9b3da94b3453a5997176758fc094eeef6f4510d20ec10639f0ee81b0a4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b90372328931da94049455ebf5cf1478feac1a3f72af2e83da45b1c452677e5bd97dd5d7d372e5eb110e61b9610fe7290635284921222b4b0252d0292841aa04", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/221ecda4a8f3d77961107a9c28e90cf92a60841cb81ff11afbcb661074d3e02b802bda04da204b2d928e85ab1b60a81d69a7c222e3bd992799ff9d7274aa816a"} 04:35:38 INFO - Running post-run listener: copy_logs_to_upload_dir 04:35:38 INFO - Copying logs to upload dir... 04:35:38 INFO - mkdir: /builds/slave/test/build/upload/logs 04:35:38 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1238.808753 ========= master_lag: 0.01 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 38 secs) (at 2016-10-01 04:35:38.639527) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-01 04:35:38.643673) ========= 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=523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728 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/Firefox/sha512/f567eb13615789364469bce1fca67c31abf186ab2248fd64dc735bc52e94cca0f756cb9b3da94b3453a5997176758fc094eeef6f4510d20ec10639f0ee81b0a4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b90372328931da94049455ebf5cf1478feac1a3f72af2e83da45b1c452677e5bd97dd5d7d372e5eb110e61b9610fe7290635284921222b4b0252d0292841aa04", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/221ecda4a8f3d77961107a9c28e90cf92a60841cb81ff11afbcb661074d3e02b802bda04da204b2d928e85ab1b60a81d69a7c222e3bd992799ff9d7274aa816a"} build_url:https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2 program finished with exit code 0 elapsedTime=0.011525 build_url: 'https://queue.taskcluster.net/v1/task/Mn-3VXCkSkGBvPSc2eHxUw/artifacts/public/build/firefox-52.0a1.en-US.linux-x86_64.tar.bz2' blobber_files: '{"dromaeojs-e10s_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/f567eb13615789364469bce1fca67c31abf186ab2248fd64dc735bc52e94cca0f756cb9b3da94b3453a5997176758fc094eeef6f4510d20ec10639f0ee81b0a4", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/b90372328931da94049455ebf5cf1478feac1a3f72af2e83da45b1c452677e5bd97dd5d7d372e5eb110e61b9610fe7290635284921222b4b0252d0292841aa04", "dromaeojs-e10s_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Firefox/sha512/221ecda4a8f3d77961107a9c28e90cf92a60841cb81ff11afbcb661074d3e02b802bda04da204b2d928e85ab1b60a81d69a7c222e3bd992799ff9d7274aa816a"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2016-10-01 04:35:38.673871) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-01 04:35:38.674653) ========= 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=523ca41ca1e0623de333ad52000001bf-1475319486.731121-97065728 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004523 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2016-10-01 04:35:38.757506) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-01 04:35:38.758336) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2016-10-01 04:35:38.759101) ========= ========= Total master_lag: 0.18 =========