builder: mozilla-aurora_ubuntu64_hw_test-dromaeojs-pgo slave: talos-linux64-ix-002 starttime: 1485504335.92 results: success (0) revision: cceb7f61ef17d0c10d42f4e4a9820d40cc46528d ========= Started set props: master (results: 0, elapsed: 0 secs) (at 2017-01-27 00:05:35.921138) ========= master: http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/ ========= Finished set props: master (results: 0, elapsed: 0 secs) (at 2017-01-27 00:05:35.921680) ========= ========= Started downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-01-27 00:05:35.922024) ========= ========= Finished downloading to buildprops.json (results: 0, elapsed: 0 secs) (at 2017-01-27 00:05:35.938960) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-01-27 00:05:35.939281) ========= 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=a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False --2017-01-27 00:05:36-- 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: 12179 (12K) [text/x-python] Saving to: `archiver_client.py' 0K .......... . 100% 42.4M=0s 2017-01-27 00:05:36 (42.4 MB/s) - `archiver_client.py' saved [12179/12179] program finished with exit code 0 elapsedTime=0.085605 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-01-27 00:05:36.038808) ========= ========= Started 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-01-27 00:05:36.039195) ========= 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=a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.018753 ========= master_lag: 0.03 ========= ========= Finished 'rm -rf ...' (results: 0, elapsed: 0 secs) (at 2017-01-27 00:05:36.088879) ========= ========= Started 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-01-27 00:05:36.089250) ========= bash -c 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev cceb7f61ef17d0c10d42f4e4a9820d40cc46528d --destination scripts --debug' in dir /builds/slave/test/. (timeout 1200 secs) watching logfiles {} argv: ['bash', '-c', 'python archiver_client.py mozharness --repo releases/mozilla-aurora --rev cceb7f61ef17d0c10d42f4e4a9820d40cc46528d --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=a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 2017-01-27 00:05:36,453 truncating revision to first 12 chars 2017-01-27 00:05:36,453 Setting DEBUG logging. 2017-01-27 00:05:36,453 attempt 1/10 2017-01-27 00:05:36,453 Getting archive location from https://api.pub.build.mozilla.org/archiver/hgmo/releases/mozilla-aurora/cceb7f61ef17?&preferred_region=us-west-2&suffix=tar.gz&subdir=testing/mozharness 2017-01-27 00:05:36,891 unpacking tar archive at: mozilla-aurora-cceb7f61ef17/testing/mozharness/ program finished with exit code 0 elapsedTime=0.794567 ========= master_lag: 0.01 ========= ========= Finished 'bash -c ...' (results: 0, elapsed: 0 secs) (at 2017-01-27 00:05:36.897193) ========= ========= Started set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-01-27 00:05:36.897555) ========= script_repo_revision: cceb7f61ef17d0c10d42f4e4a9820d40cc46528d ========= Finished set props: script_repo_revision (results: 0, elapsed: 0 secs) (at 2017-01-27 00:05:36.898010) ========= ========= Started downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-01-27 00:05:36.898322) ========= ========= Finished downloading to oauth.txt (results: 0, elapsed: 0 secs) (at 2017-01-27 00:05:36.908598) ========= ========= Started '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 39 secs) (at 2017-01-27 00:05:36.908935) ========= /tools/buildbot/bin/python scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora in dir /builds/slave/test/. (timeout 3600 secs) (maxTime 7200 secs) watching logfiles {} argv: ['/tools/buildbot/bin/python', 'scripts/scripts/talos_script.py', '--suite', 'dromaeojs', '--add-option', '--webServer,localhost', '--branch-name', 'Mozilla-Aurora', '--cfg', 'talos/linux_config.py', '--download-symbols', 'ondemand', '--use-talos-json', '--blob-upload-branch', 'Mozilla-Aurora'] environment: DISPLAY=:0 HOME=/home/cltbld LANG=en_US.UTF-8 LANGUAGE=en_US:en LOGNAME=cltbld MAIL=/var/mail/cltbld MOZ_CRASHREPORTER_NO_REPORT=1 MOZ_NO_REMOTE=1 NODE_PATH=/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript NO_EM_RESTART=1 PATH=/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games PROPERTIES_FILE=/builds/slave/test/buildprops.json PWD=/builds/slave/test SHELL=/bin/bash SHLVL=1 TERM=linux TMOUT=86400 USER=cltbld XDG_SESSION_COOKIE=a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False 00:05:37 INFO - MultiFileLogger online at 20170127 00:05:37 in /builds/slave/test 00:05:37 INFO - Run as scripts/scripts/talos_script.py --suite dromaeojs --add-option --webServer,localhost --branch-name Mozilla-Aurora --cfg talos/linux_config.py --download-symbols ondemand --use-talos-json --blob-upload-branch Mozilla-Aurora 00:05:37 INFO - Dumping config to /builds/slave/test/logs/localconfig.json. 00:05:37 INFO - {'append_to_log': False, 00:05:37 INFO - 'base_work_dir': '/builds/slave/test', 00:05:37 INFO - 'blob_upload_branch': 'Mozilla-Aurora', 00:05:37 INFO - 'blob_uploader_auth_file': '/builds/slave/test/oauth.txt', 00:05:37 INFO - 'branch': 'Mozilla-Aurora', 00:05:37 INFO - 'buildbot_json_path': 'buildprops.json', 00:05:37 INFO - 'config_files': ('talos/linux_config.py',), 00:05:37 INFO - 'default_actions': ('clobber', 00:05:37 INFO - 'read-buildbot-config', 00:05:37 INFO - 'download-and-extract', 00:05:37 INFO - 'populate-webroot', 00:05:37 INFO - 'create-virtualenv', 00:05:37 INFO - 'install', 00:05:37 INFO - 'run-tests'), 00:05:37 INFO - 'default_blob_upload_servers': ('https://blobupload.elasticbeanstalk.com',), 00:05:37 INFO - 'download_minidump_stackwalk': True, 00:05:37 INFO - 'download_symbols': 'ondemand', 00:05:37 INFO - 'exes': {'python': '/tools/buildbot/bin/python', 00:05:37 INFO - 'tooltool.py': '/tools/tooltool.py', 00:05:37 INFO - 'virtualenv': ('/tools/buildbot/bin/python', 00:05:37 INFO - '/tools/misc-python/virtualenv.py')}, 00:05:37 INFO - 'find_links': ('http://pypi.pvt.build.mozilla.org/pub', 00:05:37 INFO - 'http://pypi.pub.build.mozilla.org/pub'), 00:05:37 INFO - 'installer_path': 'installer.exe', 00:05:37 INFO - 'log_level': 'info', 00:05:37 INFO - 'log_name': 'talos', 00:05:37 INFO - 'log_to_console': True, 00:05:37 INFO - 'minidump_stackwalk_path': 'linux64-minidump_stackwalk', 00:05:37 INFO - 'minidump_tooltool_manifest_path': 'config/tooltool-manifests/linux64/releng.manifest', 00:05:37 INFO - 'opt_config_files': (), 00:05:37 INFO - 'pip_index': False, 00:05:37 INFO - 'sps_profile': False, 00:05:37 INFO - 'sps_profile_interval': 0, 00:05:37 INFO - 'suite': 'dromaeojs', 00:05:37 INFO - 'system_bits': '32', 00:05:37 INFO - 'talos_extra_options': ('--webServer', 'localhost'), 00:05:37 INFO - 'title': 'talos-linux64-ix-002', 00:05:37 INFO - 'tooltool_cache': '/builds/tooltool_cache', 00:05:37 INFO - 'use_talos_json': True, 00:05:37 INFO - 'virtualenv_path': '/builds/slave/test/build/venv', 00:05:37 INFO - 'volatile_config': {'actions': None, 'add_actions': None, 'no_actions': None}, 00:05:37 INFO - 'work_dir': 'build'} 00:05:37 INFO - [mozharness: 2017-01-27 08:05:37.376976Z] Running clobber step. 00:05:37 INFO - Running pre-action listener: _resource_record_pre_action 00:05:37 INFO - Running main action method: clobber 00:05:37 INFO - rmtree: /builds/slave/test/build 00:05:37 INFO - retry: Calling rmtree with args: ('/builds/slave/test/build',), kwargs: {}, attempt #1 00:05:37 INFO - Running post-action listener: _resource_record_post_action 00:05:37 INFO - [mozharness: 2017-01-27 08:05:37.843437Z] Finished clobber step (success) 00:05:37 INFO - [mozharness: 2017-01-27 08:05:37.843538Z] Running read-buildbot-config step. 00:05:37 INFO - Running pre-action listener: _resource_record_pre_action 00:05:37 INFO - Running main action method: read_buildbot_config 00:05:37 INFO - Using buildbot properties: 00:05:37 INFO - { 00:05:37 INFO - "project": "", 00:05:37 INFO - "product": "firefox", 00:05:37 INFO - "who": "mh@glandium.org", 00:05:37 INFO - "installer_path": "public/build/target.tar.bz2", 00:05:37 INFO - "builddir": "mozilla-aurora_ubuntu64_hw_test-dromaeojs", 00:05:37 INFO - "repository": "https://hg.mozilla.org/releases/mozilla-aurora/", 00:05:37 INFO - "buildername": "Ubuntu HW 12.04 x64 mozilla-aurora pgo talos dromaeojs", 00:05:37 INFO - "stage_platform": "linux64-pgo", 00:05:37 INFO - "basedir": "/builds/slave/test", 00:05:37 INFO - "buildnumber": 751, 00:05:37 INFO - "platform": "ubuntu64_hw", 00:05:37 INFO - "master": "http://buildbot-master105.bb.releng.scl3.mozilla.com:8201/", 00:05:37 INFO - "slavebuilddir": "test", 00:05:37 INFO - "taskId": "CS_io8j0TpivHpbbn5DJHg", 00:05:37 INFO - "branch": "mozilla-aurora", 00:05:37 INFO - "script_repo_revision": "production", 00:05:37 INFO - "revision": "cceb7f61ef17d0c10d42f4e4a9820d40cc46528d", 00:05:37 INFO - "slavename": "talos-linux64-ix-002", 00:05:37 INFO - "repo_path": "releases/mozilla-aurora" 00:05:37 INFO - } 00:05:37 INFO - Finding installer, test and symbols from parent task. 00:05:37 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/CS_io8j0TpivHpbbn5DJHg'}, attempt #1 00:05:38 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/CS_io8j0TpivHpbbn5DJHg'}, attempt #1 00:05:38 INFO - Task dependencies: eNeu4ggEQcOFNI5F9uBp5A 00:05:38 INFO - retry: Calling _urlopen with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A'}, attempt #1 00:05:39 INFO - Set installer_url: https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.tar.bz2 00:05:39 INFO - Set test_url: https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/test_packages.json 00:05:39 INFO - Set symbols_url: https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.crashreporter-symbols.zip 00:05:39 INFO - Running post-action listener: _resource_record_post_action 00:05:39 INFO - [mozharness: 2017-01-27 08:05:39.240525Z] Finished read-buildbot-config step (success) 00:05:39 INFO - [mozharness: 2017-01-27 08:05:39.240740Z] Running download-and-extract step. 00:05:39 INFO - Running pre-action listener: _resource_record_pre_action 00:05:39 INFO - Running main action method: download_and_extract 00:05:39 INFO - mkdir: /builds/slave/test/build/tests 00:05:39 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')]} 00:05:39 INFO - trying https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.test_packages.json 00:05:39 INFO - Downloading https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.test_packages.json to /builds/slave/test/build/target.test_packages.json 00:05:39 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.test_packages.json', 'file_name': '/builds/slave/test/build/target.test_packages.json'}, attempt #1 00:05:39 INFO - Downloaded 896 bytes. 00:05:39 INFO - Reading from file /builds/slave/test/build/target.test_packages.json 00:05:39 INFO - Using the following test package requirements: 00:05:39 INFO - {u'common': [u'target.common.tests.zip'], 00:05:39 INFO - u'cppunittest': [u'target.common.tests.zip', u'target.cppunittest.tests.zip'], 00:05:39 INFO - u'gtest': [u'target.common.tests.zip', u'target.gtest.tests.zip'], 00:05:39 INFO - u'jittest': [u'target.common.tests.zip', u'target.jsshell.zip'], 00:05:39 INFO - u'mochitest': [u'target.common.tests.zip', u'target.mochitest.tests.zip'], 00:05:39 INFO - u'mozbase': [u'target.common.tests.zip'], 00:05:39 INFO - u'reftest': [u'target.common.tests.zip', u'target.reftest.tests.zip'], 00:05:39 INFO - u'talos': [u'target.common.tests.zip', u'target.talos.tests.zip'], 00:05:39 INFO - u'web-platform': [u'target.common.tests.zip', 00:05:39 INFO - u'target.web-platform.tests.zip'], 00:05:39 INFO - u'xpcshell': [u'target.common.tests.zip', u'target.xpcshell.tests.zip']} 00:05:39 INFO - Downloading packages: [u'target.common.tests.zip'] for test suite category: common 00:05:39 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.common.tests.zip 00:05:39 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.common.tests.zip'}, attempt #1 00:05:39 INFO - Fetch https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.common.tests.zip into memory 00:05:41 INFO - Expected file size: 21848594 00:05:41 INFO - Obtained file size: 21848594 00:05:45 INFO - Downloading packages: [u'target.common.tests.zip', u'target.talos.tests.zip'] for test suite category: talos 00:05:45 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.common.tests.zip 00:05:45 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.common.tests.zip'}, attempt #1 00:05:45 INFO - Fetch https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.common.tests.zip into memory 00:05:46 INFO - Expected file size: 21848594 00:05:46 INFO - Obtained file size: 21848594 00:05:50 INFO - Downloading and extracting to /builds/slave/test/build/tests these dirs * from https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.talos.tests.zip 00:05:50 INFO - retry: Calling fetch_url_into_memory with args: (), kwargs: {'url': u'https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.talos.tests.zip'}, attempt #1 00:05:50 INFO - Fetch https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.talos.tests.zip into memory 00:05:52 INFO - Expected file size: 14403485 00:05:52 INFO - Obtained file size: 14403485 00:05:53 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 00:05:53 INFO - trying https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.tar.bz2 00:05:53 INFO - Downloading https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.tar.bz2 to /builds/slave/test/build/target.tar.bz2 00:05:53 INFO - retry: Calling _download_file with args: (), kwargs: {'url': 'https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.tar.bz2', 'file_name': '/builds/slave/test/build/target.tar.bz2'}, attempt #1 00:05:55 INFO - Downloaded 66041194 bytes. 00:05:55 INFO - Setting buildbot property build_url to https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.tar.bz2 00:05:55 INFO - mkdir: /builds/slave/test/properties 00:05:55 INFO - Writing buildbot properties ['build_url'] to /builds/slave/test/properties/build_url 00:05:55 INFO - Writing to file /builds/slave/test/properties/build_url 00:05:55 INFO - Contents: 00:05:55 INFO - build_url:https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.tar.bz2 00:05:55 INFO - Running post-action listener: _resource_record_post_action 00:05:55 INFO - Running post-action listener: set_extra_try_arguments 00:05:55 INFO - [mozharness: 2017-01-27 08:05:55.312593Z] Finished download-and-extract step (success) 00:05:55 INFO - [mozharness: 2017-01-27 08:05:55.312689Z] Running populate-webroot step. 00:05:55 INFO - Running pre-action listener: _resource_record_pre_action 00:05:55 INFO - Running main action method: populate_webroot 00:05:55 INFO - {'extra_options': {'android': ['--apkPath=%(apk_path)s']}, 00:05:55 INFO - 'mobile-suites': {'remote-tp4m_nochrome': {'tests': ['tp4m']}, 00:05:55 INFO - 'remote-tsvgx': {'talos_options': ['--noChrome', 00:05:55 INFO - '--tppagecycles', 00:05:55 INFO - '7'], 00:05:55 INFO - 'tests': ['tsvgm']}}, 00:05:55 INFO - 'suites': {'chromez': {'talos_options': ['--disable-e10s'], 00:05:55 INFO - 'tests': ['tresize', 'tcanvasmark']}, 00:05:55 INFO - 'chromez-e10s': {'tests': ['tresize', 'tcanvasmark']}, 00:05:55 INFO - 'dromaeojs': {'talos_options': ['--disable-e10s'], 00:05:55 INFO - 'tests': ['dromaeo_css', 'kraken']}, 00:05:55 INFO - 'dromaeojs-e10s': {'tests': ['dromaeo_css', 'kraken']}, 00:05:55 INFO - 'g1': {'pagesets_name': 'tp5n.zip', 00:05:55 INFO - 'talos_options': ['--disable-e10s'], 00:05:55 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 00:05:55 INFO - 'g1-e10s': {'pagesets_name': 'tp5n.zip', 00:05:55 INFO - 'tests': ['tp5o_scroll', 'glterrain']}, 00:05:55 INFO - 'g2': {'pagesets_name': 'tp5n.zip', 00:05:55 INFO - 'talos_options': ['--disable-e10s'], 00:05:55 INFO - 'tests': ['damp', 'tps']}, 00:05:55 INFO - 'g2-e10s': {'pagesets_name': 'tp5n.zip', 00:05:55 INFO - 'tests': ['damp', 'tps']}, 00:05:55 INFO - 'g3': {'talos_options': ['--disable-e10s'], 00:05:55 INFO - 'tests': ['dromaeo_dom']}, 00:05:55 INFO - 'g3-e10s': {'tests': ['dromaeo_dom']}, 00:05:55 INFO - 'g4': {'talos_options': ['--disable-e10s'], 00:05:55 INFO - 'tests': ['basic_compositor_video']}, 00:05:55 INFO - 'g4-e10s': {'tests': ['basic_compositor_video']}, 00:05:55 INFO - 'other': {'talos_options': ['--disable-e10s'], 00:05:55 INFO - 'tests': ['a11yr', 00:05:55 INFO - 'ts_paint', 00:05:55 INFO - 'tpaint', 00:05:55 INFO - 'sessionrestore', 00:05:55 INFO - 'sessionrestore_no_auto_restore', 00:05:55 INFO - 'tabpaint']}, 00:05:55 INFO - 'other-e10s': {'tests': ['a11yr', 00:05:55 INFO - 'ts_paint', 00:05:55 INFO - 'tpaint', 00:05:55 INFO - 'sessionrestore', 00:05:55 INFO - 'sessionrestore_no_auto_restore', 00:05:55 INFO - 'tabpaint']}, 00:05:55 INFO - 'other-e10s_l64': {'tests': ['a11yr', 00:05:55 INFO - 'ts_paint', 00:05:55 INFO - 'tpaint', 00:05:55 INFO - 'sessionrestore', 00:05:55 INFO - 'sessionrestore_no_auto_restore', 00:05:55 INFO - 'tabpaint']}, 00:05:55 INFO - 'other-e10s_nol64': {'tests': ['a11yr', 00:05:55 INFO - 'ts_paint', 00:05:55 INFO - 'tpaint', 00:05:55 INFO - 'sessionrestore', 00:05:55 INFO - 'sessionrestore_no_auto_restore', 00:05:55 INFO - 'tabpaint']}, 00:05:55 INFO - 'other_l64': {'talos_options': ['--disable-e10s'], 00:05:55 INFO - 'tests': ['a11yr', 00:05:55 INFO - 'ts_paint', 00:05:55 INFO - 'tpaint', 00:05:55 INFO - 'sessionrestore', 00:05:55 INFO - 'sessionrestore_no_auto_restore', 00:05:55 INFO - 'tabpaint']}, 00:05:55 INFO - 'other_nol64': {'talos_options': ['--disable-e10s'], 00:05:55 INFO - 'tests': ['a11yr', 00:05:55 INFO - 'ts_paint', 00:05:55 INFO - 'tpaint', 00:05:55 INFO - 'sessionrestore', 00:05:55 INFO - 'sessionrestore_no_auto_restore', 00:05:55 INFO - 'tabpaint']}, 00:05:55 INFO - 'svgr': {'talos_options': ['--disable-e10s'], 00:05:55 INFO - 'tests': ['tsvgx', 00:05:55 INFO - 'tsvgr_opacity', 00:05:55 INFO - 'tart', 00:05:55 INFO - 'tscrollx', 00:05:55 INFO - 'cart', 00:05:55 INFO - 'tsvg_static']}, 00:05:55 INFO - 'svgr-e10s': {'tests': ['tsvgx', 00:05:55 INFO - 'tsvgr_opacity', 00:05:55 INFO - 'tart', 00:05:55 INFO - 'tscrollx', 00:05:55 INFO - 'cart', 00:05:55 INFO - 'tsvg_static']}, 00:05:55 INFO - 'tp5o': {'pagesets_name': 'tp5n.zip', 00:05:55 INFO - 'talos_options': ['--disable-e10s'], 00:05:55 INFO - 'tests': ['tp5o']}, 00:05:55 INFO - 'tp5o-e10s': {'pagesets_name': 'tp5n.zip', 'tests': ['tp5o']}, 00:05:55 INFO - 'xperf': {'pagesets_name': 'tp5n.zip', 00:05:55 INFO - 'talos_options': ['--disable-e10s', 00:05:55 INFO - '--xperf_path', 00:05:55 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 00:05:55 INFO - 'tests': ['tp5n']}, 00:05:55 INFO - 'xperf-e10s': {'pagesets_name': 'tp5n.zip', 00:05:55 INFO - 'talos_options': ['--xperf_path', 00:05:55 INFO - '"c:/Program Files/Microsoft Windows Performance Toolkit/xperf.exe"'], 00:05:55 INFO - 'tests': ['tp5n']}}, 00:05:55 INFO - 'talos.zip': {'path': '', 00:05:55 INFO - 'url': 'http://talos-bundles.pvt.build.mozilla.org/zips/talos.a6052c33d420.zip'}} 00:05:55 INFO - Running post-action listener: _resource_record_post_action 00:05:55 INFO - [mozharness: 2017-01-27 08:05:55.325790Z] Finished populate-webroot step (success) 00:05:55 INFO - [mozharness: 2017-01-27 08:05:55.325880Z] Running create-virtualenv step. 00:05:55 INFO - Running pre-action listener: _resource_record_pre_action 00:05:55 INFO - Running main action method: create_virtualenv 00:05:55 INFO - Creating virtualenv /builds/slave/test/build/venv 00:05:55 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 00:05:55 INFO - Copy/paste: /tools/buildbot/bin/python /tools/misc-python/virtualenv.py --no-site-packages --distribute /builds/slave/test/build/venv 00:05:55 INFO - The --no-site-packages flag is deprecated; it is now the default behavior. 00:05:55 INFO - Using real prefix '/usr' 00:05:55 INFO - New python executable in /builds/slave/test/build/venv/bin/python 00:05:55 INFO - Installing distribute.............................................................................................................................................................................................done. 00:05:57 INFO - Installing pip.................done. 00:05:57 INFO - Return code: 0 00:05:57 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', '--version'] 00:05:57 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip --version 00:05:58 INFO - Reading from file tmpfile_stdout 00:05:58 INFO - Output received: 00:05:58 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) 00:05:58 INFO - Installing pip>=1.5 into virtualenv /builds/slave/test/build/venv 00:05:58 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')]} 00:05:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:05:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:05:58 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')]} 00:05:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:05:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:05:58 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 0x1aa11f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bb1a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e13630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e9c850>, '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 0x1e116d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e11b60>, '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': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', '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 00:05:58 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 00:05:58 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 00:05:58 INFO - Using env: {'DISPLAY': ':0', 00:05:58 INFO - 'HOME': '/home/cltbld', 00:05:58 INFO - 'LANG': 'en_US.UTF-8', 00:05:58 INFO - 'LANGUAGE': 'en_US:en', 00:05:58 INFO - 'LOGNAME': 'cltbld', 00:05:58 INFO - 'MAIL': '/var/mail/cltbld', 00:05:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:05:58 INFO - 'MOZ_NO_REMOTE': '1', 00:05:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:05:58 INFO - 'NO_EM_RESTART': '1', 00:05:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:05:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:05:58 INFO - 'PWD': '/builds/slave/test', 00:05:58 INFO - 'SHELL': '/bin/bash', 00:05:58 INFO - 'SHLVL': '1', 00:05:58 INFO - 'TERM': 'linux', 00:05:58 INFO - 'TMOUT': '86400', 00:05:58 INFO - 'USER': 'cltbld', 00:05:58 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', 00:05:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:05:58 INFO - '_': '/tools/buildbot/bin/python'} 00:05:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:05:58 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 00:05:58 INFO - Cleaning up... 00:05:58 INFO - Return code: 0 00:05:58 INFO - Installing psutil>=3.1.1 into virtualenv /builds/slave/test/build/venv 00:05:58 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')]} 00:05:58 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:05:58 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:05:58 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')]} 00:05:58 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:05:58 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:05:58 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 0x1aa11f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bb1a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e13630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e9c850>, '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 0x1e116d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e11b60>, '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': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', '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 00:05:58 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 00:05:58 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 00:05:58 INFO - Using env: {'DISPLAY': ':0', 00:05:58 INFO - 'HOME': '/home/cltbld', 00:05:58 INFO - 'LANG': 'en_US.UTF-8', 00:05:58 INFO - 'LANGUAGE': 'en_US:en', 00:05:58 INFO - 'LOGNAME': 'cltbld', 00:05:58 INFO - 'MAIL': '/var/mail/cltbld', 00:05:58 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:05:58 INFO - 'MOZ_NO_REMOTE': '1', 00:05:58 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:05:58 INFO - 'NO_EM_RESTART': '1', 00:05:58 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:05:58 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:05:58 INFO - 'PWD': '/builds/slave/test', 00:05:58 INFO - 'SHELL': '/bin/bash', 00:05:58 INFO - 'SHLVL': '1', 00:05:58 INFO - 'TERM': 'linux', 00:05:58 INFO - 'TMOUT': '86400', 00:05:58 INFO - 'USER': 'cltbld', 00:05:58 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', 00:05:58 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:05:58 INFO - '_': '/tools/buildbot/bin/python'} 00:05:58 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:05:58 INFO - Downloading/unpacking psutil>=3.1.1 00:05:58 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 00:05:58 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 00:05:58 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 00:05:58 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 00:05:58 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 00:05:58 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 00:06:00 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/psutil/setup.py) egg_info for package psutil 00:06:00 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 00:06:00 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 00:06:00 INFO - Installing collected packages: psutil 00:06:00 INFO - Running setup.py install for psutil 00:06:00 INFO - building 'psutil._psutil_linux' extension 00:06:00 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 00:06:00 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 00:06:00 INFO - building 'psutil._psutil_posix' extension 00:06:00 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 00:06:01 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 00:06:01 INFO - warning: no previously-included files matching '*' found under directory 'docs/_build' 00:06:01 INFO - warning: manifest_maker: MANIFEST.in, line 18: 'recursive-include' expects ... 00:06:01 INFO - Successfully installed psutil 00:06:01 INFO - Cleaning up... 00:06:01 INFO - Return code: 0 00:06:01 INFO - Installing mozsystemmonitor==0.3 into virtualenv /builds/slave/test/build/venv 00:06:01 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')]} 00:06:01 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:06:01 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06:01 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')]} 00:06:01 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:06:01 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06:01 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 0x1aa11f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bb1a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e13630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e9c850>, '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 0x1e116d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e11b60>, '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': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', '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 00:06:01 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 00:06:01 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 00:06:01 INFO - Using env: {'DISPLAY': ':0', 00:06:01 INFO - 'HOME': '/home/cltbld', 00:06:01 INFO - 'LANG': 'en_US.UTF-8', 00:06:01 INFO - 'LANGUAGE': 'en_US:en', 00:06:01 INFO - 'LOGNAME': 'cltbld', 00:06:01 INFO - 'MAIL': '/var/mail/cltbld', 00:06:01 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:06:01 INFO - 'MOZ_NO_REMOTE': '1', 00:06:01 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:06:01 INFO - 'NO_EM_RESTART': '1', 00:06:01 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:06:01 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:06:01 INFO - 'PWD': '/builds/slave/test', 00:06:01 INFO - 'SHELL': '/bin/bash', 00:06:01 INFO - 'SHLVL': '1', 00:06:01 INFO - 'TERM': 'linux', 00:06:01 INFO - 'TMOUT': '86400', 00:06:01 INFO - 'USER': 'cltbld', 00:06:01 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', 00:06:01 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:06:01 INFO - '_': '/tools/buildbot/bin/python'} 00:06:01 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:06:01 INFO - Downloading/unpacking mozsystemmonitor==0.3 00:06:01 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 00:06:01 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 00:06:01 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 00:06:01 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 00:06:01 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 00:06:01 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 00:06:03 INFO - Downloading mozsystemmonitor-0.3.tar.gz 00:06:03 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/mozsystemmonitor/setup.py) egg_info for package mozsystemmonitor 00:06:03 INFO - Requirement already satisfied (use --upgrade to upgrade): psutil>=3.1.1 in ./venv/lib/python2.7/site-packages (from mozsystemmonitor==0.3) 00:06:03 INFO - Installing collected packages: mozsystemmonitor 00:06:03 INFO - Running setup.py install for mozsystemmonitor 00:06:03 INFO - Successfully installed mozsystemmonitor 00:06:03 INFO - Cleaning up... 00:06:03 INFO - Return code: 0 00:06:03 INFO - Installing jsonschema==2.5.1 into virtualenv /builds/slave/test/build/venv 00:06:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 00:06:03 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:06:03 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06:03 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 00:06:03 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:06:03 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06:03 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 0x1aa11f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bb1a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e13630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e9c850>, '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 0x1e116d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e11b60>, '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': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', '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 00:06:03 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 00:06:03 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 00:06:03 INFO - Using env: {'DISPLAY': ':0', 00:06:03 INFO - 'HOME': '/home/cltbld', 00:06:03 INFO - 'LANG': 'en_US.UTF-8', 00:06:03 INFO - 'LANGUAGE': 'en_US:en', 00:06:03 INFO - 'LOGNAME': 'cltbld', 00:06:03 INFO - 'MAIL': '/var/mail/cltbld', 00:06:03 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:06:03 INFO - 'MOZ_NO_REMOTE': '1', 00:06:03 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:06:03 INFO - 'NO_EM_RESTART': '1', 00:06:03 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:06:03 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:06:03 INFO - 'PWD': '/builds/slave/test', 00:06:03 INFO - 'SHELL': '/bin/bash', 00:06:03 INFO - 'SHLVL': '1', 00:06:03 INFO - 'TERM': 'linux', 00:06:03 INFO - 'TMOUT': '86400', 00:06:03 INFO - 'USER': 'cltbld', 00:06:03 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', 00:06:03 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:06:03 INFO - '_': '/tools/buildbot/bin/python'} 00:06:03 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:06:03 INFO - Downloading/unpacking jsonschema==2.5.1 00:06:03 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 00:06:03 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 00:06:03 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 00:06:03 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 00:06:03 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 00:06:03 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 00:06:05 INFO - Downloading jsonschema-2.5.1-py2.py3-none-any.whl 00:06:05 INFO - Downloading/unpacking functools32 (from jsonschema==2.5.1) 00:06:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 00:06:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 00:06:05 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 00:06:05 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 00:06:05 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 00:06:05 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 00:06:06 INFO - Downloading functools32-3.2.3-2.tar.gz 00:06:06 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/functools32/setup.py) egg_info for package functools32 00:06:06 INFO - warning: no files found matching '*.txt' 00:06:06 INFO - no previously-included directories found matching 'build' 00:06:06 INFO - no previously-included directories found matching 'dist' 00:06:06 INFO - no previously-included directories found matching '.git*' 00:06:06 INFO - Installing collected packages: jsonschema, functools32 00:06:06 INFO - Running setup.py install for functools32 00:06:06 INFO - warning: no files found matching '*.txt' 00:06:06 INFO - no previously-included directories found matching 'build' 00:06:06 INFO - no previously-included directories found matching 'dist' 00:06:06 INFO - no previously-included directories found matching '.git*' 00:06:06 INFO - Successfully installed jsonschema functools32 00:06:06 INFO - Cleaning up... 00:06:06 INFO - Return code: 0 00:06:06 INFO - Installing functools32==3.2.3-2 into virtualenv /builds/slave/test/build/venv 00:06:06 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')]} 00:06:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:06:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06:06 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')]} 00:06:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:06:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06:06 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 0x1aa11f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bb1a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e13630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e9c850>, '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 0x1e116d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e11b60>, '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': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', '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 00:06:06 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 00:06:06 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 00:06:06 INFO - Using env: {'DISPLAY': ':0', 00:06:06 INFO - 'HOME': '/home/cltbld', 00:06:06 INFO - 'LANG': 'en_US.UTF-8', 00:06:06 INFO - 'LANGUAGE': 'en_US:en', 00:06:06 INFO - 'LOGNAME': 'cltbld', 00:06:06 INFO - 'MAIL': '/var/mail/cltbld', 00:06:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:06:06 INFO - 'MOZ_NO_REMOTE': '1', 00:06:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:06:06 INFO - 'NO_EM_RESTART': '1', 00:06:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:06:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:06:06 INFO - 'PWD': '/builds/slave/test', 00:06:06 INFO - 'SHELL': '/bin/bash', 00:06:06 INFO - 'SHLVL': '1', 00:06:06 INFO - 'TERM': 'linux', 00:06:06 INFO - 'TMOUT': '86400', 00:06:06 INFO - 'USER': 'cltbld', 00:06:06 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', 00:06:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:06:06 INFO - '_': '/tools/buildbot/bin/python'} 00:06:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:06:06 INFO - Requirement already satisfied (use --upgrade to upgrade): functools32==3.2.3-2 in ./venv/lib/python2.7/site-packages 00:06:06 INFO - Cleaning up... 00:06:06 INFO - Return code: 0 00:06:06 INFO - Installing blobuploader==1.2.4 into virtualenv /builds/slave/test/build/venv 00:06:06 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')]} 00:06:06 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:06:06 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06:06 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')]} 00:06:06 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:06:06 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06:06 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 0x1aa11f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bb1a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e13630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e9c850>, '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 0x1e116d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e11b60>, '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': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', '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 00:06:06 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 00:06:06 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 00:06:06 INFO - Using env: {'DISPLAY': ':0', 00:06:06 INFO - 'HOME': '/home/cltbld', 00:06:06 INFO - 'LANG': 'en_US.UTF-8', 00:06:06 INFO - 'LANGUAGE': 'en_US:en', 00:06:06 INFO - 'LOGNAME': 'cltbld', 00:06:06 INFO - 'MAIL': '/var/mail/cltbld', 00:06:06 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:06:06 INFO - 'MOZ_NO_REMOTE': '1', 00:06:06 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:06:06 INFO - 'NO_EM_RESTART': '1', 00:06:06 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:06:06 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:06:06 INFO - 'PWD': '/builds/slave/test', 00:06:06 INFO - 'SHELL': '/bin/bash', 00:06:06 INFO - 'SHLVL': '1', 00:06:06 INFO - 'TERM': 'linux', 00:06:06 INFO - 'TMOUT': '86400', 00:06:06 INFO - 'USER': 'cltbld', 00:06:06 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', 00:06:06 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:06:06 INFO - '_': '/tools/buildbot/bin/python'} 00:06:06 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:06:06 INFO - Downloading/unpacking blobuploader==1.2.4 00:06:06 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 00:06:06 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 00:06:06 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 00:06:06 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 00:06:06 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 00:06:06 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 00:06:08 INFO - Downloading blobuploader-1.2.4.tar.gz 00:06:08 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blobuploader/setup.py) egg_info for package blobuploader 00:06:08 INFO - Downloading/unpacking requests==1.2.3. (from blobuploader==1.2.4) 00:06:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 00:06:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 00:06:08 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 00:06:08 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 00:06:08 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 00:06:08 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 00:06:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/requests/setup.py) egg_info for package requests 00:06:09 INFO - Downloading/unpacking docopt==0.6.1 (from blobuploader==1.2.4) 00:06:09 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 00:06:09 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 00:06:09 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 00:06:09 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 00:06:09 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 00:06:09 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 00:06:09 INFO - Downloading docopt-0.6.1.tar.gz 00:06:09 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/docopt/setup.py) egg_info for package docopt 00:06:09 INFO - Installing collected packages: blobuploader, requests, docopt 00:06:09 INFO - Running setup.py install for blobuploader 00:06:09 INFO - changing mode of build/scripts-2.7/blobberc.py from 664 to 775 00:06:09 INFO - changing mode of /builds/slave/test/build/venv/bin/blobberc.py to 775 00:06:09 INFO - Running setup.py install for requests 00:06:10 INFO - Running setup.py install for docopt 00:06:10 INFO - Successfully installed blobuploader requests docopt 00:06:10 INFO - Cleaning up... 00:06:10 INFO - Return code: 0 00:06:10 INFO - Installing None into virtualenv /builds/slave/test/build/venv 00:06:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 00:06:10 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:06:10 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06:10 INFO - proxxy config: {'regions': ['.use1.', '.usw2.', '.scl3'], 'instances': ['proxxy1.srv.releng.use1.mozilla.com', 'proxxy1.srv.releng.usw2.mozilla.com', 'proxxy1.srv.releng.scl3.mozilla.com'], 'urls': [('http://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp.mozilla.org', 'ftp.mozilla.org'), ('https://ftp-ssl.mozilla.org', 'ftp.mozilla.org'), ('http://pypi.pvt.build.mozilla.org', 'pypi.pvt.build.mozilla.org'), ('http://pypi.pub.build.mozilla.org', 'pypi.pub.build.mozilla.org')]} 00:06:10 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:06:10 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06:10 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 0x1aa11f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bb1a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e13630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e9c850>, '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 0x1e116d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e11b60>, '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': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', '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 00:06:10 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 00:06:10 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 00:06:10 INFO - Using env: {'DISPLAY': ':0', 00:06:10 INFO - 'HOME': '/home/cltbld', 00:06:10 INFO - 'LANG': 'en_US.UTF-8', 00:06:10 INFO - 'LANGUAGE': 'en_US:en', 00:06:10 INFO - 'LOGNAME': 'cltbld', 00:06:10 INFO - 'MAIL': '/var/mail/cltbld', 00:06:10 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:06:10 INFO - 'MOZ_NO_REMOTE': '1', 00:06:10 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:06:10 INFO - 'NO_EM_RESTART': '1', 00:06:10 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:06:10 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:06:10 INFO - 'PWD': '/builds/slave/test', 00:06:10 INFO - 'SHELL': '/bin/bash', 00:06:10 INFO - 'SHLVL': '1', 00:06:10 INFO - 'TERM': 'linux', 00:06:10 INFO - 'TMOUT': '86400', 00:06:10 INFO - 'USER': 'cltbld', 00:06:10 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', 00:06:10 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:06:10 INFO - '_': '/tools/buildbot/bin/python'} 00:06:10 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:06:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 00:06:10 INFO - Running setup.py (path:/tmp/pip-y719DS-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 00:06:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 00:06:10 INFO - Running setup.py (path:/tmp/pip-AIeuzf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 00:06:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 00:06:10 INFO - Running setup.py (path:/tmp/pip-izw4yf-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 00:06:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 00:06:10 INFO - Running setup.py (path:/tmp/pip-yudggs-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 00:06:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 00:06:10 INFO - Running setup.py (path:/tmp/pip-70xAEj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 00:06:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 00:06:10 INFO - Running setup.py (path:/tmp/pip-97ofuh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 00:06:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 00:06:10 INFO - Running setup.py (path:/tmp/pip-S7AHhO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 00:06:10 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 00:06:10 INFO - Running setup.py (path:/tmp/pip-0v3tp6-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 00:06:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 00:06:11 INFO - Running setup.py (path:/tmp/pip-zIAgfL-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 00:06:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 00:06:11 INFO - Running setup.py (path:/tmp/pip-MDJiqn-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 00:06:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 00:06:11 INFO - Running setup.py (path:/tmp/pip-ahASab-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 00:06:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 00:06:11 INFO - Running setup.py (path:/tmp/pip-moC68o-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 00:06:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 00:06:11 INFO - Running setup.py (path:/tmp/pip-a6MEBj-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 00:06:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 00:06:11 INFO - Running setup.py (path:/tmp/pip-AfdwGa-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 00:06:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 00:06:11 INFO - Running setup.py (path:/tmp/pip-7I1dCg-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 00:06:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 00:06:11 INFO - Running setup.py (path:/tmp/pip-B8LRGh-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 00:06:11 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 00:06:11 INFO - Running setup.py (path:/tmp/pip-Fi8Oij-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 00:06:11 INFO - Installing collected packages: manifestparser, mozcrash, mozdebug, mozdevice, mozfile, mozhttpd, mozinfo, mozInstall, mozleak, mozlog, moznetwork, mozprocess, mozprofile, mozrunner, mozscreenshot, moztest, mozversion 00:06:11 INFO - Running setup.py install for manifestparser 00:06:11 INFO - Installing manifestparser script to /builds/slave/test/build/venv/bin 00:06:11 INFO - Running setup.py install for mozcrash 00:06:11 INFO - Running setup.py install for mozdebug 00:06:11 INFO - Running setup.py install for mozdevice 00:06:12 INFO - Installing sutini script to /builds/slave/test/build/venv/bin 00:06:12 INFO - Installing dm script to /builds/slave/test/build/venv/bin 00:06:12 INFO - Running setup.py install for mozfile 00:06:12 INFO - Running setup.py install for mozhttpd 00:06:12 INFO - Installing mozhttpd script to /builds/slave/test/build/venv/bin 00:06:12 INFO - Running setup.py install for mozinfo 00:06:12 INFO - Installing mozinfo script to /builds/slave/test/build/venv/bin 00:06:12 INFO - Running setup.py install for mozInstall 00:06:12 INFO - Installing moz_remove_from_system script to /builds/slave/test/build/venv/bin 00:06:12 INFO - Installing mozuninstall script to /builds/slave/test/build/venv/bin 00:06:12 INFO - Installing mozinstall script to /builds/slave/test/build/venv/bin 00:06:12 INFO - Installing moz_add_to_system script to /builds/slave/test/build/venv/bin 00:06:12 INFO - Running setup.py install for mozleak 00:06:12 INFO - Running setup.py install for mozlog 00:06:12 INFO - Installing structlog script to /builds/slave/test/build/venv/bin 00:06:12 INFO - Running setup.py install for moznetwork 00:06:12 INFO - Installing moznetwork script to /builds/slave/test/build/venv/bin 00:06:12 INFO - Running setup.py install for mozprocess 00:06:12 INFO - Running setup.py install for mozprofile 00:06:13 INFO - Installing mozprofile script to /builds/slave/test/build/venv/bin 00:06:13 INFO - Installing diff-profiles script to /builds/slave/test/build/venv/bin 00:06:13 INFO - Installing view-profile script to /builds/slave/test/build/venv/bin 00:06:13 INFO - Running setup.py install for mozrunner 00:06:13 INFO - Installing mozrunner script to /builds/slave/test/build/venv/bin 00:06:13 INFO - Running setup.py install for mozscreenshot 00:06:13 INFO - Running setup.py install for moztest 00:06:13 INFO - Running setup.py install for mozversion 00:06:13 INFO - Installing mozversion script to /builds/slave/test/build/venv/bin 00:06:13 INFO - Successfully installed manifestparser mozcrash mozdebug mozdevice mozfile mozhttpd mozinfo mozInstall mozleak mozlog moznetwork mozprocess mozprofile mozrunner mozscreenshot moztest mozversion 00:06:13 INFO - Cleaning up... 00:06:13 INFO - Return code: 0 00:06:13 INFO - Installing None into virtualenv /builds/slave/test/build/venv 00:06: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')]} 00:06:13 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:06:13 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06: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')]} 00:06:13 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:06:13 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06:13 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 0x1aa11f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bb1a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e13630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e9c850>, '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 0x1e116d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e11b60>, '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': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', '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 00:06:13 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 00:06:13 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 00:06:13 INFO - Using env: {'DISPLAY': ':0', 00:06:13 INFO - 'HOME': '/home/cltbld', 00:06:13 INFO - 'LANG': 'en_US.UTF-8', 00:06:13 INFO - 'LANGUAGE': 'en_US:en', 00:06:13 INFO - 'LOGNAME': 'cltbld', 00:06:13 INFO - 'MAIL': '/var/mail/cltbld', 00:06:13 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:06:13 INFO - 'MOZ_NO_REMOTE': '1', 00:06:13 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:06:13 INFO - 'NO_EM_RESTART': '1', 00:06:13 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:06:13 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:06:13 INFO - 'PWD': '/builds/slave/test', 00:06:13 INFO - 'SHELL': '/bin/bash', 00:06:13 INFO - 'SHLVL': '1', 00:06:13 INFO - 'TERM': 'linux', 00:06:13 INFO - 'TMOUT': '86400', 00:06:13 INFO - 'USER': 'cltbld', 00:06:13 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', 00:06:13 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:06:13 INFO - '_': '/tools/buildbot/bin/python'} 00:06:13 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:06:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/manifestparser 00:06:13 INFO - Running setup.py (path:/tmp/pip-qKNI9k-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/manifestparser 00:06:13 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)) 00:06:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozcrash 00:06:13 INFO - Running setup.py (path:/tmp/pip-GX874M-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozcrash 00:06:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozcrash==1.0 from file:///builds/slave/test/build/tests/mozbase/mozcrash in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 00:06:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdebug 00:06:13 INFO - Running setup.py (path:/tmp/pip-LvC4NE-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdebug 00:06:13 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)) 00:06:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozdevice 00:06:13 INFO - Running setup.py (path:/tmp/pip-c67ezQ-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozdevice 00:06:13 INFO - Requirement already satisfied (use --upgrade to upgrade): mozdevice==0.49 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)) 00:06:13 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozfile 00:06:14 INFO - Running setup.py (path:/tmp/pip-BoGnDB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozfile 00:06:14 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)) 00:06:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozhttpd 00:06:14 INFO - Running setup.py (path:/tmp/pip-9I_VoP-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozhttpd 00:06:14 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)) 00:06:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinfo 00:06:14 INFO - Running setup.py (path:/tmp/pip-Pk2gBe-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinfo 00:06:14 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)) 00:06:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozinstall 00:06:14 INFO - Running setup.py (path:/tmp/pip-sGpKAB-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozinstall 00:06:14 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)) 00:06:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozleak 00:06:14 INFO - Running setup.py (path:/tmp/pip-i9DLhW-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozleak 00:06:14 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)) 00:06:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozlog 00:06:14 INFO - Running setup.py (path:/tmp/pip-hf3o0I-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozlog 00:06:14 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)) 00:06:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moznetwork 00:06:14 INFO - Running setup.py (path:/tmp/pip-YRMjH2-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moznetwork 00:06:14 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)) 00:06:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprocess 00:06:14 INFO - Running setup.py (path:/tmp/pip-nHa0Og-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprocess 00:06:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozprocess==0.24 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)) 00:06:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozprofile 00:06:14 INFO - Running setup.py (path:/tmp/pip-hUGwmD-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozprofile 00:06:14 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)) 00:06:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozrunner 00:06:14 INFO - Running setup.py (path:/tmp/pip-yUMko7-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozrunner 00:06:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozrunner==6.13 from file:///builds/slave/test/build/tests/mozbase/mozrunner in /builds/slave/test/build/venv/lib/python2.7/site-packages (from -r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 14)) 00:06:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozscreenshot 00:06:14 INFO - Running setup.py (path:/tmp/pip-lQ3OsF-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozscreenshot 00:06:14 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)) 00:06:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/moztest 00:06:14 INFO - Running setup.py (path:/tmp/pip-I86akO-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/moztest 00:06:14 INFO - Requirement already satisfied (use --upgrade to upgrade): moztest==0.8 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)) 00:06:14 INFO - Unpacking /builds/slave/test/build/tests/mozbase/mozversion 00:06:14 INFO - Running setup.py (path:/tmp/pip-ox5Peu-build/setup.py) egg_info for package from file:///builds/slave/test/build/tests/mozbase/mozversion 00:06:14 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)) 00:06:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozfile>=1.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 00:06:14 INFO - Requirement already satisfied (use --upgrade to upgrade): mozlog>=3.0 in /builds/slave/test/build/venv/lib/python2.7/site-packages (from mozcrash==1.0->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 2)) 00:06:14 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)) 00:06:14 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 00:06:14 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.49->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 4)) 00:06:14 INFO - Downloading/unpacking blessings>=1.3 (from mozlog==3.4->-r /builds/slave/test/build/tests/config/mozbase_requirements.txt (line 10)) 00:06:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 00:06:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 00:06:14 INFO - http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 00:06:14 INFO - http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com has it available 00:06:14 INFO - http://pypi.pvt.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pvt.build.mozilla.org has it available 00:06:14 INFO - http://pypi.pub.build.mozilla.org/pub uses an insecure transport scheme (http). Consider using https if pypi.pub.build.mozilla.org has it available 00:06:16 INFO - Downloading blessings-1.6.tar.gz 00:06:16 INFO - Running setup.py (path:/builds/slave/test/build/venv/build/blessings/setup.py) egg_info for package blessings 00:06:17 INFO - Installing collected packages: blessings 00:06:17 INFO - Running setup.py install for blessings 00:06:17 INFO - Successfully installed blessings 00:06:17 INFO - Cleaning up... 00:06:17 INFO - Return code: 0 00:06:17 INFO - Done creating virtualenv /builds/slave/test/build/venv. 00:06:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 00:06:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 00:06:17 INFO - Reading from file tmpfile_stdout 00:06:17 INFO - Current package versions: 00:06:17 INFO - argparse == 1.2.1 00:06:17 INFO - blessings == 1.6 00:06:17 INFO - blobuploader == 1.2.4 00:06:17 INFO - docopt == 0.6.1 00:06:17 INFO - functools32 == 3.2.3-2 00:06:17 INFO - jsonschema == 2.5.1 00:06:17 INFO - manifestparser == 1.1 00:06:17 INFO - mozInstall == 1.12 00:06:17 INFO - mozcrash == 1.0 00:06:17 INFO - mozdebug == 0.1 00:06:17 INFO - mozdevice == 0.49 00:06:17 INFO - mozfile == 1.2 00:06:17 INFO - mozhttpd == 0.7 00:06:17 INFO - mozinfo == 0.9 00:06:17 INFO - mozleak == 0.1 00:06:17 INFO - mozlog == 3.4 00:06:17 INFO - moznetwork == 0.27 00:06:17 INFO - mozprocess == 0.24 00:06:17 INFO - mozprofile == 0.28 00:06:17 INFO - mozrunner == 6.13 00:06:17 INFO - mozscreenshot == 0.1 00:06:17 INFO - mozsystemmonitor == 0.3 00:06:17 INFO - moztest == 0.8 00:06:17 INFO - mozversion == 1.4 00:06:17 INFO - psutil == 3.1.1 00:06:17 INFO - requests == 1.2.3 00:06:17 INFO - wsgiref == 0.1.2 00:06:17 INFO - Installing None into virtualenv /builds/slave/test/build/venv 00:06: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')]} 00:06:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:06:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06: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')]} 00:06:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:06:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06:17 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 0x1aa11f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bb1a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e13630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e9c850>, '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 0x1e116d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e11b60>, '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': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', '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 00:06:17 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 00:06:17 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 00:06:17 INFO - Using env: {'DISPLAY': ':0', 00:06:17 INFO - 'HOME': '/home/cltbld', 00:06:17 INFO - 'LANG': 'en_US.UTF-8', 00:06:17 INFO - 'LANGUAGE': 'en_US:en', 00:06:17 INFO - 'LOGNAME': 'cltbld', 00:06:17 INFO - 'MAIL': '/var/mail/cltbld', 00:06:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:06:17 INFO - 'MOZ_NO_REMOTE': '1', 00:06:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:06:17 INFO - 'NO_EM_RESTART': '1', 00:06:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:06:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:06:17 INFO - 'PWD': '/builds/slave/test', 00:06:17 INFO - 'SHELL': '/bin/bash', 00:06:17 INFO - 'SHLVL': '1', 00:06:17 INFO - 'TERM': 'linux', 00:06:17 INFO - 'TMOUT': '86400', 00:06:17 INFO - 'USER': 'cltbld', 00:06:17 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', 00:06:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:06:17 INFO - '_': '/tools/buildbot/bin/python'} 00:06:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:06:17 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)) 00:06:17 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)) 00:06:17 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)) 00:06:17 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)) 00:06:17 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)) 00:06:17 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)) 00:06:17 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)) 00:06:17 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)) 00:06:17 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)) 00:06:17 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)) 00:06:17 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)) 00:06:17 INFO - Cleaning up... 00:06:17 INFO - Return code: 0 00:06:17 INFO - Installing jsonschema into virtualenv /builds/slave/test/build/venv 00:06: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')]} 00:06:17 INFO - http://pypi.pvt.build.mozilla.org/pub matches http://pypi.pvt.build.mozilla.org 00:06:17 INFO - URL Candidate: http://pypi.pvt.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06: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')]} 00:06:17 INFO - http://pypi.pub.build.mozilla.org/pub matches http://pypi.pub.build.mozilla.org 00:06:17 INFO - URL Candidate: http://pypi.pub.build.mozilla.org.proxxy1.srv.releng.scl3.mozilla.com/pub 00:06: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', 'jsonschema']], kwargs: {'error_level': 'warning', 'error_list': [{'substr': 'not found or a compiler error:', 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1aa11f0>, 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1bb1a80>, 'level': 'warning'}, {'regex': <_sre.SRE_Pattern object at 0x1e13630>, 'level': 'debug'}, {'substr': 'command not found', 'level': 'error'}, {'regex': <_sre.SRE_Pattern object at 0x1e9c850>, '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 0x1e116d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e11b60>, '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': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', '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 00:06: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', 'jsonschema'] in /builds/slave/test/build 00:06: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 jsonschema 00:06:17 INFO - Using env: {'DISPLAY': ':0', 00:06:17 INFO - 'HOME': '/home/cltbld', 00:06:17 INFO - 'LANG': 'en_US.UTF-8', 00:06:17 INFO - 'LANGUAGE': 'en_US:en', 00:06:17 INFO - 'LOGNAME': 'cltbld', 00:06:17 INFO - 'MAIL': '/var/mail/cltbld', 00:06:17 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:06:17 INFO - 'MOZ_NO_REMOTE': '1', 00:06:17 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:06:17 INFO - 'NO_EM_RESTART': '1', 00:06:17 INFO - 'PATH': '/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:06:17 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:06:17 INFO - 'PWD': '/builds/slave/test', 00:06:17 INFO - 'SHELL': '/bin/bash', 00:06:17 INFO - 'SHLVL': '1', 00:06:17 INFO - 'TERM': 'linux', 00:06:17 INFO - 'TMOUT': '86400', 00:06:17 INFO - 'USER': 'cltbld', 00:06:17 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', 00:06:17 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:06:17 INFO - '_': '/tools/buildbot/bin/python'} 00:06:17 INFO - Ignoring indexes: https://pypi.python.org/simple/ 00:06:17 INFO - Requirement already satisfied (use --upgrade to upgrade): jsonschema in ./venv/lib/python2.7/site-packages 00:06:17 INFO - Cleaning up... 00:06:17 INFO - Return code: 0 00:06:17 INFO - Running post-action listener: _resource_record_post_action 00:06:17 INFO - Running post-action listener: _start_resource_monitoring 00:06:17 INFO - Starting resource monitoring. 00:06:17 INFO - [mozharness: 2017-01-27 08:06:17.931287Z] Finished create-virtualenv step (success) 00:06:17 INFO - [mozharness: 2017-01-27 08:06:17.931796Z] Running install step. 00:06:17 INFO - Running pre-action listener: _resource_record_pre_action 00:06:17 INFO - Running main action method: install 00:06:17 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/pip', 'freeze'] 00:06:17 INFO - Copy/paste: /builds/slave/test/build/venv/bin/pip freeze 00:06:18 INFO - Reading from file tmpfile_stdout 00:06:18 INFO - Detecting whether we're running mozinstall >=1.0... 00:06:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '-h'] 00:06:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall -h 00:06:18 INFO - Reading from file tmpfile_stdout 00:06:18 INFO - Output received: 00:06:18 INFO - Usage: mozinstall [options] installer 00:06:18 INFO - Options: 00:06:18 INFO - -h, --help show this help message and exit 00:06:18 INFO - -d DEST, --destination=DEST 00:06:18 INFO - Directory to install application into. [default: 00:06:18 INFO - "/builds/slave/test"] 00:06:18 INFO - --app=APP Application being installed. [default: firefox] 00:06:18 INFO - mkdir: /builds/slave/test/build/application 00:06:18 INFO - Getting output from command: ['/builds/slave/test/build/venv/bin/mozinstall', '/builds/slave/test/build/target.tar.bz2', '--destination', '/builds/slave/test/build/application'] 00:06:18 INFO - Copy/paste: /builds/slave/test/build/venv/bin/mozinstall /builds/slave/test/build/target.tar.bz2 --destination /builds/slave/test/build/application 00:06:34 INFO - Reading from file tmpfile_stdout 00:06:34 INFO - Output received: 00:06:34 INFO - /builds/slave/test/build/application/firefox/firefox 00:06:34 INFO - Running post-action listener: _resource_record_post_action 00:06:34 INFO - [mozharness: 2017-01-27 08:06:34.758574Z] Finished install step (success) 00:06:34 INFO - [mozharness: 2017-01-27 08:06:34.758729Z] Running run-tests step. 00:06:34 INFO - Running pre-action listener: _resource_record_pre_action 00:06:34 INFO - Running main action method: run_tests 00:06:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '--version'] 00:06:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python --version 00:06:34 INFO - Python 2.7.3 00:06:34 INFO - Return code: 0 00:06:34 INFO - grabbing minidump binary from tooltool 00:06:34 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')]} 00:06:34 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 0x1e9c850>, '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 0x1e116d0>, 'level': 'critical'}, {'regex': <_sre.SRE_Pattern object at 0x1e11b60>, 'level': 'critical'}, {'substr': 'ERROR - ', 'level': 'error'}], 'cwd': '/builds/slave/test/build', 'privileged': False}, attempt #1 00:06:34 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 00:06:34 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 00:06:34 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 00:06:34 INFO - INFO - File linux64-minidump_stackwalk retrieved from local cache /builds/tooltool_cache 00:06:34 INFO - Return code: 0 00:06:34 INFO - Chmoding /builds/slave/test/build/linux64-minidump_stackwalk to 0755 00:06:34 INFO - mkdir: /builds/slave/test/build/blobber_upload_dir 00:06:34 INFO - ENV: MOZ_UPLOAD_DIR is now /builds/slave/test/build/blobber_upload_dir 00:06:34 INFO - ENV: MINIDUMP_STACKWALK is now /builds/slave/test/build/linux64-minidump_stackwalk 00:06:34 INFO - ENV: MINIDUMP_SAVE_PATH is now /builds/slave/test/build/blobber_upload_dir 00:06:34 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] in /builds/slave/test/build 00:06:34 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/tests/talos/talos/run_tests.py --branchName Mozilla-Aurora --suite dromaeojs --executablePath /builds/slave/test/build/application/firefox/firefox --symbolsPath https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.crashreporter-symbols.zip --title talos-linux64-ix-002 --webServer localhost --log-tbpl-level=debug --log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log --log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log 00:06:34 INFO - Using env: {'DISPLAY': ':0', 00:06:34 INFO - 'HOME': '/home/cltbld', 00:06:34 INFO - 'LANG': 'en_US.UTF-8', 00:06:34 INFO - 'LANGUAGE': 'en_US:en', 00:06:34 INFO - 'LOGNAME': 'cltbld', 00:06:34 INFO - 'MAIL': '/var/mail/cltbld', 00:06:34 INFO - 'MINIDUMP_SAVE_PATH': '/builds/slave/test/build/blobber_upload_dir', 00:06:34 INFO - 'MINIDUMP_STACKWALK': '/builds/slave/test/build/linux64-minidump_stackwalk', 00:06:34 INFO - 'MOZ_CRASHREPORTER_NO_REPORT': '1', 00:06:34 INFO - 'MOZ_NO_REMOTE': '1', 00:06:34 INFO - 'MOZ_UPLOAD_DIR': '/builds/slave/test/build/blobber_upload_dir', 00:06:34 INFO - 'NODE_PATH': '/usr/lib/nodejs:/usr/lib/node_modules:/usr/share/javascript', 00:06:34 INFO - 'NO_EM_RESTART': '1', 00:06:34 INFO - 'PATH': '/builds/slave/test/build/venv/bin:/usr/local/bin:/usr/local/bin:/usr/bin:/bin:/usr/local/games:/usr/games', 00:06:34 INFO - 'PROPERTIES_FILE': '/builds/slave/test/buildprops.json', 00:06:34 INFO - 'PWD': '/builds/slave/test', 00:06:34 INFO - 'PYTHONPATH': '/builds/slave/test/build/tests/talos', 00:06:34 INFO - 'SHELL': '/bin/bash', 00:06:34 INFO - 'SHLVL': '1', 00:06:34 INFO - 'TERM': 'linux', 00:06:34 INFO - 'TMOUT': '86400', 00:06:34 INFO - 'USER': 'cltbld', 00:06:34 INFO - 'XDG_SESSION_COOKIE': 'a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590', 00:06:34 INFO - 'XPCOM_DEBUG_BREAK': 'warn', 00:06:34 INFO - '_': '/tools/buildbot/bin/python'} 00:06:34 INFO - Calling ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/tests/talos/talos/run_tests.py', '--branchName', 'Mozilla-Aurora', '--suite', 'dromaeojs', '--executablePath', '/builds/slave/test/build/application/firefox/firefox', '--symbolsPath', 'https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.crashreporter-symbols.zip', '--title', 'talos-linux64-ix-002', '--webServer', 'localhost', '--log-tbpl-level=debug', '--log-errorsummary=/builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log', '--log-raw=/builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log'] with output_timeout 3600 00:06:35 INFO - mozversion application_buildid: 20170127070635 00:06:35 INFO - mozversion application_changeset: cceb7f61ef17d0c10d42f4e4a9820d40cc46528d 00:06:35 INFO - mozversion application_display_name: FirefoxDeveloperEdition 00:06:35 INFO - mozversion application_id: {ec8030f7-c20a-464f-9b0e-13a3a9e97384} 00:06:35 INFO - mozversion application_name: Firefox 00:06:35 INFO - mozversion application_remotingname: firefox-dev 00:06:35 INFO - mozversion application_repository: https://hg.mozilla.org/releases/mozilla-aurora 00:06:35 INFO - mozversion application_vendor: Mozilla 00:06:35 INFO - mozversion application_version: 53.0a2 00:06:35 INFO - mozversion platform_buildid: 20170127070635 00:06:35 INFO - mozversion platform_changeset: cceb7f61ef17d0c10d42f4e4a9820d40cc46528d 00:06:35 INFO - mozversion platform_repository: https://hg.mozilla.org/releases/mozilla-aurora 00:06:35 INFO - mozversion platform_version: 53.0a2 00:06:35 INFO - using testdate: 1485504395 00:06:35 INFO - actual date: 1485504395 00:06:35 INFO - starting webserver on 'localhost:46990' 00:06:35 INFO - SUITE-START | Running 2 tests 00:06:35 INFO - TEST-START | dromaeo_css 00:06:35 INFO - operating with platform_type : linux_ 00:06:35 INFO - Initialising browser for dromaeo_css test... 00:06:35 INFO - TEST-INFO | started process 23528 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpBMS1gA/profile http://localhost:46990/getInfo.html) 00:06:39 INFO - PROCESS | 23528 | __metrics Screen width/height:1600/1200 00:06:39 INFO - PROCESS | 23528 | colorDepth:24 00:06:39 INFO - PROCESS | 23528 | Browser inner width/height: 1024/697 00:06:39 INFO - PROCESS | 23528 | __metrics 00:06:39 INFO - PROCESS | 23528 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 00:06:39 INFO - PROCESS | 23528 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 00:06:40 INFO - PROCESS | 23528 | console.error: PushService: 00:06:40 INFO - PROCESS | 23528 | stateChangeProcessEnqueue: Error transitioning state 00:06:40 INFO - PROCESS | 23528 | UnknownError 00:06:40 INFO - TEST-INFO | 23528: exit 0 00:06:40 INFO - Browser initialized. 00:06:40 INFO - Running cycle 1/1 for dromaeo_css test... 00:06:41 INFO - TEST-INFO | started process 23620 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmpBMS1gA/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/dromaeo/css.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 00:06:52 INFO - PROCESS | 23620 | RSS: Main: 138571776 00:06:52 INFO - PROCESS | 23620 | 00:09:53 INFO - PROCESS | 23620 | Cycle 1(1): loaded http://localhost:46990/tests/dromaeo/cssquery-dojo.html (next: http://localhost:46990/tests/dromaeo/cssquery-ext.html) 00:09:54 INFO - PROCESS | 23620 | RSS: Main: 242515968 00:09:54 INFO - PROCESS | 23620 | 00:11:42 INFO - PROCESS | 23620 | ************************* 00:11:42 INFO - PROCESS | 23620 | A coding exception was thrown and uncaught in a Task. 00:11:42 INFO - PROCESS | 23620 | 00:11:42 ERROR - PROCESS | 23620 | Full message: TypeError: NetworkError when attempting to fetch resource. 00:11:42 INFO - PROCESS | 23620 | Full stack: 00:11:42 INFO - PROCESS | 23620 | ************************* 00:12:56 INFO - PROCESS | 23620 | Cycle 1(1): loaded http://localhost:46990/tests/dromaeo/cssquery-ext.html (next: http://localhost:46990/tests/dromaeo/cssquery-jquery.html) 00:12:57 INFO - PROCESS | 23620 | RSS: Main: 222220288 00:12:57 INFO - PROCESS | 23620 | 00:15:58 INFO - PROCESS | 23620 | Cycle 1(1): loaded http://localhost:46990/tests/dromaeo/cssquery-jquery.html (next: http://localhost:46990/tests/dromaeo/cssquery-mootools.html) 00:15:59 INFO - PROCESS | 23620 | RSS: Main: 173252608 00:15:59 INFO - PROCESS | 23620 | 00:19:01 INFO - PROCESS | 23620 | Cycle 1(1): loaded http://localhost:46990/tests/dromaeo/cssquery-mootools.html (next: http://localhost:46990/tests/dromaeo/cssquery-prototype.html) 00:19:01 INFO - PROCESS | 23620 | RSS: Main: 213151744 00:19:01 INFO - PROCESS | 23620 | 00:22:04 INFO - PROCESS | 23620 | Cycle 1(1): loaded http://localhost:46990/tests/dromaeo/cssquery-prototype.html (next: http://localhost:46990/tests/dromaeo/cssquery-yui.html) 00:22:05 INFO - PROCESS | 23620 | RSS: Main: 171872256 00:22:05 INFO - PROCESS | 23620 | 00:25:07 INFO - PROCESS | 23620 | Cycle 1(1): loaded http://localhost:46990/tests/dromaeo/cssquery-yui.html (next: http://localhost:46990/tests/dromaeo/cssquery-dojo.html) 00:25:08 INFO - PROCESS | 23620 | RSS: Main: 259588096 00:25:08 INFO - PROCESS | 23620 | 00:25:08 INFO - PROCESS | 23620 | __start_tp_report 00:25:08 INFO - PROCESS | 23620 | _x_x_mozilla_page_load 00:25:08 INFO - PROCESS | 23620 | _x_x_mozilla_page_load_details 00:25:08 INFO - PROCESS | 23620 | |i|pagename|runs| 00:25:08 INFO - PROCESS | 23620 | |0;dojo.html;3202.183443221978;3202.919927001825;3216.8069915805045;3232.9191770205757;3249.2039450334673;5405.35135783706;5478.643888147268;5487.835364939048;5491.121420572709;5507.752151153192;5445.646033007862;5460.31746031746;5472.863178420542;5496.31296087989;5507.339119305689;4843.418789745236;4860.902781944359;4875.439324477695;4895.290182923474;4907.975460122694;4786.449558300787;4823.975880120594;4891.828785992491;4933.161362568372;4963.776630051656;4858.441279252878;4864.1730905745935;4868.099401610696;4921.237208232729;4943.480934501879;4973.676711013809;4976.0545496355935;4977.626677999165;4995.325631039799;5004.524570165829;4751.928721069186;4893.877653058702;4894.559489645913;4918.926216106761;4929.038837426703;5263.3947096083675;5306.8407947761625;5342.412334643186;5358.866028349284;5423.972880135574;5768.942310576883;5794.797182098649;5798.391168927286;5813.360530341659;5818.6217895836635;5788.305403351583;5821.155932389822;5857.970710146465;5881.264841894763;5882.882342353129;5404.216388623667;5431.891362172734;5434.402215756343;5436.157395603688;5480.890382192374;5979.820605381846;5982.7008649568215;5990.430909063632;6014.308354539196;6021.638701677914;5777.017906955828;5780.566457515703;5783.595148339576;5789.334226563915;5803.709814509258;5700.657960522382;5713.257276554022;5821.446962538552;5828.038373668382;5874.236349274567;5847.386024467455;5905.291365036223;5920.881582368328;5927.673977931255;5943.108533719977;5927.585069045125;5933.881322373529;5934.851628709317;5946.821595352059;5949.077892926517;4449.7330160190495;4450.955490445054;4481.820727170942;4557.202489564379;4572.428446444194;3974.0859602291634;3980.44273801668;4014.397840323975;4027.979860100739;4033.858814941463;5576.860578485489;5584.050711379075;5584.413636568183;5585.553155747531;5588.385277619459;5730.255066841284;5835.708214589254;5860.941390586125;5889.087191485327;5925.614835035709;5688.943110568841;5701.486866182064;5707;5716.171155182476;5724.255846739898;5080.13637681595;5084.41529224144;5084.847454576368;5086.262491938648;5088.313077734459;5950;6005.879882402328;6098.390160983866;6191.226096737908;6201.0388389799655;5952.077427998667;5975.282966044103;5998.760049598141;6023.879522409439;6024.638521688713;6204.255489341127;6214.036824292242;6220.34686357944;6223.377662233922;6228.56400051992;5605.5515558756015;5616.157576363415;5795.304563452412;5851.034579294539;5868.413158684098;5809.2738407699035;5862.062070068769;5863.589548731547;5867.295924488918;5938.524918006463;5762.711864406847;5767.913481297868;5768.711564421678;5781.913271300849;5789.131630255495;5644.548436125182;5737.627054241461;5742.1673857289625;5750.6837123958585;5755.424457554379;5592.273004509388;5608.327000759935;5619.353774315842;5619.381867994435;5714.285714285715;5733;5748.281464816898;5759.9136012959;5762.193292939076;5767.423257674199;5634.492895639248;5635.492805647511;5637.577181711306;5642.802501912413;5651.152327150796 00:25:08 INFO - PROCESS | 23620 | |1;ext.html;560.3136158206198;592.6621825559431;631.0187658191512;631.4033238589535;655.704932780249;36329.818350908245;46923;48078.75960620201;48265.03469930604;48464.27303590449;51298.743506282415;51459.74270128644;51741;51830.481695183036;51869.74065129669;8781.868271975893;9280.767980800467;9459.337846350758;9466.290028247875;9468.573914173845;8621;11156.888431115665;11352.659420217407;11364.261323013978;11835.05319574432;11392.658220253406;11462.426878656075;11463;11467.827982580267;11473.655790326304;9026.23277021454;9165;11241.83137252942;11321.037711794508;11330.036946859527;11035.613753518668;11235.382053987027;11239.494222759995;11772.646820595395;11772.882271177265;49206.75396622994;49756.50243497555;49774.253386199234;49836;49837.75081124607;4510.300903359985;4556.954430455686;4569.9314510282375;4671.649626278043;4736.7631618418945;35198.64244360141;35215.82392088049;36223.4566481503;36453;36704.26591468156;4428.335749637548;4434.423524941769;4545.182465731571;4635.397398338228;4673.462551806551;326596;328420;328808;329816;330284;70899;70914.2908570918;71056.64471677608;71196.64401677958;71500.28499714936;74004.25995739974;74489.6275518619;74860;75012;75223.24776752162;17709.380171694185;17988;18015.54961125956;18023.18895649699;18046.187921543562;12236.755264894653;12621.558245461365;12748.681282968;12799.680007999688;12835;19664.131907468767;21363.67954480684;21440.678389824167;21466.463338416354;21479.14083436645;7057.153141623038;7095.219525852152;7216.458765592602;7219.241979592172;7264.56637026602;1003.7239759066315;1017.3133135133903;1020.280702105029;1038.5949479702922;1038.6209033702644;34789.47815782765;35260.64739352574;35531;35584.66230065459;35771.28457430837;1098.3464838421128;1186.649938268213;1205.1202622085927;1230.5262473947416;1240.193873981919;18521.53696157607;18548;18678.81321186798;18809.717854232196;18906.243750250112;521798;525074;525288;525976;526172;71746.28253717396;71879.28120718726;71899.28100718926;71931.28068719245;72037;1535.9308831102628;1540.6841597472492;1544.328217225488;1560.3836484588523;1593.529908676943;32268.515972259964;33513.83243083769;33882.83058584691;34249.31501369909;34396.82801586076;59247;59747.701261493414;59889;60034.39965600288;60161.09758353716;419240;419451;421034;422599;422750;41325.79337103295;41598.584014159474;44764;44824.55175448334;46659.53340466688;52904.20643690271;53278.46721532735;53976.46023539714;54149.72925135349;54782.45217547774;44668.32997505105;45146.54853451555;45309;45871.08257834758;46795.532044680476;43330.68441442286;44597.33104003378;45313;45893.31160032669;45955.77022114868;43629.56370436255;43800.34299485574;45035.774821125684;45197.09605807931;45295;35222.29555408826;38408.807955960045;38926.80536597299;39085.8045709781;39223.60776392314;28088.56530194918;29480.262993425335;29820.254493636963;30297.697023029486;30790 00:25:08 INFO - PROCESS | 23620 | |2;jquery.html;435.82762369226776;445.105338270077;445.22086348889445;446.51553064924553;452.37572150432396;20111.49721256969;21218.89390553049;22213.666794998047;22375.776242237574;22454.88772556137;22397.44006399841;22615.208467703633;23125.19061832836;23568.64647030296;23809;5909.231799866022;5937.198478205431;6157.107219453176;6164.476019538344;6168.84577885552;5955.225820643311;5983.461488466037;5987.820365389045;5992.5505587080925;6000.669963152025;5780.884382312352;5955.642661440305;5960.642361458305;5960.986632272502;5970.820875373724;5958.851028724295;5994.280686317648;5996.340402555694;6001.919654462239;6002;5327.440618735054;5340;5384.5692344612335;5391.002664507039;5393.9730301348245;26242;26383.47233055347;26411.339716507242;26434.86782566075;26544.469110617873;2999.655039670444;3071.262896904749;3116.9532457013165;3141.8743250269963;3145.779795414322;14395.712085758227;15302.387904483807;15387.769183462256;15868.920655396649;16101.838981610268;1972.1618312217395;2021.757389113301;2023.8785672859676;2027.1789925080366;2028.868123571963;91951.54024229836;92812;94228.05771942262;95337.52331238368;97005;10980.341179529254;11201;11247.493862776195;11343.886561134448;11436.370999594936;17199.65600687979;17206.1396930153;17281.481555553353;17317.653646927243;17385.304587816598;8737.51943643093;8841.16008979146;8847.867281990775;8858.069902660256;8880.8667869982;8314.459560128573;8363.080061193265;8425.157484251526;8593.828123437495;8622.353323500762;7317.52417601635;7409.370203532652;7541.35898448627;7546.471746977769;7548.584827834522;1921.5868588253593;1948.6102779444168;1994.8703334283225;2001.6096861111944;2027.5944811037557;944.8866136063716;949.1694767078806;951.70497145885;956.1346980982222;968.3560432312574;19823.207071717257;21564;21610.56778864414;21695.24066657691;21868;979.1383582447401;988.1650005745134;989.475577943691;989.9851502227473;1007.6573964851985;11847.289162650097;13002.219866808022;13288.468461261635;13339.933300333436;13345;469811;677142;678279;684459;701376.95869124;91054;93197;100677;114042.42978785053;121352;1172.1794743679459;1181.1082632612495;1203.4644583160584;1207.4747484844122;1227.2145826670937;18925.526861828563;19273.614527709648;19365.709514357015;19418.320358787376;19500.122494488067;36998.44502332521;43016.56983430251;44275;46522.30216546687;51483.74258128685;64275.35724642694;67440;68760.6561967187;71268.50560230367;74628;13681.79477307861;14649.780253296422;14863.331150098054;14892.40430382816;15325.386984520494;11515.25150865191;12232.75534489323;15362.231888405759;16371.70565996395;16736.079515626272;13108.803367949678;13522.86477135216;13665.111767735065;13929.23389213603;14164.716705666035;12970.35148242603;13225.908025410094;13497.595072147851;13516.39176237052;13975.930120349332;13502.459901603826;13893.957953153757;13930.930345348208;14376.712465750836;14579;14793.408263669333;14923.925380373028;15017.924910375377;15212.543623691306;15415.229238537804;13612.387442565307;13698.52055178064;13714.93142534321;13718.794218086538;13765.518206862711 00:25:08 INFO - PROCESS | 23620 | |3;mootools.html;1381.3231516556891;1495.9401623935041;1496.5884381795006;1501.2943916359313;1502.5492352294316;7980.680772769089;8409.159084091587;8746.956265218665;8756.824863502734;8757.824843503126;8265.958670206655;8417.074121846606;8421.747347579567;8561.143885611436;8561.871571926411;2174.4672555223915;2246.1576908659254;2443.3647251714506;2496.10140349474;2503.249025292414;2496.463260399014;2574.4207553300453;2579.097315939425;2589.637450756886;2591.6371707960902;2434.257551446808;2440.511897620474;2458.311672731638;2467.1734968785477;2475.653408522808;2496.662950501677;2498.6127150291554;2516.9748302517105;2519.59686450168;2520.5463016656995;2438.682971213731;2496.7253602103756;2496.862672553009;2498.025769949721;2498.5127900059497;8542.017667968139;8571.228589426919;8588.613512391958;8592.14078592142;8606.698765543239;5400.270963419927;5520.06158952979;5532.1425179097305;5538.335399752015;5545.362283337387;3279.9344013119844;3303.174206448388;3510.5260789793306;3571.785692858437;3572.5712914450173;1338.4445455136204;1390.1867407566585;1392.0951381601938;1435.1389166500016;1446.327457732149;11704.005159561448;12080.033597312195;12082.818757718553;12106.394680265952;12111;4841.975790121097;4889.731064791471;4987.127252730757;5003.974980125076;5030.924536131961;10364.740881477872;10409.271351005356;10413.42726150054;10417.9479102604;10420.531076101593;5592.720363981784;5603.215549823028;5606.299212598426;5610.13042978339;5613.10190369547;4856.538628830326;4888.071266459361;4940.061388336205;4976.253561965734;5022.096022715873;3929.9017524562114;4023.4166045923175;4032.3749818778138;4042.514898212233;4094.815733292009;1181.5155786127646;1194.1700518139983;1197.4252358867793;1200.9099317551045;1202.9518819247132;881.8412685716632;884.2351366068305;898.9640414383351;922.1378011559214;967.6371360739722;5805.767769289266;5896;6037.879242415127;6196.549286660049;6320.178376810985;1077.0790973717515;1086.9510872010621;1092.6175838456477;1101.9944900275607;1121.7195701074731;3992.2215168042535;4147.834086636501;4181.372794080912;4198.328267477189;4278.422412974271;10509.684709458728;10782.191335649857;10788.676339709822;10845.186611004206;10846.511906964206;10453.895461045444;10525.84211236832;10626.096781773636;10655.786884262272;10692.572297108029;8262.256396924306;8372.455790373606;8385.203405676451;8386.371022173484;8393.790155246168;5921.763129474945;5928;6006.819795406145;6020.939790602213;6063.514918806573;9281;9739.366941148803;9739.659111931049;9748.268879834182;9784.559694813608;8887.777805554913;9731.221502279659;9856.112949834549;9923.801523969336;9954;6996.440284777307;7476.813079672834;7618.69525218985;7711.845763084819;7815;8458;8477.491350518989;8566.443181193203;8584.098669639849;8594.957025214833;7424.851502969802;7483.476156668981;7529.209433009674;7667.769966901002;7704.191059938626;7481.251874812475;7500.212477689982;7590.468667193243;7600.96199519021;7661.923380766344;6773.796786096425;6783.728650853911;6850.588964662136;6861.656917154222;6875.312468753084;5002.174641184164;5038.697678139323;5074.188129899198;5084.161113416393;5116.4627714090975;4984.327115839315;5014.420457555858;5157.613179011514;5157.922631160461;5232.1628539433505 00:25:08 INFO - PROCESS | 23620 | |4;prototype.html;381.7308797297905;404.77353618535847;408.3181087583737;408.5363112866896;413.38612160941005;5408.161734931087;5416.5937554683405;5472.5621950243885;5493.670379777216;5494.846082322712;5183.326167598217;5238.8690282742955;5294.014744470824;5333.813136613989;5444.3194600674915;4316.115196384733;4326.8269269229195;4327.870163895088;4330.631896288819;4346.39150518926;4343.761093139876;4351.325544540601;4357.673174511909;4379.802908869093;4386.846460373888;4025.2553277643583;4091.1817636472674;4237.512686041114;4248.490181178247;4324.308110702288;4216.2199993001395;4235.830566777326;4258.850940217093;4262.531121576624;4274.059706864485;3842.346801043829;3863.806809659534;3876.573576906538;3879.39869320253;3885.30064588374;5196.8960620787375;5200.349956255468;5236.3978142513715;5260.92108618371;5287.23335116406;4908.779104940286;4954.628402869799;4973.523828554294;4974.900501989976;4980.526849949249;5627.493525582676;5638.182463542805;5653.604247702662;5683.175939488751;5683.2895888014;4225.852095176685;4281.571842815724;4284.507281662618;4297.935530967038;4339.631131353839;5776.826695199109;5784.36371999084;5790.623609465371;5828.096645019987;5839.7664093436215;4455.131249406335;4462.174497717932;4468.4414448193975;4484.148011877733;4489.9775501122285;4058.9594104058583;4226.36604509326;4258.233517966733;4534.4380425059735;4538.818447262139;4812.868975790687;4812.951870481321;4834.178189707758;4834.274858771142;4834.516548345207;5628.493435590816;5653.869226154786;5666.348369937427;5668.801591944262;5727.5131613812455;1379.7240551889663;1421.410114802366;1439.6760728835927;1451.9128852268898;1457.1475686723386;931.7670582354411;947.5641205045619;973.8003709239589;980.2060331131663;981.474910922653;5293.444188360244;5295.232191332312;5317.54800841925;5321.308229930084;5325.866853328698;5584.636998595079;5617.174418313983;5617.522510586646;5618.578606604521;5662.801801936995;5134.435212126663;5267.762950667229;5279.392869819943;5300;5311.786369246627;2966.8071575347535;2975.479291124088;2990.6560745514544;2997;3000.6249218847643;5479.698616576126;5663.677892064234;5762.971185144047;5773.942260577341;5853.88292234153;5650.5479561634975;5662.66024038559;5679.630823996427;5691.345495268014;5711.742971566289;5747.195392645117;5751;5799.739011744397;5799.927013502515;5818.679972601548;5284.577233821208;5533.197686335539;5556.777728890799;5573.27547418833;5587.2120921304795;5461.945380546303;5464.508194262536;5497.312835895513;5501.917471237854;5539.396483652677;5522.475364840334;5804.533073443854;5809.302883653989;5816.94183058164;5818.534517238526;4104.261232977973;4118.5173337599035;4126.91746165069;4149.190907772955;4158.750474971512;5591.888162236651;5632.76079262578;5641.887162256814;5645.266115405136;5673.517750991047;5289.920651190312;5426.755795989111;5458.590605704668;5512;5525.502704756591;5414.783408663609;5417.864553386197;5423.776251736769;5440.455954404528;5446.727663616883;5375.731213439234;5414.675119492843;5432.483914028161;5439.347278326626;5496.175573663822;5506.779728810963;5600.327960644749;5662.971685141548;5670.432956704297;5683.914741278802;5553.611247212656;5562.774890044015;5564.8330550083565;5568.749406276808;5571.3871474137 00:25:08 INFO - PROCESS | 23620 | |5;yui.html;817.8568750468667;825.6232011074703;827.5572568675759;910.8633704944259;927.4713413354388;17239.913800430997;17467.82532174678;17861.732074018884;18105.185266663;18259;16347.673046539063;16707.91646041768;16709.91645041776;16712.83287167128;16726.49820505384;814.2956342763512;832.8958880139983;835.9205875441824;836.4855613797502;842.9030661473947;715.8818794898835;734.4271468254769;809.1746418652971;829.1625458287114;829.9170082991683;860.8579584368572;861.0270394454258;861.5132450165636;861.7113267055513;861.9138086191363;850.9787255318605;857.4555157475017;857.7812657772259;858.3733874271754;858.4291446188278;540.5405405405413;552.7816512477589;618.9350118237566;637.8118455055724;643.925948515922;16282.918585407115;16314.918425407915;16346.264418101095;16347.509574712778;16347.673046539121;15675.843241567552;15814.367425302975;15864.92067539655;15867.365305387772;16293.755593666105;14569.635759106;14604.196769177692;14655.34050967709;14699.926500367537;14776;4794.424669039738;4795.568398844086;4807.687500312469;4819.469858315618;4919.680220785674;85309;85701.57149214276;85743;87184;87803;11350.772984540263;11449.828252576051;11479.196456247982;11505.367204803648;11531.308121512737;21514.677279840816;21826.345209643736;21841.67237491439;22701.432464188198;22957.426064348525;8553.57232138403;8669.523176225368;8782;8805.559722013873;8880.378373513791;4803.639727020487;4812.25410061441;4835.95164048355;4863.635227357962;4914.754262286943;3722.5346831646043;3814.6185381461632;3908.7068469864876;3917;3963.7027222958395;686.1868685607471;690.5097380859545;698.5494356140262;700.2997002997002;702.6065403374025;767.6468824340755;767.7274567528559;770.7456539342004;778.7702627724835;784.6351446577255;9982.201423886072;10513.684589462327;10701;10731.785364292671;10757;767.3439209475818;771.8494893495827;777.3081957058223;789.0964845252154;837.4179944938331;5042.42012168598;5142.897142057138;5190.92213616796;5209.947900520946;5233.162693968947;81363.59318203371;82150.58924705339;83144.58427707944;84277;84723.5763821177;55937.440625593226;56376.71811640915;65038;66985.66507167433;67731;60191;60507.69746151241;60780.392196077475;61212.38787612156;62085.37914620796;10658.893411066101;11134.610288639858;11197.328160310408;11263.584040094342;11416.429178541206;41168;41641.16717665569;41809.372859406525;42333.788331058146;43025.139497210504;49278.260826086924;49691;49776.751116245636;54006.3798086058;55166.17250741323;14042.1574705518;15099.54701358961;15173.544793656209;15231;15358.385664573292;16260.837391625932;16354.427595034116;16368.918155409146;16455.25951332169;17155.65688686244;15628;15755.054696718234;15771.605709856887;15847.762283565526;16078.598035049217;14761.409543618134;15011.849881501044;15599.688006240038;15926.68146637084;16054.839451605334;15155;15374.615634609225;16053.438129665406;16246.593835154215;16274.186290685655;12781.297028663514;12855.87144128584;13203.867961320648;13365.465381385025;13498.52755153565;11633.825492617787;11651.766964660828;11993.520259189883;12363.93818030904;12547.121701480808 00:25:08 INFO - PROCESS | 23620 | __end_tp_report 00:25:08 INFO - PROCESS | 23620 | __start_cc_report 00:25:08 INFO - PROCESS | 23620 | _x_x_mozilla_cycle_collect,1001 00:25:08 INFO - PROCESS | 23620 | __end_cc_report 00:25:08 INFO - PROCESS | 23620 | __startTimestamp1485505508055__endTimestamp 00:25:08 INFO - PROCESS | 23620 | 00:25:08 INFO - PROCESS | 23620 | ------- Summary: start ------- 00:25:08 INFO - PROCESS | 23620 | Number of tests: 6 00:25:08 INFO - PROCESS | 23620 | 00:25:08 INFO - PROCESS | 23620 | [#0] dojo.html Cycles:165 Average:5445.44 Median:5688.94 stddev:631.22 (11.1%) stddev-sans-first:608.13 00:25:08 INFO - PROCESS | 23620 | Values: 3202.2 3202.9 3216.8 3232.9 3249.2 5405.4 5478.6 5487.8 5491.1 5507.8 5445.6 5460.3 5472.9 5496.3 5507.3 4843.4 4860.9 4875.4 4895.3 4908.0 4786.4 4824.0 4891.8 4933.2 4963.8 4858.4 4864.2 4868.1 4921.2 4943.5 4973.7 4976.1 4977.6 4995.3 5004.5 4751.9 4893.9 4894.6 4918.9 4929.0 5263.4 5306.8 5342.4 5358.9 5424.0 5768.9 5794.8 5798.4 5813.4 5818.6 5788.3 5821.2 5858.0 5881.3 5882.9 5404.2 5431.9 5434.4 5436.2 5480.9 5979.8 5982.7 5990.4 6014.3 6021.6 5777.0 5780.6 5783.6 5789.3 5803.7 5700.7 5713.3 5821.4 5828.0 5874.2 5847.4 5905.3 5920.9 5927.7 5943.1 5927.6 5933.9 5934.9 5946.8 5949.1 4449.7 4451.0 4481.8 4557.2 4572.4 3974.1 3980.4 4014.4 4028.0 4033.9 5576.9 5584.1 5584.4 5585.6 5588.4 5730.3 5835.7 5860.9 5889.1 5925.6 5688.9 5701.5 5707.0 5716.2 5724.3 5080.1 5084.4 5084.8 5086.3 5088.3 5950.0 6005.9 6098.4 6191.2 6201.0 5952.1 5975.3 5998.8 6023.9 6024.6 6204.3 6214.0 6220.3 6223.4 6228.6 5605.6 5616.2 5795.3 5851.0 5868.4 5809.3 5862.1 5863.6 5867.3 5938.5 5762.7 5767.9 5768.7 5781.9 5789.1 5644.5 5737.6 5742.2 5750.7 5755.4 5592.3 5608.3 5619.4 5619.4 5714.3 5733.0 5748.3 5759.9 5762.2 5767.4 5634.5 5635.5 5637.6 5642.8 5651.2 00:25:08 INFO - PROCESS | 23620 | 00:25:08 INFO - PROCESS | 23620 | [#1] ext.html Cycles:180 Average:62482.36 Median:43480.12 stddev:114067.45 (262.3%) stddev-sans-first:114292.69 00:25:08 INFO - PROCESS | 23620 | Values: 560.3 592.7 631.0 631.4 655.7 36329.8 46923.0 48078.8 48265.0 48464.3 51298.7 51459.7 51741.0 51830.5 51869.7 8781.9 9280.8 9459.3 9466.3 9468.6 8621.0 11156.9 11352.7 11364.3 11835.1 11392.7 11462.4 11463.0 11467.8 11473.7 9026.2 9165.0 11241.8 11321.0 11330.0 11035.6 11235.4 11239.5 11772.6 11772.9 49206.8 49756.5 49774.3 49836.0 49837.8 4510.3 4557.0 4569.9 4671.6 4736.8 35198.6 35215.8 36223.5 36453.0 36704.3 4428.3 4434.4 4545.2 4635.4 4673.5 326596.0 328420.0 328808.0 329816.0 330284.0 70899.0 70914.3 71056.6 71196.6 71500.3 74004.3 74489.6 74860.0 75012.0 75223.2 17709.4 17988.0 18015.5 18023.2 18046.2 12236.8 12621.6 12748.7 12799.7 12835.0 19664.1 21363.7 21440.7 21466.5 21479.1 7057.2 7095.2 7216.5 7219.2 7264.6 1003.7 1017.3 1020.3 1038.6 1038.6 34789.5 35260.6 35531.0 35584.7 35771.3 1098.3 1186.6 1205.1 1230.5 1240.2 18521.5 18548.0 18678.8 18809.7 18906.2 521798.0 525074.0 525288.0 525976.0 526172.0 71746.3 71879.3 71899.3 71931.3 72037.0 1535.9 1540.7 1544.3 1560.4 1593.5 32268.5 33513.8 33882.8 34249.3 34396.8 59247.0 59747.7 59889.0 60034.4 60161.1 419240.0 419451.0 421034.0 422599.0 422750.0 41325.8 41598.6 44764.0 44824.6 46659.5 52904.2 53278.5 53976.5 54149.7 54782.5 44668.3 45146.5 45309.0 45871.1 46795.5 43330.7 44597.3 45313.0 45893.3 45955.8 43629.6 43800.3 45035.8 45197.1 45295.0 35222.3 38408.8 38926.8 39085.8 39223.6 28088.6 29480.3 29820.3 30297.7 30790.0 00:25:08 INFO - PROCESS | 23620 | 00:25:08 INFO - PROCESS | 23620 | [#2] jquery.html Cycles:180 Average:35744.97 Median:22870.20 stddev:106464.79 (465.5%) stddev-sans-first:106730.44 00:25:08 INFO - PROCESS | 23620 | Values: 435.8 445.1 445.2 446.5 452.4 20111.5 21218.9 22213.7 22375.8 22454.9 22397.4 22615.2 23125.2 23568.6 23809.0 5909.2 5937.2 6157.1 6164.5 6168.8 5955.2 5983.5 5987.8 5992.6 6000.7 5780.9 5955.6 5960.6 5961.0 5970.8 5958.9 5994.3 5996.3 6001.9 6002.0 5327.4 5340.0 5384.6 5391.0 5394.0 26242.0 26383.5 26411.3 26434.9 26544.5 2999.7 3071.3 3117.0 3141.9 3145.8 14395.7 15302.4 15387.8 15868.9 16101.8 1972.2 2021.8 2023.9 2027.2 2028.9 91951.5 92812.0 94228.1 95337.5 97005.0 10980.3 11201.0 11247.5 11343.9 11436.4 17199.7 17206.1 17281.5 17317.7 17385.3 8737.5 8841.2 8847.9 8858.1 8880.9 8314.5 8363.1 8425.2 8593.8 8622.4 7317.5 7409.4 7541.4 7546.5 7548.6 1921.6 1948.6 1994.9 2001.6 2027.6 944.9 949.2 951.7 956.1 968.4 19823.2 21564.0 21610.6 21695.2 21868.0 979.1 988.2 989.5 990.0 1007.7 11847.3 13002.2 13288.5 13339.9 13345.0 469811.0 677142.0 678279.0 684459.0 701377.0 91054.0 93197.0 100677.0 114042.4 121352.0 1172.2 1181.1 1203.5 1207.5 1227.2 18925.5 19273.6 19365.7 19418.3 19500.1 36998.4 43016.6 44275.0 46522.3 51483.7 64275.4 67440.0 68760.7 71268.5 74628.0 13681.8 14649.8 14863.3 14892.4 15325.4 11515.3 12232.8 15362.2 16371.7 16736.1 13108.8 13522.9 13665.1 13929.2 14164.7 12970.4 13225.9 13497.6 13516.4 13975.9 13502.5 13894.0 13930.9 14376.7 14579.0 14793.4 14923.9 15017.9 15212.5 15415.2 13612.4 13698.5 13714.9 13718.8 13765.5 00:25:08 INFO - PROCESS | 23620 | 00:25:08 INFO - PROCESS | 23620 | [#3] mootools.html Cycles:180 Average:5787.29 Median:5018.26 stddev:3165.99 (63.1%) stddev-sans-first:3157.55 00:25:08 INFO - PROCESS | 23620 | Values: 1381.3 1495.9 1496.6 1501.3 1502.5 7980.7 8409.2 8747.0 8756.8 8757.8 8266.0 8417.1 8421.7 8561.1 8561.9 2174.5 2246.2 2443.4 2496.1 2503.2 2496.5 2574.4 2579.1 2589.6 2591.6 2434.3 2440.5 2458.3 2467.2 2475.7 2496.7 2498.6 2517.0 2519.6 2520.5 2438.7 2496.7 2496.9 2498.0 2498.5 8542.0 8571.2 8588.6 8592.1 8606.7 5400.3 5520.1 5532.1 5538.3 5545.4 3279.9 3303.2 3510.5 3571.8 3572.6 1338.4 1390.2 1392.1 1435.1 1446.3 11704.0 12080.0 12082.8 12106.4 12111.0 4842.0 4889.7 4987.1 5004.0 5030.9 10364.7 10409.3 10413.4 10417.9 10420.5 5592.7 5603.2 5606.3 5610.1 5613.1 4856.5 4888.1 4940.1 4976.3 5022.1 3929.9 4023.4 4032.4 4042.5 4094.8 1181.5 1194.2 1197.4 1200.9 1203.0 881.8 884.2 899.0 922.1 967.6 5805.8 5896.0 6037.9 6196.5 6320.2 1077.1 1087.0 1092.6 1102.0 1121.7 3992.2 4147.8 4181.4 4198.3 4278.4 10509.7 10782.2 10788.7 10845.2 10846.5 10453.9 10525.8 10626.1 10655.8 10692.6 8262.3 8372.5 8385.2 8386.4 8393.8 5921.8 5928.0 6006.8 6020.9 6063.5 9281.0 9739.4 9739.7 9748.3 9784.6 8887.8 9731.2 9856.1 9923.8 9954.0 6996.4 7476.8 7618.7 7711.8 7815.0 8458.0 8477.5 8566.4 8584.1 8595.0 7424.9 7483.5 7529.2 7667.8 7704.2 7481.3 7500.2 7590.5 7601.0 7661.9 6773.8 6783.7 6850.6 6861.7 6875.3 5002.2 5038.7 5074.2 5084.2 5116.5 4984.3 5014.4 5157.6 5157.9 5232.2 00:25:08 INFO - PROCESS | 23620 | 00:25:08 INFO - PROCESS | 23620 | [#4] prototype.html Cycles:180 Average:4726.17 Median:5354.77 stddev:1334.97 (24.9%) stddev-sans-first:1298.28 00:25:08 INFO - PROCESS | 23620 | Values: 381.7 404.8 408.3 408.5 413.4 5408.2 5416.6 5472.6 5493.7 5494.8 5183.3 5238.9 5294.0 5333.8 5444.3 4316.1 4326.8 4327.9 4330.6 4346.4 4343.8 4351.3 4357.7 4379.8 4386.8 4025.3 4091.2 4237.5 4248.5 4324.3 4216.2 4235.8 4258.9 4262.5 4274.1 3842.3 3863.8 3876.6 3879.4 3885.3 5196.9 5200.3 5236.4 5260.9 5287.2 4908.8 4954.6 4973.5 4974.9 4980.5 5627.5 5638.2 5653.6 5683.2 5683.3 4225.9 4281.6 4284.5 4297.9 4339.6 5776.8 5784.4 5790.6 5828.1 5839.8 4455.1 4462.2 4468.4 4484.1 4490.0 4059.0 4226.4 4258.2 4534.4 4538.8 4812.9 4813.0 4834.2 4834.3 4834.5 5628.5 5653.9 5666.3 5668.8 5727.5 1379.7 1421.4 1439.7 1451.9 1457.1 931.8 947.6 973.8 980.2 981.5 5293.4 5295.2 5317.5 5321.3 5325.9 5584.6 5617.2 5617.5 5618.6 5662.8 5134.4 5267.8 5279.4 5300.0 5311.8 2966.8 2975.5 2990.7 2997.0 3000.6 5479.7 5663.7 5763.0 5773.9 5853.9 5650.5 5662.7 5679.6 5691.3 5711.7 5747.2 5751.0 5799.7 5799.9 5818.7 5284.6 5533.2 5556.8 5573.3 5587.2 5461.9 5464.5 5497.3 5501.9 5539.4 5522.5 5804.5 5809.3 5816.9 5818.5 4104.3 4118.5 4126.9 4149.2 4158.8 5591.9 5632.8 5641.9 5645.3 5673.5 5289.9 5426.8 5458.6 5512.0 5525.5 5414.8 5417.9 5423.8 5440.5 5446.7 5375.7 5414.7 5432.5 5439.3 5496.2 5506.8 5600.3 5663.0 5670.4 5683.9 5553.6 5562.8 5564.8 5568.7 5571.4 00:25:08 INFO - PROCESS | 23620 | 00:25:08 INFO - PROCESS | 23620 | [#5] yui.html Cycles:180 Average:18370.33 Median:4799.60 stddev:22548.75 (469.8%) stddev-sans-first:22573.48 00:25:08 INFO - PROCESS | 23620 | Values: 817.9 825.6 827.6 910.9 927.5 17239.9 17467.8 17861.7 18105.2 18259.0 16347.7 16707.9 16709.9 16712.8 16726.5 814.3 832.9 835.9 836.5 842.9 715.9 734.4 809.2 829.2 829.9 860.9 861.0 861.5 861.7 861.9 851.0 857.5 857.8 858.4 858.4 540.5 552.8 618.9 637.8 643.9 16282.9 16314.9 16346.3 16347.5 16347.7 15675.8 15814.4 15864.9 15867.4 16293.8 14569.6 14604.2 14655.3 14699.9 14776.0 4794.4 4795.6 4807.7 4819.5 4919.7 85309.0 85701.6 85743.0 87184.0 87803.0 11350.8 11449.8 11479.2 11505.4 11531.3 21514.7 21826.3 21841.7 22701.4 22957.4 8553.6 8669.5 8782.0 8805.6 8880.4 4803.6 4812.3 4836.0 4863.6 4914.8 3722.5 3814.6 3908.7 3917.0 3963.7 686.2 690.5 698.5 700.3 702.6 767.6 767.7 770.7 778.8 784.6 9982.2 10513.7 10701.0 10731.8 10757.0 767.3 771.8 777.3 789.1 837.4 5042.4 5142.9 5190.9 5209.9 5233.2 81363.6 82150.6 83144.6 84277.0 84723.6 55937.4 56376.7 65038.0 66985.7 67731.0 60191.0 60507.7 60780.4 61212.4 62085.4 10658.9 11134.6 11197.3 11263.6 11416.4 41168.0 41641.2 41809.4 42333.8 43025.1 49278.3 49691.0 49776.8 54006.4 55166.2 14042.2 15099.5 15173.5 15231.0 15358.4 16260.8 16354.4 16368.9 16455.3 17155.7 15628.0 15755.1 15771.6 15847.8 16078.6 14761.4 15011.8 15599.7 15926.7 16054.8 15155.0 15374.6 16053.4 16246.6 16274.2 12781.3 12855.9 13203.9 13365.5 13498.5 11633.8 11651.8 11993.5 12363.9 12547.1 00:25:08 INFO - PROCESS | 23620 | -------- Summary: end -------- 00:25:08 INFO - PROCESS | 23620 | 00:25:08 INFO - TEST-INFO | 23620: exit 0 00:25:08 INFO - TEST-OK | dromaeo_css | took 1113824ms 00:25:08 INFO - TEST-START | kraken 00:25:08 INFO - operating with platform_type : linux_ 00:25:08 INFO - Initialising browser for kraken test... 00:25:08 INFO - TEST-INFO | started process 23946 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp4orW6F/profile http://localhost:46990/getInfo.html) 00:25:12 INFO - PROCESS | 23946 | __metrics Screen width/height:1600/1200 00:25:12 INFO - PROCESS | 23946 | colorDepth:24 00:25:12 INFO - PROCESS | 23946 | Browser inner width/height: 1024/697 00:25:12 INFO - PROCESS | 23946 | __metrics 00:25:13 INFO - PROCESS | 23946 | JavaScript error: resource://gre/modules/AsyncShutdown.jsm, line 692: Error: Phase "quit-application-granted" is finished, it is too late to register completion condition "SessionStore: flushing all windows" 00:25:13 INFO - PROCESS | 23946 | JavaScript error: resource://app/modules/BrowserUsageTelemetry.jsm, line 303: NS_ERROR_FAILURE: Component returned failure code: 0x80004005 (NS_ERROR_FAILURE) [nsIObserverService.removeObserver] 00:25:14 INFO - PROCESS | 23946 | console.error: PushService: 00:25:14 INFO - PROCESS | 23946 | stateChangeProcessEnqueue: Error transitioning state 00:25:14 INFO - PROCESS | 23946 | UnknownError 00:25:14 INFO - TEST-INFO | 23946: exit 0 00:25:14 INFO - Browser initialized. 00:25:14 INFO - Running cycle 1/1 for kraken test... 00:25:14 INFO - TEST-INFO | started process 24037 (/builds/slave/test/build/application/firefox/firefox -profile /tmp/tmp4orW6F/profile -tp file:/builds/slave/test/build/tests/talos/talos/tests/kraken/kraken.manifest.develop -tpchrome -tpnoisy -tpcycles 1 -tppagecycles 1) 00:25:26 INFO - PROCESS | 24037 | RSS: Main: 142331904 00:25:26 INFO - PROCESS | 24037 | 00:25:28 INFO - PROCESS | 24037 | Cycle 1(1): loaded http://localhost:46990/tests/kraken/driver.html?testName=ai-astar (next: http://localhost:46990/tests/kraken/driver.html?testName=audio-beat-detection) 00:25:29 INFO - PROCESS | 24037 | RSS: Main: 185937920 00:25:29 INFO - PROCESS | 24037 | 00:25:32 INFO - PROCESS | 24037 | Cycle 1(1): loaded http://localhost:46990/tests/kraken/driver.html?testName=audio-beat-detection (next: http://localhost:46990/tests/kraken/driver.html?testName=audio-dft) 00:25:32 INFO - PROCESS | 24037 | RSS: Main: 175894528 00:25:32 INFO - PROCESS | 24037 | 00:25:35 INFO - PROCESS | 24037 | Cycle 1(1): loaded http://localhost:46990/tests/kraken/driver.html?testName=audio-dft (next: http://localhost:46990/tests/kraken/driver.html?testName=audio-fft) 00:25:36 INFO - PROCESS | 24037 | RSS: Main: 266612736 00:25:36 INFO - PROCESS | 24037 | 00:25:38 INFO - PROCESS | 24037 | Cycle 1(1): loaded http://localhost:46990/tests/kraken/driver.html?testName=audio-fft (next: http://localhost:46990/tests/kraken/driver.html?testName=audio-oscillator) 00:25:38 INFO - PROCESS | 24037 | RSS: Main: 173993984 00:25:38 INFO - PROCESS | 24037 | 00:25:41 INFO - PROCESS | 24037 | Cycle 1(1): loaded http://localhost:46990/tests/kraken/driver.html?testName=audio-oscillator (next: http://localhost:46990/tests/kraken/driver.html?testName=imaging-gaussian-blur) 00:25:41 INFO - PROCESS | 24037 | RSS: Main: 176492544 00:25:41 INFO - PROCESS | 24037 | 00:25:44 INFO - PROCESS | 24037 | Cycle 1(1): loaded http://localhost:46990/tests/kraken/driver.html?testName=imaging-gaussian-blur (next: http://localhost:46990/tests/kraken/driver.html?testName=imaging-darkroom) 00:25:45 INFO - PROCESS | 24037 | RSS: Main: 215617536 00:25:45 INFO - PROCESS | 24037 | 00:25:48 INFO - PROCESS | 24037 | Cycle 1(1): loaded http://localhost:46990/tests/kraken/driver.html?testName=imaging-darkroom (next: http://localhost:46990/tests/kraken/driver.html?testName=imaging-desaturate) 00:25:49 INFO - PROCESS | 24037 | RSS: Main: 213942272 00:25:49 INFO - PROCESS | 24037 | 00:25:51 INFO - PROCESS | 24037 | Cycle 1(1): loaded http://localhost:46990/tests/kraken/driver.html?testName=imaging-desaturate (next: http://localhost:46990/tests/kraken/driver.html?testName=json-parse-financial) 00:25:52 INFO - PROCESS | 24037 | RSS: Main: 211714048 00:25:52 INFO - PROCESS | 24037 | 00:25:53 INFO - PROCESS | 24037 | Cycle 1(1): loaded http://localhost:46990/tests/kraken/driver.html?testName=json-parse-financial (next: http://localhost:46990/tests/kraken/driver.html?testName=json-stringify-tinderbox) 00:25:54 INFO - PROCESS | 24037 | RSS: Main: 174047232 00:25:54 INFO - PROCESS | 24037 | 00:25:56 INFO - PROCESS | 24037 | Cycle 1(1): loaded http://localhost:46990/tests/kraken/driver.html?testName=json-stringify-tinderbox (next: http://localhost:46990/tests/kraken/driver.html?testName=stanford-crypto-aes) 00:25:56 INFO - PROCESS | 24037 | RSS: Main: 180719616 00:25:56 INFO - PROCESS | 24037 | 00:25:58 INFO - PROCESS | 24037 | Cycle 1(1): loaded http://localhost:46990/tests/kraken/driver.html?testName=stanford-crypto-aes (next: http://localhost:46990/tests/kraken/driver.html?testName=stanford-crypto-ccm) 00:25:59 INFO - PROCESS | 24037 | RSS: Main: 187949056 00:25:59 INFO - PROCESS | 24037 | 00:26:02 INFO - PROCESS | 24037 | Cycle 1(1): loaded http://localhost:46990/tests/kraken/driver.html?testName=stanford-crypto-ccm (next: http://localhost:46990/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2) 00:26:02 INFO - PROCESS | 24037 | RSS: Main: 197341184 00:26:02 INFO - PROCESS | 24037 | 00:26:05 INFO - PROCESS | 24037 | Cycle 1(1): loaded http://localhost:46990/tests/kraken/driver.html?testName=stanford-crypto-pbkdf2 (next: http://localhost:46990/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative) 00:26:05 INFO - PROCESS | 24037 | RSS: Main: 193208320 00:26:05 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | Cycle 1(1): loaded http://localhost:46990/tests/kraken/driver.html?testName=stanford-crypto-sha256-iterative (next: http://localhost:46990/tests/kraken/driver.html?testName=ai-astar) 00:26:07 INFO - PROCESS | 24037 | RSS: Main: 245452800 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | __start_tp_report 00:26:07 INFO - PROCESS | 24037 | _x_x_mozilla_page_load 00:26:07 INFO - PROCESS | 24037 | _x_x_mozilla_page_load_details 00:26:07 INFO - PROCESS | 24037 | |i|pagename|runs| 00:26:07 INFO - PROCESS | 24037 | |0;ai-astar;111;111;110;111;113;111;110;110;110;110 00:26:07 INFO - PROCESS | 24037 | |1;audio-beat-detection;150;117;117;158;119;119;117;119;147;119 00:26:07 INFO - PROCESS | 24037 | |2;audio-dft;159;161;159;159;160;160;160;160;159;159 00:26:07 INFO - PROCESS | 24037 | |3;audio-fft;74;76;75;113;77;76;76;76;89;75 00:26:07 INFO - PROCESS | 24037 | |4;audio-oscillator;82;81;107;83;83;83;95;83;83;112 00:26:07 INFO - PROCESS | 24037 | |5;imaging-gaussian-blur;118;116;117;116;117;118;117;117;118;116 00:26:07 INFO - PROCESS | 24037 | |6;imaging-darkroom;146;146;147;147;147;146;146;146;146;145 00:26:07 INFO - PROCESS | 24037 | |7;imaging-desaturate;96;95;95;95;95;96;95;95;95;95 00:26:07 INFO - PROCESS | 24037 | |8;json-parse-financial;50;48;48;53;51;48;48;49;50;49 00:26:07 INFO - PROCESS | 24037 | |9;json-stringify-tinderbox;63;65;65;64;64;63;64;63;64;65 00:26:07 INFO - PROCESS | 24037 | |10;stanford-crypto-aes;85;75;76;78;77;77;77;77;83;76 00:26:07 INFO - PROCESS | 24037 | |11;stanford-crypto-ccm;123;130;131;121;127;120;120;120;149;130 00:26:07 INFO - PROCESS | 24037 | |12;stanford-crypto-pbkdf2;158;158;162;157;163;159;157;159;160;156 00:26:07 INFO - PROCESS | 24037 | |13;stanford-crypto-sha256-iterative;63;63;60;60;61;61;59;59;60;59 00:26:07 INFO - PROCESS | 24037 | __end_tp_report 00:26:07 INFO - PROCESS | 24037 | __start_cc_report 00:26:07 INFO - PROCESS | 24037 | _x_x_mozilla_cycle_collect,1512 00:26:07 INFO - PROCESS | 24037 | __end_cc_report 00:26:07 INFO - PROCESS | 24037 | __startTimestamp1485505567886__endTimestamp 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | ------- Summary: start ------- 00:26:07 INFO - PROCESS | 24037 | Number of tests: 14 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | [#0] ai-astar Cycles:10 Average:110.70 Median:111.00 stddev:0.95 (0.9%) stddev-sans-first:1.00 00:26:07 INFO - PROCESS | 24037 | Values: 111.0 111.0 110.0 111.0 113.0 111.0 110.0 110.0 110.0 110.0 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | [#1] audio-beat-detection Cycles:10 Average:128.20 Median:119.00 stddev:16.44 (13.8%) stddev-sans-first:15.43 00:26:07 INFO - PROCESS | 24037 | Values: 150.0 117.0 117.0 158.0 119.0 119.0 117.0 119.0 147.0 119.0 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | [#2] audio-dft Cycles:10 Average:159.60 Median:160.00 stddev:0.70 (0.4%) stddev-sans-first:0.71 00:26:07 INFO - PROCESS | 24037 | Values: 159.0 161.0 159.0 159.0 160.0 160.0 160.0 160.0 159.0 159.0 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | [#3] audio-fft Cycles:10 Average:80.70 Median:76.00 stddev:12.13 (16.0%) stddev-sans-first:12.62 00:26:07 INFO - PROCESS | 24037 | Values: 74.0 76.0 75.0 113.0 77.0 76.0 76.0 76.0 89.0 75.0 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | [#4] audio-oscillator Cycles:10 Average:89.20 Median:83.00 stddev:11.46 (13.8%) stddev-sans-first:11.85 00:26:07 INFO - PROCESS | 24037 | Values: 82.0 81.0 107.0 83.0 83.0 83.0 95.0 83.0 83.0 112.0 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | [#5] imaging-gaussian-blur Cycles:10 Average:117.00 Median:117.00 stddev:0.82 (0.7%) stddev-sans-first:0.78 00:26:07 INFO - PROCESS | 24037 | Values: 118.0 116.0 117.0 116.0 117.0 118.0 117.0 117.0 118.0 116.0 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | [#6] imaging-darkroom Cycles:10 Average:146.20 Median:146.00 stddev:0.63 (0.4%) stddev-sans-first:0.67 00:26:07 INFO - PROCESS | 24037 | Values: 146.0 146.0 147.0 147.0 147.0 146.0 146.0 146.0 146.0 145.0 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | [#7] imaging-desaturate Cycles:10 Average:95.20 Median:95.00 stddev:0.42 (0.4%) stddev-sans-first:0.33 00:26:07 INFO - PROCESS | 24037 | Values: 96.0 95.0 95.0 95.0 95.0 96.0 95.0 95.0 95.0 95.0 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | [#8] json-parse-financial Cycles:10 Average:49.40 Median:49.50 stddev:1.65 (3.3%) stddev-sans-first:1.73 00:26:07 INFO - PROCESS | 24037 | Values: 50.0 48.0 48.0 53.0 51.0 48.0 48.0 49.0 50.0 49.0 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | [#9] json-stringify-tinderbox Cycles:10 Average:64.00 Median:64.00 stddev:0.82 (1.3%) stddev-sans-first:0.78 00:26:07 INFO - PROCESS | 24037 | Values: 63.0 65.0 65.0 64.0 64.0 63.0 64.0 63.0 64.0 65.0 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | [#10] stanford-crypto-aes Cycles:10 Average:78.10 Median:77.00 stddev:3.25 (4.2%) stddev-sans-first:2.29 00:26:07 INFO - PROCESS | 24037 | Values: 85.0 75.0 76.0 78.0 77.0 77.0 77.0 77.0 83.0 76.0 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | [#11] stanford-crypto-ccm Cycles:10 Average:127.10 Median:128.50 stddev:8.92 (6.9%) stddev-sans-first:9.34 00:26:07 INFO - PROCESS | 24037 | Values: 123.0 130.0 131.0 121.0 127.0 120.0 120.0 120.0 149.0 130.0 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | [#12] stanford-crypto-pbkdf2 Cycles:10 Average:158.90 Median:159.00 stddev:2.23 (1.4%) stddev-sans-first:2.35 00:26:07 INFO - PROCESS | 24037 | Values: 158.0 158.0 162.0 157.0 163.0 159.0 157.0 159.0 160.0 156.0 00:26:07 INFO - PROCESS | 24037 | 00:26:07 INFO - PROCESS | 24037 | [#13] stanford-crypto-sha256-iterative Cycles:10 Average:60.50 Median:60.50 stddev:1.51 (2.5%) stddev-sans-first:1.30 00:26:07 INFO - PROCESS | 24037 | Values: 63.0 63.0 60.0 60.0 61.0 61.0 59.0 59.0 60.0 59.0 00:26:07 INFO - PROCESS | 24037 | -------- Summary: end -------- 00:26:07 INFO - PROCESS | 24037 | 00:26:08 INFO - TEST-INFO | 24037: exit 0 00:26:08 INFO - TEST-OK | kraken | took 60050ms 00:26:08 INFO - SUITE-END | took 1173s 00:26:09 INFO - Completed test suite (00:19:34) 00:26:09 INFO - javascript benchmark 00:26:09 INFO - PERFHERDER_DATA: {"framework": {"name": "talos"}, "suites": [{"lowerIsBetter": false, "subtests": [{"name": "dojo.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [3202.183443221978, 3202.919927001825, 3216.8069915805045, 3232.9191770205757, 3249.2039450334673, 5405.35135783706, 5478.643888147268, 5487.835364939048, 5491.121420572709, 5507.752151153192, 5445.646033007862, 5460.31746031746, 5472.863178420542, 5496.31296087989, 5507.339119305689, 4843.418789745236, 4860.902781944359, 4875.439324477695, 4895.290182923474, 4907.975460122694, 4786.449558300787, 4823.975880120594, 4891.828785992491, 4933.161362568372, 4963.776630051656, 4858.441279252878, 4864.1730905745935, 4868.099401610696, 4921.237208232729, 4943.480934501879, 4973.676711013809, 4976.0545496355935, 4977.626677999165, 4995.325631039799, 5004.524570165829, 4751.928721069186, 4893.877653058702, 4894.559489645913, 4918.926216106761, 4929.038837426703, 5263.3947096083675, 5306.8407947761625, 5342.412334643186, 5358.866028349284, 5423.972880135574, 5768.942310576883, 5794.797182098649, 5798.391168927286, 5813.360530341659, 5818.6217895836635, 5788.305403351583, 5821.155932389822, 5857.970710146465, 5881.264841894763, 5882.882342353129, 5404.216388623667, 5431.891362172734, 5434.402215756343, 5436.157395603688, 5480.890382192374, 5979.820605381846, 5982.7008649568215, 5990.430909063632, 6014.308354539196, 6021.638701677914, 5777.017906955828, 5780.566457515703, 5783.595148339576, 5789.334226563915, 5803.709814509258, 5700.657960522382, 5713.257276554022, 5821.446962538552, 5828.038373668382, 5874.236349274567, 5847.386024467455, 5905.291365036223, 5920.881582368328, 5927.673977931255, 5943.108533719977, 5927.585069045125, 5933.881322373529, 5934.851628709317, 5946.821595352059, 5949.077892926517, 4449.7330160190495, 4450.955490445054, 4481.820727170942, 4557.202489564379, 4572.428446444194, 3974.0859602291634, 3980.44273801668, 4014.397840323975, 4027.979860100739, 4033.858814941463, 5576.860578485489, 5584.050711379075, 5584.413636568183, 5585.553155747531, 5588.385277619459, 5730.255066841284, 5835.708214589254, 5860.941390586125, 5889.087191485327, 5925.614835035709, 5688.943110568841, 5701.486866182064, 5707.0, 5716.171155182476, 5724.255846739898, 5080.13637681595, 5084.41529224144, 5084.847454576368, 5086.262491938648, 5088.313077734459, 5950.0, 6005.879882402328, 6098.390160983866, 6191.226096737908, 6201.0388389799655, 5952.077427998667, 5975.282966044103, 5998.760049598141, 6023.879522409439, 6024.638521688713, 6204.255489341127, 6214.036824292242, 6220.34686357944, 6223.377662233922, 6228.56400051992, 5605.5515558756015, 5616.157576363415, 5795.304563452412, 5851.034579294539, 5868.413158684098, 5809.2738407699035, 5862.062070068769, 5863.589548731547, 5867.295924488918, 5938.524918006463, 5762.711864406847, 5767.913481297868, 5768.711564421678, 5781.913271300849, 5789.131630255495, 5644.548436125182, 5737.627054241461, 5742.1673857289625, 5750.6837123958585, 5755.424457554379, 5592.273004509388, 5608.327000759935, 5619.353774315842, 5619.381867994435, 5714.285714285715, 5733.0, 5748.281464816898, 5759.9136012959, 5762.193292939076, 5767.423257674199, 5634.492895639248, 5635.492805647511, 5637.577181711306, 5642.802501912413, 5651.152327150796], "value": 5402.593026489715, "unit": "score"}, {"name": "ext.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [560.3136158206198, 592.6621825559431, 631.0187658191512, 631.4033238589535, 655.704932780249, 36329.818350908245, 46923.0, 48078.75960620201, 48265.03469930604, 48464.27303590449, 51298.743506282415, 51459.74270128644, 51741.0, 51830.481695183036, 51869.74065129669, 8781.868271975893, 9280.767980800467, 9459.337846350758, 9466.290028247875, 9468.573914173845, 8621.0, 11156.888431115665, 11352.659420217407, 11364.261323013978, 11835.05319574432, 11392.658220253406, 11462.426878656075, 11463.0, 11467.827982580267, 11473.655790326304, 9026.23277021454, 9165.0, 11241.83137252942, 11321.037711794508, 11330.036946859527, 11035.613753518668, 11235.382053987027, 11239.494222759995, 11772.646820595395, 11772.882271177265, 49206.75396622994, 49756.50243497555, 49774.253386199234, 49836.0, 49837.75081124607, 4510.300903359985, 4556.954430455686, 4569.9314510282375, 4671.649626278043, 4736.7631618418945, 35198.64244360141, 35215.82392088049, 36223.4566481503, 36453.0, 36704.26591468156, 4428.335749637548, 4434.423524941769, 4545.182465731571, 4635.397398338228, 4673.462551806551, 326596.0, 328420.0, 328808.0, 329816.0, 330284.0, 70899.0, 70914.2908570918, 71056.64471677608, 71196.64401677958, 71500.28499714936, 74004.25995739974, 74489.6275518619, 74860.0, 75012.0, 75223.24776752162, 17709.380171694185, 17988.0, 18015.54961125956, 18023.18895649699, 18046.187921543562, 12236.755264894653, 12621.558245461365, 12748.681282968, 12799.680007999688, 12835.0, 19664.131907468767, 21363.67954480684, 21440.678389824167, 21466.463338416354, 21479.14083436645, 7057.153141623038, 7095.219525852152, 7216.458765592602, 7219.241979592172, 7264.56637026602, 1003.7239759066315, 1017.3133135133903, 1020.280702105029, 1038.5949479702922, 1038.6209033702644, 34789.47815782765, 35260.64739352574, 35531.0, 35584.66230065459, 35771.28457430837, 1098.3464838421128, 1186.649938268213, 1205.1202622085927, 1230.5262473947416, 1240.193873981919, 18521.53696157607, 18548.0, 18678.81321186798, 18809.717854232196, 18906.243750250112, 521798.0, 525074.0, 525288.0, 525976.0, 526172.0, 71746.28253717396, 71879.28120718726, 71899.28100718926, 71931.28068719245, 72037.0, 1535.9308831102628, 1540.6841597472492, 1544.328217225488, 1560.3836484588523, 1593.529908676943, 32268.515972259964, 33513.83243083769, 33882.83058584691, 34249.31501369909, 34396.82801586076, 59247.0, 59747.701261493414, 59889.0, 60034.39965600288, 60161.09758353716, 419240.0, 419451.0, 421034.0, 422599.0, 422750.0, 41325.79337103295, 41598.584014159474, 44764.0, 44824.55175448334, 46659.53340466688, 52904.20643690271, 53278.46721532735, 53976.46023539714, 54149.72925135349, 54782.45217547774, 44668.32997505105, 45146.54853451555, 45309.0, 45871.08257834758, 46795.532044680476, 43330.68441442286, 44597.33104003378, 45313.0, 45893.31160032669, 45955.77022114868, 43629.56370436255, 43800.34299485574, 45035.774821125684, 45197.09605807931, 45295.0, 35222.29555408826, 38408.807955960045, 38926.80536597299, 39085.8045709781, 39223.60776392314, 28088.56530194918, 29480.262993425335, 29820.254493636963, 30297.697023029486, 30790.0], "value": 22449.574469408, "unit": "score"}, {"name": "jquery.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [435.82762369226776, 445.105338270077, 445.22086348889445, 446.51553064924553, 452.37572150432396, 20111.49721256969, 21218.89390553049, 22213.666794998047, 22375.776242237574, 22454.88772556137, 22397.44006399841, 22615.208467703633, 23125.19061832836, 23568.64647030296, 23809.0, 5909.231799866022, 5937.198478205431, 6157.107219453176, 6164.476019538344, 6168.84577885552, 5955.225820643311, 5983.461488466037, 5987.820365389045, 5992.5505587080925, 6000.669963152025, 5780.884382312352, 5955.642661440305, 5960.642361458305, 5960.986632272502, 5970.820875373724, 5958.851028724295, 5994.280686317648, 5996.340402555694, 6001.919654462239, 6002.0, 5327.440618735054, 5340.0, 5384.5692344612335, 5391.002664507039, 5393.9730301348245, 26242.0, 26383.47233055347, 26411.339716507242, 26434.86782566075, 26544.469110617873, 2999.655039670444, 3071.262896904749, 3116.9532457013165, 3141.8743250269963, 3145.779795414322, 14395.712085758227, 15302.387904483807, 15387.769183462256, 15868.920655396649, 16101.838981610268, 1972.1618312217395, 2021.757389113301, 2023.8785672859676, 2027.1789925080366, 2028.868123571963, 91951.54024229836, 92812.0, 94228.05771942262, 95337.52331238368, 97005.0, 10980.341179529254, 11201.0, 11247.493862776195, 11343.886561134448, 11436.370999594936, 17199.65600687979, 17206.1396930153, 17281.481555553353, 17317.653646927243, 17385.304587816598, 8737.51943643093, 8841.16008979146, 8847.867281990775, 8858.069902660256, 8880.8667869982, 8314.459560128573, 8363.080061193265, 8425.157484251526, 8593.828123437495, 8622.353323500762, 7317.52417601635, 7409.370203532652, 7541.35898448627, 7546.471746977769, 7548.584827834522, 1921.5868588253593, 1948.6102779444168, 1994.8703334283225, 2001.6096861111944, 2027.5944811037557, 944.8866136063716, 949.1694767078806, 951.70497145885, 956.1346980982222, 968.3560432312574, 19823.207071717257, 21564.0, 21610.56778864414, 21695.24066657691, 21868.0, 979.1383582447401, 988.1650005745134, 989.475577943691, 989.9851502227473, 1007.6573964851985, 11847.289162650097, 13002.219866808022, 13288.468461261635, 13339.933300333436, 13345.0, 469811.0, 677142.0, 678279.0, 684459.0, 701376.95869124, 91054.0, 93197.0, 100677.0, 114042.42978785053, 121352.0, 1172.1794743679459, 1181.1082632612495, 1203.4644583160584, 1207.4747484844122, 1227.2145826670937, 18925.526861828563, 19273.614527709648, 19365.709514357015, 19418.320358787376, 19500.122494488067, 36998.44502332521, 43016.56983430251, 44275.0, 46522.30216546687, 51483.74258128685, 64275.35724642694, 67440.0, 68760.6561967187, 71268.50560230367, 74628.0, 13681.79477307861, 14649.780253296422, 14863.331150098054, 14892.40430382816, 15325.386984520494, 11515.25150865191, 12232.75534489323, 15362.231888405759, 16371.70565996395, 16736.079515626272, 13108.803367949678, 13522.86477135216, 13665.111767735065, 13929.23389213603, 14164.716705666035, 12970.35148242603, 13225.908025410094, 13497.595072147851, 13516.39176237052, 13975.930120349332, 13502.459901603826, 13893.957953153757, 13930.930345348208, 14376.712465750836, 14579.0, 14793.408263669333, 14923.925380373028, 15017.924910375377, 15212.543623691306, 15415.229238537804, 13612.387442565307, 13698.52055178064, 13714.93142534321, 13718.794218086538, 13765.518206862711], "value": 10694.086171878209, "unit": "score"}, {"name": "mootools.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [1381.3231516556891, 1495.9401623935041, 1496.5884381795006, 1501.2943916359313, 1502.5492352294316, 7980.680772769089, 8409.159084091587, 8746.956265218665, 8756.824863502734, 8757.824843503126, 8265.958670206655, 8417.074121846606, 8421.747347579567, 8561.143885611436, 8561.871571926411, 2174.4672555223915, 2246.1576908659254, 2443.3647251714506, 2496.10140349474, 2503.249025292414, 2496.463260399014, 2574.4207553300453, 2579.097315939425, 2589.637450756886, 2591.6371707960902, 2434.257551446808, 2440.511897620474, 2458.311672731638, 2467.1734968785477, 2475.653408522808, 2496.662950501677, 2498.6127150291554, 2516.9748302517105, 2519.59686450168, 2520.5463016656995, 2438.682971213731, 2496.7253602103756, 2496.862672553009, 2498.025769949721, 2498.5127900059497, 8542.017667968139, 8571.228589426919, 8588.613512391958, 8592.14078592142, 8606.698765543239, 5400.270963419927, 5520.06158952979, 5532.1425179097305, 5538.335399752015, 5545.362283337387, 3279.9344013119844, 3303.174206448388, 3510.5260789793306, 3571.785692858437, 3572.5712914450173, 1338.4445455136204, 1390.1867407566585, 1392.0951381601938, 1435.1389166500016, 1446.327457732149, 11704.005159561448, 12080.033597312195, 12082.818757718553, 12106.394680265952, 12111.0, 4841.975790121097, 4889.731064791471, 4987.127252730757, 5003.974980125076, 5030.924536131961, 10364.740881477872, 10409.271351005356, 10413.42726150054, 10417.9479102604, 10420.531076101593, 5592.720363981784, 5603.215549823028, 5606.299212598426, 5610.13042978339, 5613.10190369547, 4856.538628830326, 4888.071266459361, 4940.061388336205, 4976.253561965734, 5022.096022715873, 3929.9017524562114, 4023.4166045923175, 4032.3749818778138, 4042.514898212233, 4094.815733292009, 1181.5155786127646, 1194.1700518139983, 1197.4252358867793, 1200.9099317551045, 1202.9518819247132, 881.8412685716632, 884.2351366068305, 898.9640414383351, 922.1378011559214, 967.6371360739722, 5805.767769289266, 5896.0, 6037.879242415127, 6196.549286660049, 6320.178376810985, 1077.0790973717515, 1086.9510872010621, 1092.6175838456477, 1101.9944900275607, 1121.7195701074731, 3992.2215168042535, 4147.834086636501, 4181.372794080912, 4198.328267477189, 4278.422412974271, 10509.684709458728, 10782.191335649857, 10788.676339709822, 10845.186611004206, 10846.511906964206, 10453.895461045444, 10525.84211236832, 10626.096781773636, 10655.786884262272, 10692.572297108029, 8262.256396924306, 8372.455790373606, 8385.203405676451, 8386.371022173484, 8393.790155246168, 5921.763129474945, 5928.0, 6006.819795406145, 6020.939790602213, 6063.514918806573, 9281.0, 9739.366941148803, 9739.659111931049, 9748.268879834182, 9784.559694813608, 8887.777805554913, 9731.221502279659, 9856.112949834549, 9923.801523969336, 9954.0, 6996.440284777307, 7476.813079672834, 7618.69525218985, 7711.845763084819, 7815.0, 8458.0, 8477.491350518989, 8566.443181193203, 8584.098669639849, 8594.957025214833, 7424.851502969802, 7483.476156668981, 7529.209433009674, 7667.769966901002, 7704.191059938626, 7481.251874812475, 7500.212477689982, 7590.468667193243, 7600.96199519021, 7661.923380766344, 6773.796786096425, 6783.728650853911, 6850.588964662136, 6861.656917154222, 6875.312468753084, 5002.174641184164, 5038.697678139323, 5074.188129899198, 5084.161113416393, 5116.4627714090975, 4984.327115839315, 5014.420457555858, 5157.613179011514, 5157.922631160461, 5232.1628539433505], "value": 4704.560051652682, "unit": "score"}, {"name": "prototype.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [381.7308797297905, 404.77353618535847, 408.3181087583737, 408.5363112866896, 413.38612160941005, 5408.161734931087, 5416.5937554683405, 5472.5621950243885, 5493.670379777216, 5494.846082322712, 5183.326167598217, 5238.8690282742955, 5294.014744470824, 5333.813136613989, 5444.3194600674915, 4316.115196384733, 4326.8269269229195, 4327.870163895088, 4330.631896288819, 4346.39150518926, 4343.761093139876, 4351.325544540601, 4357.673174511909, 4379.802908869093, 4386.846460373888, 4025.2553277643583, 4091.1817636472674, 4237.512686041114, 4248.490181178247, 4324.308110702288, 4216.2199993001395, 4235.830566777326, 4258.850940217093, 4262.531121576624, 4274.059706864485, 3842.346801043829, 3863.806809659534, 3876.573576906538, 3879.39869320253, 3885.30064588374, 5196.8960620787375, 5200.349956255468, 5236.3978142513715, 5260.92108618371, 5287.23335116406, 4908.779104940286, 4954.628402869799, 4973.523828554294, 4974.900501989976, 4980.526849949249, 5627.493525582676, 5638.182463542805, 5653.604247702662, 5683.175939488751, 5683.2895888014, 4225.852095176685, 4281.571842815724, 4284.507281662618, 4297.935530967038, 4339.631131353839, 5776.826695199109, 5784.36371999084, 5790.623609465371, 5828.096645019987, 5839.7664093436215, 4455.131249406335, 4462.174497717932, 4468.4414448193975, 4484.148011877733, 4489.9775501122285, 4058.9594104058583, 4226.36604509326, 4258.233517966733, 4534.4380425059735, 4538.818447262139, 4812.868975790687, 4812.951870481321, 4834.178189707758, 4834.274858771142, 4834.516548345207, 5628.493435590816, 5653.869226154786, 5666.348369937427, 5668.801591944262, 5727.5131613812455, 1379.7240551889663, 1421.410114802366, 1439.6760728835927, 1451.9128852268898, 1457.1475686723386, 931.7670582354411, 947.5641205045619, 973.8003709239589, 980.2060331131663, 981.474910922653, 5293.444188360244, 5295.232191332312, 5317.54800841925, 5321.308229930084, 5325.866853328698, 5584.636998595079, 5617.174418313983, 5617.522510586646, 5618.578606604521, 5662.801801936995, 5134.435212126663, 5267.762950667229, 5279.392869819943, 5300.0, 5311.786369246627, 2966.8071575347535, 2975.479291124088, 2990.6560745514544, 2997.0, 3000.6249218847643, 5479.698616576126, 5663.677892064234, 5762.971185144047, 5773.942260577341, 5853.88292234153, 5650.5479561634975, 5662.66024038559, 5679.630823996427, 5691.345495268014, 5711.742971566289, 5747.195392645117, 5751.0, 5799.739011744397, 5799.927013502515, 5818.679972601548, 5284.577233821208, 5533.197686335539, 5556.777728890799, 5573.27547418833, 5587.2120921304795, 5461.945380546303, 5464.508194262536, 5497.312835895513, 5501.917471237854, 5539.396483652677, 5522.475364840334, 5804.533073443854, 5809.302883653989, 5816.94183058164, 5818.534517238526, 4104.261232977973, 4118.5173337599035, 4126.91746165069, 4149.190907772955, 4158.750474971512, 5591.888162236651, 5632.76079262578, 5641.887162256814, 5645.266115405136, 5673.517750991047, 5289.920651190312, 5426.755795989111, 5458.590605704668, 5512.0, 5525.502704756591, 5414.783408663609, 5417.864553386197, 5423.776251736769, 5440.455954404528, 5446.727663616883, 5375.731213439234, 5414.675119492843, 5432.483914028161, 5439.347278326626, 5496.175573663822, 5506.779728810963, 5600.327960644749, 5662.971685141548, 5670.432956704297, 5683.914741278802, 5553.611247212656, 5562.774890044015, 5564.8330550083565, 5568.749406276808, 5571.3871474137], "value": 4315.086605864555, "unit": "score"}, {"name": "yui.html", "lowerIsBetter": false, "alertThreshold": 5.0, "replicates": [817.8568750468667, 825.6232011074703, 827.5572568675759, 910.8633704944259, 927.4713413354388, 17239.913800430997, 17467.82532174678, 17861.732074018884, 18105.185266663, 18259.0, 16347.673046539063, 16707.91646041768, 16709.91645041776, 16712.83287167128, 16726.49820505384, 814.2956342763512, 832.8958880139983, 835.9205875441824, 836.4855613797502, 842.9030661473947, 715.8818794898835, 734.4271468254769, 809.1746418652971, 829.1625458287114, 829.9170082991683, 860.8579584368572, 861.0270394454258, 861.5132450165636, 861.7113267055513, 861.9138086191363, 850.9787255318605, 857.4555157475017, 857.7812657772259, 858.3733874271754, 858.4291446188278, 540.5405405405413, 552.7816512477589, 618.9350118237566, 637.8118455055724, 643.925948515922, 16282.918585407115, 16314.918425407915, 16346.264418101095, 16347.509574712778, 16347.673046539121, 15675.843241567552, 15814.367425302975, 15864.92067539655, 15867.365305387772, 16293.755593666105, 14569.635759106, 14604.196769177692, 14655.34050967709, 14699.926500367537, 14776.0, 4794.424669039738, 4795.568398844086, 4807.687500312469, 4819.469858315618, 4919.680220785674, 85309.0, 85701.57149214276, 85743.0, 87184.0, 87803.0, 11350.772984540263, 11449.828252576051, 11479.196456247982, 11505.367204803648, 11531.308121512737, 21514.677279840816, 21826.345209643736, 21841.67237491439, 22701.432464188198, 22957.426064348525, 8553.57232138403, 8669.523176225368, 8782.0, 8805.559722013873, 8880.378373513791, 4803.639727020487, 4812.25410061441, 4835.95164048355, 4863.635227357962, 4914.754262286943, 3722.5346831646043, 3814.6185381461632, 3908.7068469864876, 3917.0, 3963.7027222958395, 686.1868685607471, 690.5097380859545, 698.5494356140262, 700.2997002997002, 702.6065403374025, 767.6468824340755, 767.7274567528559, 770.7456539342004, 778.7702627724835, 784.6351446577255, 9982.201423886072, 10513.684589462327, 10701.0, 10731.785364292671, 10757.0, 767.3439209475818, 771.8494893495827, 777.3081957058223, 789.0964845252154, 837.4179944938331, 5042.42012168598, 5142.897142057138, 5190.92213616796, 5209.947900520946, 5233.162693968947, 81363.59318203371, 82150.58924705339, 83144.58427707944, 84277.0, 84723.5763821177, 55937.440625593226, 56376.71811640915, 65038.0, 66985.66507167433, 67731.0, 60191.0, 60507.69746151241, 60780.392196077475, 61212.38787612156, 62085.37914620796, 10658.893411066101, 11134.610288639858, 11197.328160310408, 11263.584040094342, 11416.429178541206, 41168.0, 41641.16717665569, 41809.372859406525, 42333.788331058146, 43025.139497210504, 49278.260826086924, 49691.0, 49776.751116245636, 54006.3798086058, 55166.17250741323, 14042.1574705518, 15099.54701358961, 15173.544793656209, 15231.0, 15358.385664573292, 16260.837391625932, 16354.427595034116, 16368.918155409146, 16455.25951332169, 17155.65688686244, 15628.0, 15755.054696718234, 15771.605709856887, 15847.762283565526, 16078.598035049217, 14761.409543618134, 15011.849881501044, 15599.688006240038, 15926.68146637084, 16054.839451605334, 15155.0, 15374.615634609225, 16053.438129665406, 16246.593835154215, 16274.186290685655, 12781.297028663514, 12855.87144128584, 13203.867961320648, 13365.465381385025, 13498.52755153565, 11633.825492617787, 11651.766964660828, 11993.520259189883, 12363.93818030904, 12547.121701480808], "value": 7800.649662583483, "unit": "score"}], "name": "dromaeo_css", "value": 7681.402354857949, "alertThreshold": 5.0}, {"lowerIsBetter": true, "subtests": [{"name": "ai-astar", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [111.0, 111.0, 110.0, 111.0, 113.0, 111.0, 110.0, 110.0, 110.0, 110.0], "value": 110.7, "unit": "score"}, {"name": "audio-beat-detection", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [150.0, 117.0, 117.0, 158.0, 119.0, 119.0, 117.0, 119.0, 147.0, 119.0], "value": 128.2, "unit": "score"}, {"name": "audio-dft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [159.0, 161.0, 159.0, 159.0, 160.0, 160.0, 160.0, 160.0, 159.0, 159.0], "value": 159.6, "unit": "score"}, {"name": "audio-fft", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [74.0, 76.0, 75.0, 113.0, 77.0, 76.0, 76.0, 76.0, 89.0, 75.0], "value": 80.7, "unit": "score"}, {"name": "audio-oscillator", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [82.0, 81.0, 107.0, 83.0, 83.0, 83.0, 95.0, 83.0, 83.0, 112.0], "value": 89.2, "unit": "score"}, {"name": "imaging-gaussian-blur", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [118.0, 116.0, 117.0, 116.0, 117.0, 118.0, 117.0, 117.0, 118.0, 116.0], "value": 117.0, "unit": "score"}, {"name": "imaging-darkroom", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [146.0, 146.0, 147.0, 147.0, 147.0, 146.0, 146.0, 146.0, 146.0, 145.0], "value": 146.2, "unit": "score"}, {"name": "imaging-desaturate", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [96.0, 95.0, 95.0, 95.0, 95.0, 96.0, 95.0, 95.0, 95.0, 95.0], "value": 95.2, "unit": "score"}, {"name": "json-parse-financial", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [50.0, 48.0, 48.0, 53.0, 51.0, 48.0, 48.0, 49.0, 50.0, 49.0], "value": 49.4, "unit": "score"}, {"name": "json-stringify-tinderbox", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 65.0, 65.0, 64.0, 64.0, 63.0, 64.0, 63.0, 64.0, 65.0], "value": 64.0, "unit": "score"}, {"name": "stanford-crypto-aes", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [85.0, 75.0, 76.0, 78.0, 77.0, 77.0, 77.0, 77.0, 83.0, 76.0], "value": 78.1, "unit": "score"}, {"name": "stanford-crypto-ccm", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [123.0, 130.0, 131.0, 121.0, 127.0, 120.0, 120.0, 120.0, 149.0, 130.0], "value": 127.1, "unit": "score"}, {"name": "stanford-crypto-pbkdf2", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [158.0, 158.0, 162.0, 157.0, 163.0, 159.0, 157.0, 159.0, 160.0, 156.0], "value": 158.9, "unit": "score"}, {"name": "stanford-crypto-sha256-iterative", "lowerIsBetter": true, "alertThreshold": 2.0, "replicates": [63.0, 63.0, 60.0, 60.0, 61.0, 61.0, 59.0, 59.0, 60.0, 59.0], "value": 60.5, "unit": "score"}], "name": "kraken", "value": 1464.7999999999997, "alertThreshold": 2.0}]} 00:26:09 INFO - Return code: 0 00:26:09 INFO - Validating PERFHERDER_DATA against /builds/slave/test/scripts/external_tools/performance-artifact-schema.json 00:26:09 ERROR - # TBPL SUCCESS # 00:26:09 INFO - Running post-action listener: _resource_record_post_action 00:26:09 INFO - [mozharness: 2017-01-27 08:26:09.181642Z] Finished run-tests step (success) 00:26:09 INFO - Running post-run listener: _resource_record_post_run 00:26:09 INFO - Total resource usage - Wall time: 1191s; CPU: 13.0%; Read bytes: 266240; Write bytes: 362893312; Read time: 36; Write time: 186384 00:26:09 INFO - TinderboxPrint: CPU usage
13.1% 00:26:09 INFO - TinderboxPrint: I/O read bytes / time
266,240 / 36 00:26:09 INFO - TinderboxPrint: I/O write bytes / time
362,893,312 / 186,384 00:26:09 INFO - TinderboxPrint: CPU idle
8,264.8 (86.9%) 00:26:09 INFO - TinderboxPrint: CPU user
1,196.9 (12.6%) 00:26:09 INFO - TinderboxPrint: Swap in / out
0 / 0 00:26:09 INFO - install - Wall time: 17s; CPU: 13.0%; Read bytes: 0; Write bytes: 109977600; Read time: 0; Write time: 84680 00:26:09 INFO - run-tests - Wall time: 1174s; CPU: 13.0%; Read bytes: 266240; Write bytes: 252915712; Read time: 36; Write time: 101704 00:26:09 INFO - Running post-run listener: _upload_blobber_files 00:26:09 INFO - Blob upload gear active. 00:26:09 INFO - Preparing to upload files from /builds/slave/test/build/blobber_upload_dir. 00:26:09 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 00:26:09 INFO - Running command: ['/builds/slave/test/build/venv/bin/python', '/builds/slave/test/build/venv/bin/blobberc.py', '-u', 'https://blobupload.elasticbeanstalk.com', '-a', '/builds/slave/test/oauth.txt', '-b', 'Mozilla-Aurora', '-d', '/builds/slave/test/build/blobber_upload_dir', '--output-manifest', '/builds/slave/test/build/uploaded_files.json'] 00:26:09 INFO - Copy/paste: /builds/slave/test/build/venv/bin/python /builds/slave/test/build/venv/bin/blobberc.py -u https://blobupload.elasticbeanstalk.com -a /builds/slave/test/oauth.txt -b Mozilla-Aurora -d /builds/slave/test/build/blobber_upload_dir --output-manifest /builds/slave/test/build/uploaded_files.json 00:26:10 INFO - (blobuploader) - INFO - Open directory for files ... 00:26:10 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/perfherder-data.json ... 00:26:10 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 00:26:10 INFO - (blobuploader) - INFO - Uploading, attempt #1. 00:26:11 INFO - (blobuploader) - INFO - TinderboxPrint: perfherder-data.json: uploaded 00:26:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 00:26:11 INFO - (blobuploader) - INFO - Done attempting. 00:26:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_errorsummary.log ... 00:26:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 00:26:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 00:26:11 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_errorsummary.log: uploaded 00:26:11 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 00:26:11 INFO - (blobuploader) - INFO - Done attempting. 00:26:11 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/resource-usage.json ... 00:26:11 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 00:26:11 INFO - (blobuploader) - INFO - Uploading, attempt #1. 00:26:15 INFO - (blobuploader) - INFO - TinderboxPrint: resource-usage.json: uploaded 00:26:15 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 00:26:15 INFO - (blobuploader) - INFO - Done attempting. 00:26:15 INFO - (blobuploader) - INFO - Uploading /builds/slave/test/build/blobber_upload_dir/dromaeojs_raw.log ... 00:26:15 INFO - (blobuploader) - INFO - Using https://blobupload.elasticbeanstalk.com 00:26:15 INFO - (blobuploader) - INFO - Uploading, attempt #1. 00:26:16 INFO - (blobuploader) - INFO - TinderboxPrint: dromaeojs_raw.log: uploaded 00:26:16 INFO - (blobuploader) - INFO - Blobserver returned 202. File uploaded! 00:26:16 INFO - (blobuploader) - INFO - Done attempting. 00:26:16 INFO - (blobuploader) - INFO - Iteration through files over. 00:26:16 INFO - Return code: 0 00:26:16 INFO - rmtree: /builds/slave/test/build/uploaded_files.json 00:26:16 INFO - retry: Calling remove with args: ('/builds/slave/test/build/uploaded_files.json',), kwargs: {}, attempt #1 00:26:16 INFO - Setting buildbot property blobber_files to {"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/8051314cef2bf8b08095185635b1b3985928f58ad34f4d2aef651c1e95b3b54a3049229323252d29b487ba4f657623bd98a0f12c0139db59405c26877a2578e3", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/22d55933aad49cfcda70f099a6973b9c93456bd4f1538280f9ac4ff4a1ec32e1d69b2c010f5ec505c90816d60a33ee2b25caf3c88f91ff293565c49c128acb7a", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/85171b02cb8dc99319f55a4d669f02fa2ed8b44f15051d6762bba29eeb221d2fbfe19f5090741e7d6f809fd97f5e5e107fde1ce023c5f792007e1bbdfc41cb4e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/62039d743f475f29e1a1723d4865d6b4f9c0e96353eff69287d707ed330a4264f5997c3c0e5371871fd75df89d24f5dc9ba8c4bd186b8f4498df86781fd37a9c"} 00:26:16 INFO - Writing buildbot properties ['blobber_files'] to /builds/slave/test/properties/blobber_files 00:26:16 INFO - Writing to file /builds/slave/test/properties/blobber_files 00:26:16 INFO - Contents: 00:26:16 INFO - blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/8051314cef2bf8b08095185635b1b3985928f58ad34f4d2aef651c1e95b3b54a3049229323252d29b487ba4f657623bd98a0f12c0139db59405c26877a2578e3", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/22d55933aad49cfcda70f099a6973b9c93456bd4f1538280f9ac4ff4a1ec32e1d69b2c010f5ec505c90816d60a33ee2b25caf3c88f91ff293565c49c128acb7a", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/85171b02cb8dc99319f55a4d669f02fa2ed8b44f15051d6762bba29eeb221d2fbfe19f5090741e7d6f809fd97f5e5e107fde1ce023c5f792007e1bbdfc41cb4e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/62039d743f475f29e1a1723d4865d6b4f9c0e96353eff69287d707ed330a4264f5997c3c0e5371871fd75df89d24f5dc9ba8c4bd186b8f4498df86781fd37a9c"} 00:26:16 INFO - Running post-run listener: copy_logs_to_upload_dir 00:26:16 INFO - Copying logs to upload dir... 00:26:16 INFO - mkdir: /builds/slave/test/build/upload/logs 00:26:16 INFO - Copying logs to upload dir... program finished with exit code 0 elapsedTime=1239.385574 ========= master_lag: 0.03 ========= ========= Finished '/tools/buildbot/bin/python scripts/scripts/talos_script.py ...' (results: 0, elapsed: 20 mins, 39 secs) (at 2017-01-27 00:26:16.322079) ========= ========= Started set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-01-27 00:26:16.325362) ========= 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=a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False blobber_files:{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/8051314cef2bf8b08095185635b1b3985928f58ad34f4d2aef651c1e95b3b54a3049229323252d29b487ba4f657623bd98a0f12c0139db59405c26877a2578e3", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/22d55933aad49cfcda70f099a6973b9c93456bd4f1538280f9ac4ff4a1ec32e1d69b2c010f5ec505c90816d60a33ee2b25caf3c88f91ff293565c49c128acb7a", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/85171b02cb8dc99319f55a4d669f02fa2ed8b44f15051d6762bba29eeb221d2fbfe19f5090741e7d6f809fd97f5e5e107fde1ce023c5f792007e1bbdfc41cb4e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/62039d743f475f29e1a1723d4865d6b4f9c0e96353eff69287d707ed330a4264f5997c3c0e5371871fd75df89d24f5dc9ba8c4bd186b8f4498df86781fd37a9c"} build_url:https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.tar.bz2 program finished with exit code 0 elapsedTime=0.011499 build_url: 'https://queue.taskcluster.net/v1/task/eNeu4ggEQcOFNI5F9uBp5A/artifacts/public/build/target.tar.bz2' blobber_files: '{"perfherder-data.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/8051314cef2bf8b08095185635b1b3985928f58ad34f4d2aef651c1e95b3b54a3049229323252d29b487ba4f657623bd98a0f12c0139db59405c26877a2578e3", "dromaeojs_errorsummary.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/22d55933aad49cfcda70f099a6973b9c93456bd4f1538280f9ac4ff4a1ec32e1d69b2c010f5ec505c90816d60a33ee2b25caf3c88f91ff293565c49c128acb7a", "dromaeojs_raw.log": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/85171b02cb8dc99319f55a4d669f02fa2ed8b44f15051d6762bba29eeb221d2fbfe19f5090741e7d6f809fd97f5e5e107fde1ce023c5f792007e1bbdfc41cb4e", "resource-usage.json": "http://mozilla-releng-blobs.s3.amazonaws.com/blobs/Mozilla-Aurora/sha512/62039d743f475f29e1a1723d4865d6b4f9c0e96353eff69287d707ed330a4264f5997c3c0e5371871fd75df89d24f5dc9ba8c4bd186b8f4498df86781fd37a9c"}' ========= master_lag: 0.02 ========= ========= Finished set props: build_url blobber_files (results: 0, elapsed: 0 secs) (at 2017-01-27 00:26:16.352103) ========= ========= Started 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-01-27 00:26:16.352639) ========= 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=a0d2d2de893abaa8702a9954000001a7-1485504163.233358-520417590 XPCOM_DEBUG_BREAK=warn _=/tools/buildbot/bin/python using PTY: False program finished with exit code 0 elapsedTime=0.004521 ========= master_lag: 0.08 ========= ========= Finished 'rm -f ...' (results: 0, elapsed: 0 secs) (at 2017-01-27 00:26:16.434817) ========= ========= Started reboot skipped (results: 3, elapsed: 0 secs) (at 2017-01-27 00:26:16.435136) ========= ========= Finished reboot skipped (results: 3, elapsed: 0 secs) (at 2017-01-27 00:26:16.435427) ========= ========= Total master_lag: 0.18 =========